19:16:03.175 [XNIO-41 task-2] DEBUG ersatz.undertow.request.io - UT005013: An IOException occurred
java.nio.channels.ClosedChannelException: null
at sun.nio.ch.SocketChannelImpl.shutdownOutput(SocketChannelImpl.java:797)
at ersatz.xnio.nio.NioSocketConduit.write(NioSocketConduit.java:170)
at ersatz.undertow.server.protocol.http.HttpResponseConduit.processWrite(HttpResponseConduit.java:242)
at ersatz.undertow.server.protocol.http.HttpResponseConduit.flush(HttpResponseConduit.java:739)
at ersatz.undertow.conduits.HeadStreamSinkConduit.flush(HeadStreamSinkConduit.java:131)
at ersatz.xnio.conduits.ConduitStreamSinkChannel.flush(ConduitStreamSinkChannel.java:162)
at ersatz.undertow.channels.DetachableStreamSinkChannel.flush(DetachableStreamSinkChannel.java:119)
at ersatz.xnio.channels.Channels.flushBlocking(Channels.java:63)
at ersatz.undertow.io.UndertowOutputStream.close(UndertowOutputStream.java:344)
at ersatz.undertow.io.BlockingSenderImpl.close(BlockingSenderImpl.java:170)
at ersatz.undertow.io.DefaultIoCallback.onComplete(DefaultIoCallback.java:54)
at ersatz.undertow.io.BlockingSenderImpl.invokeOnComplete(BlockingSenderImpl.java:227)
at ersatz.undertow.io.BlockingSenderImpl.send(BlockingSenderImpl.java:95)
at ersatz.undertow.io.BlockingSenderImpl.send(BlockingSenderImpl.java:117)
at com.stehno.ersatz.ErsatzServer.send(ErsatzServer.groovy:494)
at com.stehno.ersatz.ErsatzServer.access$0(ErsatzServer.groovy)
at com.stehno.ersatz.ErsatzServer$1.handleRequest(ErsatzServer.groovy:370)
at ersatz.undertow.server.handlers.HttpTraceHandler.handleRequest(HttpTraceHandler.java:70)
at ersatz.undertow.server.handlers.encoding.EncodingHandler.handleRequest(EncodingHandler.java:72)
at ersatz.undertow.server.Connectors.executeRootHandler(Connectors.java:332)
at ersatz.undertow.server.HttpServerExchange$1.run(HttpServerExchange.java:812)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
at java.lang.Thread.run(Thread.java:748)
Suppressed: java.nio.channels.ClosedByInterruptException: null
at java.nio.channels.spi.AbstractInterruptibleChannel.end(AbstractInterruptibleChannel.java:202)
at sun.nio.ch.SocketChannelImpl.write(SocketChannelImpl.java:478)
at ersatz.xnio.nio.NioSocketConduit.write(NioSocketConduit.java:164)
... 22 common frames omitted
19:16:03.192 [Test worker] DEBUG ersatz.undertow - starting undertow server ersatz.undertow.Undertow@7aad9375
19:16:03.194 [XNIO-42 I/O-1] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 I/O-1', selector sun.nio.ch.EPollSelectorImpl@4fc01769
19:16:03.198 [XNIO-42 I/O-2] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 I/O-2', selector sun.nio.ch.EPollSelectorImpl@20d483c
19:16:03.203 [XNIO-42 I/O-3] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 I/O-3', selector sun.nio.ch.EPollSelectorImpl@ac4b32f
19:16:03.205 [XNIO-42 I/O-4] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 I/O-4', selector sun.nio.ch.EPollSelectorImpl@6750e31f
19:16:03.205 [XNIO-42 I/O-5] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 I/O-5', selector sun.nio.ch.EPollSelectorImpl@63399124
19:16:03.206 [XNIO-42 I/O-6] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 I/O-6', selector sun.nio.ch.EPollSelectorImpl@3f42e338
19:16:03.210 [XNIO-42 I/O-7] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 I/O-7', selector sun.nio.ch.EPollSelectorImpl@44363776
19:16:03.211 [XNIO-42 I/O-8] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 I/O-8', selector sun.nio.ch.EPollSelectorImpl@34cc86aa
19:16:03.222 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTP for interface localhost and port 0
19:16:03.222 [XNIO-42 Accept] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-42 Accept', selector sun.nio.ch.EPollSelectorImpl@6aef70bb
19:16:03.223 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTPS for interface localhost and port 0
19:16:03.233 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.233 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.233 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:33511
19:16:03.233 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Opening connection {}->http://localhost:33511
19:16:03.234 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connecting to localhost/127.0.0.1:33511
19:16:03.234 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connection established 127.0.0.1:46032<->127.0.0.1:33511
19:16:03.234 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE / HTTP/1.1
19:16:03.234 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.234 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.234 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> TRACE / HTTP/1.1
19:16:03.234 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> Host: localhost:33511
19:16:03.234 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> Connection: Keep-Alive
19:16:03.234 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.234 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> Accept-Encoding: gzip,deflate
19:16:03.234 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "TRACE / HTTP/1.1[\r][\n]"
19:16:03.234 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "Host: localhost:33511[\r][\n]"
19:16:03.234 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.234 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.234 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.234 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "[\r][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Content-Encoding: gzip[\r][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Connection: keep-alive[\r][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Content-Type: message/http[\r][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Content-Length: 159[\r][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "[\r][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8e][0xb1][\n]"
19:16:03.258 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "[0xc3] [0x14]Ew[0xc1]pl[0xa1][0x9a][0xc6]4P[0xdc]D[0x2][0xa1]]JI[0xe7]"//F[0x10][0x95]F2[0xf4][0xeb]k[0xb7][0xcb]=[0x17][0xce][0x9d][0x9e][0xda][0xc][0xac]a[0xe3]4=[0x9a]V[0xb4][0x94][0x98][0x14]#B[0xf1])*vG[0xcc]\[0x7][0xbf]#%[0x1a][0x0]s[0xe1]C[0x84]4[0xfb][0xe8][0x14]s_[0x9f]O3.[0xc1][0x96][0x8a]_[0x1b]~[0xb8]v[0x18][0x8b]b:[X[0x91][0x8f][0xa5]d[0x13]|[0xad][0x9a][0x8b][0xe8][0x85]d[0x87][0x9b][0xdd]m[0xb5]\[0xc5][0xf9]-[0xa5]<R2[0xa6][0xad][0xee]C[0x2][0x1b][0xd6][0xec][0xba][0xbe][0xad][0x1f]([0xf9][0x1]3>dt[0x98][0x0][0x0][0x0]"
19:16:03.258 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << HTTP/1.1 200 OK
19:16:03.258 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Content-Encoding: gzip
19:16:03.258 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Connection: keep-alive
19:16:03.259 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Content-Type: message/http
19:16:03.259 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Content-Length: 159
19:16:03.259 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.261 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.338 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:46032<->127.0.0.1:33511
19:16:03.338 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.340 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.340 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.340 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:33511
19:16:03.340 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE / HTTP/1.1
19:16:03.340 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.340 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.340 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> TRACE / HTTP/1.1
19:16:03.340 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> Host: localhost:33511
19:16:03.340 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> Connection: Keep-Alive
19:16:03.340 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.340 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 >> Accept-Encoding: gzip,deflate
19:16:03.340 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "TRACE / HTTP/1.1[\r][\n]"
19:16:03.340 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "Host: localhost:33511[\r][\n]"
19:16:03.340 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.340 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.340 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.340 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 >> "[\r][\n]"
19:16:03.341 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.342 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Content-Encoding: gzip[\r][\n]"
19:16:03.342 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Connection: keep-alive[\r][\n]"
19:16:03.342 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Content-Type: message/http[\r][\n]"
19:16:03.342 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Content-Length: 159[\r][\n]"
19:16:03.342 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.342 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "[\r][\n]"
19:16:03.342 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8e][0xb1][\n]"
19:16:03.342 [Test worker] DEBUG org.apache.http.wire - http-outgoing-41 << "[0xc3] [0x14]Ew[0xc1]pl[0xa1][0x9a][0xc6]4P[0xdc]D[0x2][0xa1]]JI[0xe7]"//F[0x10][0x95]F2[0xf4][0xeb]k[0xb7][0xcb]=[0x17][0xce][0x9d][0x9e][0xda][0xc][0xac]a[0xe3]4=[0x9a]V[0xb4][0x94][0x98][0x14]#B[0xf1])*vG[0xcc]\[0x7][0xbf]#%[0x1a][0x0]s[0xe1]C[0x84]4[0xfb][0xe8][0x14]s_[0x9f]O3.[0xc1][0x96][0x8a]_[0x1b]~[0xb8]v[0x18][0x8b]b:[X[0x91][0x8f][0xa5]d[0x13]|[0xad][0x9a][0x8b][0xe8][0x85]d[0x87][0x9b][0xdd]m[0xb5]\[0xc5][0xf9]-[0xa5]<R2[0xa6][0xad][0xee]C[0x2][0x1b][0xd6][0xec][0xba][0xbe][0xad][0x1f]([0xf9][0x1]3>dt[0x98][0x0][0x0][0x0]"
19:16:03.342 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << HTTP/1.1 200 OK
19:16:03.342 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Content-Encoding: gzip
19:16:03.342 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Connection: keep-alive
19:16:03.342 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Content-Type: message/http
19:16:03.342 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Content-Length: 159
19:16:03.342 [Test worker] DEBUG org.apache.http.headers - http-outgoing-41 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.342 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.343 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:46032<->127.0.0.1:33511
19:16:03.343 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.343 [Test worker] DEBUG ersatz.undertow - stopping undertow server ersatz.undertow.Undertow@7aad9375
19:16:03.348 [Test worker] DEBUG ersatz.undertow - starting undertow server ersatz.undertow.Undertow@e22512f
19:16:03.354 [XNIO-43 I/O-1] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 I/O-1', selector sun.nio.ch.EPollSelectorImpl@5a5f3829
19:16:03.363 [XNIO-43 I/O-2] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 I/O-2', selector sun.nio.ch.EPollSelectorImpl@61411861
19:16:03.367 [XNIO-43 I/O-4] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 I/O-4', selector sun.nio.ch.EPollSelectorImpl@3d760ead
19:16:03.367 [XNIO-43 I/O-3] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 I/O-3', selector sun.nio.ch.EPollSelectorImpl@4ff22733
19:16:03.367 [XNIO-43 I/O-5] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 I/O-5', selector sun.nio.ch.EPollSelectorImpl@357894b7
19:16:03.367 [XNIO-43 I/O-6] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 I/O-6', selector sun.nio.ch.EPollSelectorImpl@5650ad6d
19:16:03.372 [XNIO-43 I/O-7] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 I/O-7', selector sun.nio.ch.EPollSelectorImpl@70d0a67c
19:16:03.374 [XNIO-43 I/O-8] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 I/O-8', selector sun.nio.ch.EPollSelectorImpl@37b6c26b
19:16:03.390 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTP for interface localhost and port 0
19:16:03.390 [XNIO-43 Accept] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-43 Accept', selector sun.nio.ch.EPollSelectorImpl@23e8267c
19:16:03.391 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTPS for interface localhost and port 0
19:16:03.395 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.395 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.395 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:41509
19:16:03.395 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Opening connection {}->http://localhost:41509
19:16:03.396 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connecting to localhost/127.0.0.1:41509
19:16:03.396 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connection established 127.0.0.1:46572<->127.0.0.1:41509
19:16:03.396 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE /something HTTP/1.1
19:16:03.396 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.396 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.396 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> TRACE /something HTTP/1.1
19:16:03.396 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> Host: localhost:41509
19:16:03.396 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> Connection: Keep-Alive
19:16:03.396 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.396 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> Accept-Encoding: gzip,deflate
19:16:03.396 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "TRACE /something HTTP/1.1[\r][\n]"
19:16:03.396 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "Host: localhost:41509[\r][\n]"
19:16:03.396 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.396 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.396 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.396 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "[\r][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Content-Encoding: gzip[\r][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Connection: keep-alive[\r][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Content-Type: message/http[\r][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Content-Length: 165[\r][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "[\r][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8d][0xb1][\n]"
19:16:03.398 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "[0xc3] [0x14]Ew[0xc1]pl[0xa1][0x9a]D[0x12]h[0xb3][0x89][0x4][0xa4]]JI[0xe7]"[0xe6]%[0x11][0xac]J[0xf3][0xc8][0xd0][0xaf][0xaf][0xdd].[0xf7][0xdc][0xc3][0x1d][0x1f]J[0xf][0xac][0xda][0xd2][0x1b]p[0xf5]qaf[0x1c][0xef]U#[0x1a]Jt[0x8a][0x11][0x1c][0xfa][0x14]{v[0x3][0xc8]\[0x5][0xbf][0x3]%[0xca]9[0xc8][0xc8][0x87][0xe8][0xd2]T[0x8c][0x9e]-_[0x9f]O[0x13][0xcc][0xc1]b[0xc1][0xcf][\r]>\-[0x10][0xb1]g*[[0xb7][0x2]7[0x88]Y[0x7]_[0xaa][0xaa][0x15][0x9d][0x90][0xec]p[0xb5][0xbb]-/gQ[0xbf][0xa4][0x94]GJL[0xda][0xca]>$g[0xc3][0xfa][0x8f]m[0xd3][0xd5][0x17]J([0xf9][0x1][0xb4][0xfa][0xb1][0xcb][0xa1][0x0][0x0][0x0]"
19:16:03.398 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << HTTP/1.1 200 OK
19:16:03.398 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Content-Encoding: gzip
19:16:03.398 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Connection: keep-alive
19:16:03.398 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Content-Type: message/http
19:16:03.398 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Content-Length: 165
19:16:03.398 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.398 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.399 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:46572<->127.0.0.1:41509
19:16:03.399 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.400 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.401 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.401 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:41509
19:16:03.401 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE /something HTTP/1.1
19:16:03.401 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.401 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.401 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> TRACE /something HTTP/1.1
19:16:03.401 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> Host: localhost:41509
19:16:03.401 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> Connection: Keep-Alive
19:16:03.401 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.401 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 >> Accept-Encoding: gzip,deflate
19:16:03.401 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "TRACE /something HTTP/1.1[\r][\n]"
19:16:03.401 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "Host: localhost:41509[\r][\n]"
19:16:03.401 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.401 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.401 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.401 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 >> "[\r][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Content-Encoding: gzip[\r][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Connection: keep-alive[\r][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Content-Type: message/http[\r][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Content-Length: 165[\r][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "[\r][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8d][0xb1][\n]"
19:16:03.402 [Test worker] DEBUG org.apache.http.wire - http-outgoing-42 << "[0xc3] [0x14]Ew[0xc1]pl[0xa1][0x9a]D[0x12]h[0xb3][0x89][0x4][0xa4]]JI[0xe7]"[0xe6]%[0x11][0xac]J[0xf3][0xc8][0xd0][0xaf][0xaf][0xdd].[0xf7][0xdc][0xc3][0x1d][0x1f]J[0xf][0xac][0xda][0xd2][0x1b]p[0xf5]qaf[0x1c][0xef]U#[0x1a]Jt[0x8a][0x11][0x1c][0xfa][0x14]{v[0x3][0xc8]\[0x5][0xbf][0x3]%[0xca]9[0xc8][0xc8][0x87][0xe8][0xd2]T[0x8c][0x9e]-_[0x9f]O[0x13][0xcc][0xc1]b[0xc1][0xcf][\r]>\-[0x10][0xb1]g*[[0xb7][0x2]7[0x88]Y[0x7]_[0xaa][0xaa][0x15][0x9d][0x90][0xec]p[0xb5][0xbb]-/gQ[0xbf][0xa4][0x94]GJL[0xda][0xca]>$g[0xc3][0xfa][0x8f]m[0xd3][0xd5][0x17]J([0xf9][0x1][0xb4][0xfa][0xb1][0xcb][0xa1][0x0][0x0][0x0]"
19:16:03.403 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << HTTP/1.1 200 OK
19:16:03.403 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Content-Encoding: gzip
19:16:03.403 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Connection: keep-alive
19:16:03.403 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Content-Type: message/http
19:16:03.403 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Content-Length: 165
19:16:03.403 [Test worker] DEBUG org.apache.http.headers - http-outgoing-42 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.403 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.410 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:46572<->127.0.0.1:41509
19:16:03.410 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.411 [Test worker] DEBUG ersatz.undertow - stopping undertow server ersatz.undertow.Undertow@e22512f
19:16:03.415 [Test worker] DEBUG ersatz.undertow - starting undertow server ersatz.undertow.Undertow@2278dbe3
19:16:03.419 [XNIO-44 I/O-2] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 I/O-2', selector sun.nio.ch.EPollSelectorImpl@232e988
19:16:03.419 [XNIO-44 I/O-1] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 I/O-1', selector sun.nio.ch.EPollSelectorImpl@720dec64
19:16:03.419 [XNIO-44 I/O-3] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 I/O-3', selector sun.nio.ch.EPollSelectorImpl@78968b65
19:16:03.426 [XNIO-44 I/O-4] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 I/O-4', selector sun.nio.ch.EPollSelectorImpl@49cdb7f4
19:16:03.433 [XNIO-44 I/O-5] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 I/O-5', selector sun.nio.ch.EPollSelectorImpl@256f8a05
19:16:03.434 [XNIO-44 I/O-6] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 I/O-6', selector sun.nio.ch.EPollSelectorImpl@83ec474
19:16:03.434 [XNIO-44 I/O-7] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 I/O-7', selector sun.nio.ch.EPollSelectorImpl@7a73c131
19:16:03.436 [XNIO-44 I/O-8] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 I/O-8', selector sun.nio.ch.EPollSelectorImpl@47242bbc
19:16:03.443 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTP for interface localhost and port 0
19:16:03.443 [XNIO-44 Accept] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-44 Accept', selector sun.nio.ch.EPollSelectorImpl@20a89f44
19:16:03.445 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTPS for interface localhost and port 0
19:16:03.449 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.449 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.449 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:38613
19:16:03.449 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Opening connection {}->http://localhost:38613
19:16:03.449 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connecting to localhost/127.0.0.1:38613
19:16:03.449 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connection established 127.0.0.1:57710<->127.0.0.1:38613
19:16:03.449 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE /something HTTP/1.1
19:16:03.449 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.449 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.449 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> TRACE /something HTTP/1.1
19:16:03.449 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> Host: localhost:38613
19:16:03.450 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> Connection: Keep-Alive
19:16:03.450 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.450 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> Accept-Encoding: gzip,deflate
19:16:03.450 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "TRACE /something HTTP/1.1[\r][\n]"
19:16:03.450 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "Host: localhost:38613[\r][\n]"
19:16:03.450 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.450 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.450 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.450 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "[\r][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Content-Encoding: gzip[\r][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Connection: keep-alive[\r][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Content-Type: message/http[\r][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Content-Length: 165[\r][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "[\r][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8d][0xb1][\n]"
19:16:03.463 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "[0xc2]0[0x14]E[0xf7]@[0xfe]![0xa3][0x82]Il[0xaa][0xa5]t[0xb][0xa1]Pt[0x11][0xa9][0xb3][0x84][0xf4][0xd9][0x6]b[0x12][0xec][0xa3][0x83]_o[0xdc].[0xf7][0xdc][0xc3][0x1d][0xef][0xda][0xf4]L[0xae][0xe9][\r][0xb8][0xf8]8[0xb3]a[0x1c]o[0xb2][0x12][0x15]%&[0xc5][0x8][0xe]}[0x8a][0x1d][0xbb][0x2]d[0xae][0x83][0xdf][0x80][0x12][0xed][0x1c]d[0xe4]}ti*F[0xc7][0xe6][0xaf][0xcf][0x87][0x9]^[0xc1]b[0xc1][0x8f][0x15]>\[0xcf][0x10][0xb1]c:[[0xb7][0x0][0x1f][0x10][0xb3][0x9][0xbe]T[0xf2]$[0xce]B[0xb1][0xdd][0xc5]n[0xb6][0xbc][0xb4][0xe2][0xf8]TJ[0xed])[0x19][0xd2]Z[0xf6]!9[0x1b][0x96][0xac][0xdb][0xa6][0xaa])[0xa1][0xe4][0x7][0xcf]][0x9b][0x0][0xa1][0x0][0x0][0x0]"
19:16:03.463 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << HTTP/1.1 200 OK
19:16:03.463 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Content-Encoding: gzip
19:16:03.463 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Connection: keep-alive
19:16:03.463 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Content-Type: message/http
19:16:03.463 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Content-Length: 165
19:16:03.463 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.463 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.464 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:57710<->127.0.0.1:38613
19:16:03.464 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.466 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.466 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.466 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:38613
19:16:03.466 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE /something HTTP/1.1
19:16:03.466 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.466 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.466 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> TRACE /something HTTP/1.1
19:16:03.466 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> Host: localhost:38613
19:16:03.466 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> Connection: Keep-Alive
19:16:03.466 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.466 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 >> Accept-Encoding: gzip,deflate
19:16:03.466 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "TRACE /something HTTP/1.1[\r][\n]"
19:16:03.466 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "Host: localhost:38613[\r][\n]"
19:16:03.466 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.466 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.466 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.466 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 >> "[\r][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Content-Encoding: gzip[\r][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Connection: keep-alive[\r][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Content-Type: message/http[\r][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Content-Length: 165[\r][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "[\r][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8d][0xb1][\n]"
19:16:03.468 [Test worker] DEBUG org.apache.http.wire - http-outgoing-43 << "[0xc2]0[0x14]E[0xf7]@[0xfe]![0xa3][0x82]Il[0xaa][0xa5]t[0xb][0xa1]Pt[0x11][0xa9][0xb3][0x84][0xf4][0xd9][0x6]b[0x12][0xec][0xa3][0x83]_o[0xdc].[0xf7][0xdc][0xc3][0x1d][0xef][0xda][0xf4]L[0xae][0xe9][\r][0xb8][0xf8]8[0xb3]a[0x1c]o[0xb2][0x12][0x15]%&[0xc5][0x8][0xe]}[0x8a][0x1d][0xbb][0x2]d[0xae][0x83][0xdf][0x80][0x12][0xed][0x1c]d[0xe4]}ti*F[0xc7][0xe6][0xaf][0xcf][0x87][0x9]^[0xc1]b[0xc1][0x8f][0x15]>\[0xcf][0x10][0xb1]c:[[0xb7][0x0][0x1f][0x10][0xb3][0x9][0xbe]T[0xf2]$[0xce]B[0xb1][0xdd][0xc5]n[0xb6][0xbc][0xb4][0xe2][0xf8]TJ[0xed])[0x19][0xd2]Z[0xf6]!9[0x1b][0x96][0xac][0xdb][0xa6][0xaa])[0xa1][0xe4][0x7][0xcf]][0x9b][0x0][0xa1][0x0][0x0][0x0]"
19:16:03.468 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << HTTP/1.1 200 OK
19:16:03.468 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Content-Encoding: gzip
19:16:03.468 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Connection: keep-alive
19:16:03.468 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Content-Type: message/http
19:16:03.468 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Content-Length: 165
19:16:03.468 [Test worker] DEBUG org.apache.http.headers - http-outgoing-43 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.468 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.469 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:57710<->127.0.0.1:38613
19:16:03.469 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.469 [Test worker] DEBUG ersatz.undertow - stopping undertow server ersatz.undertow.Undertow@2278dbe3
19:16:03.472 [Test worker] DEBUG ersatz.undertow - starting undertow server ersatz.undertow.Undertow@3fa919aa
19:16:03.475 [XNIO-44 task-2] DEBUG ersatz.undertow.request.io - UT005013: An IOException occurred
java.nio.channels.ClosedChannelException: null
at sun.nio.ch.SocketChannelImpl.shutdownOutput(SocketChannelImpl.java:797)
at ersatz.xnio.nio.NioSocketConduit.write(NioSocketConduit.java:190)
at ersatz.undertow.server.protocol.http.HttpResponseConduit.processWrite(HttpResponseConduit.java:250)
at ersatz.undertow.server.protocol.http.HttpResponseConduit.write(HttpResponseConduit.java:596)
at ersatz.undertow.conduits.AbstractFixedLengthStreamSinkConduit.write(AbstractFixedLengthStreamSinkConduit.java:106)
at ersatz.undertow.conduits.AbstractFixedLengthStreamSinkConduit.write(AbstractFixedLengthStreamSinkConduit.java:120)
at ersatz.undertow.conduits.DeflatingStreamSinkConduit.performFlushIfRequired(DeflatingStreamSinkConduit.java:419)
at ersatz.undertow.conduits.DeflatingStreamSinkConduit.flush(DeflatingStreamSinkConduit.java:349)
at ersatz.xnio.conduits.ConduitStreamSinkChannel.flush(ConduitStreamSinkChannel.java:162)
at ersatz.undertow.channels.DetachableStreamSinkChannel.flush(DetachableStreamSinkChannel.java:119)
at ersatz.xnio.channels.Channels.flushBlocking(Channels.java:63)
at ersatz.undertow.io.UndertowOutputStream.close(UndertowOutputStream.java:344)
at ersatz.undertow.io.BlockingSenderImpl.close(BlockingSenderImpl.java:170)
at ersatz.undertow.io.DefaultIoCallback.onComplete(DefaultIoCallback.java:54)
at ersatz.undertow.io.BlockingSenderImpl.invokeOnComplete(BlockingSenderImpl.java:227)
at ersatz.undertow.io.BlockingSenderImpl.send(BlockingSenderImpl.java:95)
at ersatz.undertow.io.BlockingSenderImpl.send(BlockingSenderImpl.java:117)
at ersatz.undertow.server.handlers.HttpTraceHandler.handleRequest(HttpTraceHandler.java:68)
at ersatz.undertow.server.handlers.encoding.EncodingHandler.handleRequest(EncodingHandler.java:72)
at ersatz.undertow.server.Connectors.executeRootHandler(Connectors.java:332)
at ersatz.undertow.server.HttpServerExchange$1.run(HttpServerExchange.java:812)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
at java.lang.Thread.run(Thread.java:748)
Suppressed: java.nio.channels.ClosedByInterruptException: null
at java.nio.channels.spi.AbstractInterruptibleChannel.end(AbstractInterruptibleChannel.java:202)
at sun.nio.ch.SocketChannelImpl.write(SocketChannelImpl.java:511)
at ersatz.xnio.nio.NioSocketConduit.write(NioSocketConduit.java:184)
... 22 common frames omitted
19:16:03.480 [XNIO-45 I/O-1] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 I/O-1', selector sun.nio.ch.EPollSelectorImpl@6e93c481
19:16:03.486 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTP for interface localhost and port 0
19:16:03.489 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTPS for interface localhost and port 0
19:16:03.490 [XNIO-45 I/O-3] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 I/O-3', selector sun.nio.ch.EPollSelectorImpl@79800af8
19:16:03.490 [XNIO-45 Accept] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 Accept', selector sun.nio.ch.EPollSelectorImpl@103328c2
19:16:03.490 [XNIO-45 I/O-5] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 I/O-5', selector sun.nio.ch.EPollSelectorImpl@5c5308e2
19:16:03.490 [XNIO-45 I/O-7] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 I/O-7', selector sun.nio.ch.EPollSelectorImpl@7fc6de0c
19:16:03.490 [XNIO-45 I/O-4] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 I/O-4', selector sun.nio.ch.EPollSelectorImpl@7d090dcf
19:16:03.490 [XNIO-45 I/O-8] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 I/O-8', selector sun.nio.ch.EPollSelectorImpl@55c0486f
19:16:03.490 [XNIO-45 I/O-6] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 I/O-6', selector sun.nio.ch.EPollSelectorImpl@6d8c9175
19:16:03.490 [XNIO-45 I/O-2] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-45 I/O-2', selector sun.nio.ch.EPollSelectorImpl@5ed99e22
19:16:03.497 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.497 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.497 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:34997
19:16:03.497 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Opening connection {}->http://localhost:34997
19:16:03.497 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connecting to localhost/127.0.0.1:34997
19:16:03.497 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connection established 127.0.0.1:52478<->127.0.0.1:34997
19:16:03.498 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE /something HTTP/1.1
19:16:03.498 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.498 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.498 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> TRACE /something HTTP/1.1
19:16:03.498 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> Host: localhost:34997
19:16:03.498 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> Connection: Keep-Alive
19:16:03.498 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.498 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> Accept-Encoding: gzip,deflate
19:16:03.498 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "TRACE /something HTTP/1.1[\r][\n]"
19:16:03.498 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "Host: localhost:34997[\r][\n]"
19:16:03.498 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.498 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.498 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.498 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "[\r][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Content-Encoding: gzip[\r][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Connection: keep-alive[\r][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Content-Type: message/http[\r][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Content-Length: 165[\r][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "[\r][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8d][0xb1][\n]"
19:16:03.501 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "[0xc2]0[0x14]E[0xf7]@[0xfe]![0xa3][0x82]Im[0xac]h[0xbb][0x85]P([0xba][0x88][0xd4]YB[0xfa]l[0x3]1[0x9][0xe6][0xd1][0xc1][0xaf]7n[0x97]{[0xee][0xe1][0x8e]w[0xa5]{V[0xe5][0xf8][0x6]\\[0x98][0xd9]0[0x8e][0xb7][0xaa][0x16]5%:[0x86][0x0][0x16]][0xc][0x1d][0xbb][0x2]$[0xae][0xbc][[0x81][0x12]e-$[0xe4]}[0xb0]q*F[0xc7][0xe6][0xaf]K[0xbb][0x9]^[0xde]`[0xc1][0x8f][0xc][0x1f][0xae]f[0x8][0xd8]1[0x95][0x8c]][0x80][0xf][0x88]I{W[0xaa][0xaa][0x11]G![0xd9][0xe6]bVS^[0xce]b[0xff][0x94]Rn)[0x19]b.{[0x1f][0xad][0xf1][0xcb]?[0x1e][0x9a][0xb6]=QB[0xc9][0xf][0xc4][0x1c][0xaf][0xb8][0xa1][0x0][0x0][0x0]"
19:16:03.501 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << HTTP/1.1 200 OK
19:16:03.501 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Content-Encoding: gzip
19:16:03.501 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Connection: keep-alive
19:16:03.501 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Content-Type: message/http
19:16:03.501 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Content-Length: 165
19:16:03.501 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.501 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.502 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:52478<->127.0.0.1:34997
19:16:03.502 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.503 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.503 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.503 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:34997
19:16:03.503 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE /something HTTP/1.1
19:16:03.503 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.503 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.503 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> TRACE /something HTTP/1.1
19:16:03.503 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> Host: localhost:34997
19:16:03.503 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> Connection: Keep-Alive
19:16:03.503 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.503 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 >> Accept-Encoding: gzip,deflate
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "TRACE /something HTTP/1.1[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "Host: localhost:34997[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 >> "[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Content-Encoding: gzip[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Connection: keep-alive[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Content-Type: message/http[\r][\n]"
19:16:03.504 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Content-Length: 165[\r][\n]"
19:16:03.505 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.505 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "[\r][\n]"
19:16:03.505 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8d][0xb1][\n]"
19:16:03.505 [Test worker] DEBUG org.apache.http.wire - http-outgoing-44 << "[0xc2]0[0x14]E[0xf7]@[0xfe]![0xa3][0x82]Im[0xac]h[0xbb][0x85]P([0xba][0x88][0xd4]YB[0xfa]l[0x3]1[0x9][0xe6][0xd1][0xc1][0xaf]7n[0x97]{[0xee][0xe1][0x8e]w[0xa5]{V[0xe5][0xf8][0x6]\\[0x98][0xd9]0[0x8e][0xb7][0xaa][0x16]5%:[0x86][0x0][0x16]][0xc][0x1d][0xbb][0x2]$[0xae][0xbc][[0x81][0x12]e-$[0xe4]}[0xb0]q*F[0xc7][0xe6][0xaf]K[0xbb][0x9]^[0xde]`[0xc1][0x8f][0xc][0x1f][0xae]f[0x8][0xd8]1[0x95][0x8c]][0x80][0xf][0x88]I{W[0xaa][0xaa][0x11]G![0xd9][0xe6]bVS^[0xce]b[0xff][0x94]Rn)[0x19]b.{[0x1f][0xad][0xf1][0xcb]?[0x1e][0x9a][0xb6]=QB[0xc9][0xf][0xc4][0x1c][0xaf][0xb8][0xa1][0x0][0x0][0x0]"
19:16:03.505 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << HTTP/1.1 200 OK
19:16:03.505 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Content-Encoding: gzip
19:16:03.505 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Connection: keep-alive
19:16:03.505 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Content-Type: message/http
19:16:03.505 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Content-Length: 165
19:16:03.505 [Test worker] DEBUG org.apache.http.headers - http-outgoing-44 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.505 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.506 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:52478<->127.0.0.1:34997
19:16:03.506 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.506 [Test worker] DEBUG ersatz.undertow - stopping undertow server ersatz.undertow.Undertow@3fa919aa
19:16:03.510 [Test worker] DEBUG ersatz.undertow - starting undertow server ersatz.undertow.Undertow@704340ed
19:16:03.519 [XNIO-46 I/O-2] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 I/O-2', selector sun.nio.ch.EPollSelectorImpl@3ec35d42
19:16:03.526 [XNIO-46 I/O-3] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 I/O-3', selector sun.nio.ch.EPollSelectorImpl@654ea0d0
19:16:03.530 [XNIO-46 I/O-1] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 I/O-1', selector sun.nio.ch.EPollSelectorImpl@b5bfd03
19:16:03.534 [XNIO-46 I/O-4] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 I/O-4', selector sun.nio.ch.EPollSelectorImpl@74527eba
19:16:03.537 [XNIO-46 I/O-5] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 I/O-5', selector sun.nio.ch.EPollSelectorImpl@4bb19618
19:16:03.537 [XNIO-46 I/O-6] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 I/O-6', selector sun.nio.ch.EPollSelectorImpl@140d1e7
19:16:03.540 [XNIO-46 I/O-7] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 I/O-7', selector sun.nio.ch.EPollSelectorImpl@13aad23f
19:16:03.541 [XNIO-46 I/O-8] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 I/O-8', selector sun.nio.ch.EPollSelectorImpl@638ea960
19:16:03.544 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTP for interface localhost and port 0
19:16:03.544 [XNIO-46 Accept] DEBUG ersatz.xnio.nio - Started channel thread 'XNIO-46 Accept', selector sun.nio.ch.EPollSelectorImpl@50fd554c
19:16:03.545 [Test worker] DEBUG ersatz.undertow - Configuring listener with protocol HTTPS for interface localhost and port 0
19:16:03.551 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.551 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.551 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:40593
19:16:03.552 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Opening connection {}->http://localhost:40593
19:16:03.552 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connecting to localhost/127.0.0.1:40593
19:16:03.553 [Test worker] DEBUG org.apache.http.impl.conn.DefaultHttpClientConnectionOperator - Connection established 127.0.0.1:46788<->127.0.0.1:40593
19:16:03.553 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE /something HTTP/1.1
19:16:03.553 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.553 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.553 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> TRACE /something HTTP/1.1
19:16:03.553 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> Host: localhost:40593
19:16:03.553 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> Connection: Keep-Alive
19:16:03.553 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.553 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> Accept-Encoding: gzip,deflate
19:16:03.553 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "TRACE /something HTTP/1.1[\r][\n]"
19:16:03.553 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "Host: localhost:40593[\r][\n]"
19:16:03.553 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.553 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.553 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.553 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "[\r][\n]"
19:16:03.559 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.559 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Content-Encoding: gzip[\r][\n]"
19:16:03.559 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Connection: keep-alive[\r][\n]"
19:16:03.559 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Content-Type: message/http[\r][\n]"
19:16:03.560 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Content-Length: 165[\r][\n]"
19:16:03.560 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.560 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "[\r][\n]"
19:16:03.560 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8d][0xb1][\n]"
19:16:03.560 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "[0xc2]0[0x14]E[0xf7]@[0xfe]![0xa3][0x82]I[0xda][0xd8][0x82]f[0xb][0xa5]Pt[0x11][0xa9][0xb3][0x84][0xf4][0xd9][0x6]b[0x12][0xec][0xa3][0x83]_o[0xdc].[0xf7][0xdc][0xc3][0x1d][0xef][0xa6][0xeb][0x99]\[0xd3][0x1b]p[0xf1]qf[0xc3]8[0xde]d-jJ[0xba][0x14]#8[0xf4])jv[0x5][0xc8][0xdc][0x4][0xbf][0x1]%[0xc6]9[0xc8][0xc8][0xfb][0xe8][0xd2]T[0xc][0xcd][0xe6][0xaf][0xcf][0x87][0x9]^[0xc1]b[0xc1][0x8f][0x15]>[0xdc][0xcc][0x10]Q3[0x93][0xad][[0x80][0xf][0x88][0xb9][0xb][0xbe]T[0xb2][0x11][0xad]Plw[0xb1][0x9b]-/'Q=[0x95]R{J[0x86][0xb4][0x96]}H[0xce][0x86][0xe5][0x1f][0x9b][0xaa]=[0x1f])[0xa1][0xe4][0x7]C[0xb3][0xa4]j[0xa1][0x0][0x0][0x0]"
19:16:03.560 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << HTTP/1.1 200 OK
19:16:03.560 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Content-Encoding: gzip
19:16:03.560 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Connection: keep-alive
19:16:03.560 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Content-Type: message/http
19:16:03.560 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Content-Length: 165
19:16:03.560 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.560 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.560 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:46788<->127.0.0.1:40593
19:16:03.560 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.562 [Test worker] DEBUG org.apache.http.client.protocol.RequestAddCookies - CookieSpec selected: default
19:16:03.562 [Test worker] DEBUG org.apache.http.client.protocol.RequestAuthCache - Auth cache not set in the context
19:16:03.562 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Get connection for route {}->http://localhost:40593
19:16:03.562 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Executing request TRACE /something HTTP/1.1
19:16:03.562 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Target auth state: UNCHALLENGED
19:16:03.562 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Proxy auth state: UNCHALLENGED
19:16:03.562 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> TRACE /something HTTP/1.1
19:16:03.562 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> Host: localhost:40593
19:16:03.562 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> Connection: Keep-Alive
19:16:03.562 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)
19:16:03.562 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 >> Accept-Encoding: gzip,deflate
19:16:03.562 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "TRACE /something HTTP/1.1[\r][\n]"
19:16:03.562 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "Host: localhost:40593[\r][\n]"
19:16:03.563 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "Connection: Keep-Alive[\r][\n]"
19:16:03.563 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "User-Agent: Apache-HttpClient/4.5.2 (Java/1.8.0_222)[\r][\n]"
19:16:03.563 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "Accept-Encoding: gzip,deflate[\r][\n]"
19:16:03.563 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 >> "[\r][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "HTTP/1.1 200 OK[\r][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Content-Encoding: gzip[\r][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Connection: keep-alive[\r][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Content-Type: message/http[\r][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Content-Length: 165[\r][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "Date: Sun, 11 Aug 2019 00:15:57 GMT[\r][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "[\r][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "[0x1f][0x8b][0x8][0x0][0x0][0x0][0x0][0x0][0x0][0x0][0x15][0x8d][0xb1][\n]"
19:16:03.567 [Test worker] DEBUG org.apache.http.wire - http-outgoing-45 << "[0xc2]0[0x14]E[0xf7]@[0xfe]![0xa3][0x82]I[0xda][0xd8][0x82]f[0xb][0xa5]Pt[0x11][0xa9][0xb3][0x84][0xf4][0xd9][0x6]b[0x12][0xec][0xa3][0x83]_o[0xdc].[0xf7][0xdc][0xc3][0x1d][0xef][0xa6][0xeb][0x99]\[0xd3][0x1b]p[0xf1]qf[0xc3]8[0xde]d-jJ[0xba][0x14]#8[0xf4])jv[0x5][0xc8][0xdc][0x4][0xbf][0x1]%[0xc6]9[0xc8][0xc8][0xfb][0xe8][0xd2]T[0xc][0xcd][0xe6][0xaf][0xcf][0x87][0x9]^[0xc1]b[0xc1][0x8f][0x15]>[0xdc][0xcc][0x10]Q3[0x93][0xad][[0x80][0xf][0x88][0xb9][0xb][0xbe]T[0xb2][0x11][0xad]Plw[0xb1][0x9b]-/'Q=[0x95]R{J[0x86][0xb4][0x96]}H[0xce][0x86][0xe5][0x1f][0x9b][0xaa]=[0x1f])[0xa1][0xe4][0x7]C[0xb3][0xa4]j[0xa1][0x0][0x0][0x0]"
19:16:03.567 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << HTTP/1.1 200 OK
19:16:03.567 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Content-Encoding: gzip
19:16:03.567 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Connection: keep-alive
19:16:03.567 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Content-Type: message/http
19:16:03.567 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Content-Length: 165
19:16:03.567 [Test worker] DEBUG org.apache.http.headers - http-outgoing-45 << Date: Sun, 11 Aug 2019 00:15:57 GMT
19:16:03.568 [Test worker] DEBUG org.apache.http.impl.execchain.MainClientExec - Connection can be kept alive indefinitely
19:16:03.568 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Releasing connection 127.0.0.1:46788<->127.0.0.1:40593
19:16:03.568 [Test worker] DEBUG org.apache.http.impl.conn.BasicHttpClientConnectionManager - Connection can be kept alive indefinitely
19:16:03.568 [Test worker] DEBUG ersatz.undertow - stopping undertow server ersatz.undertow.Undertow@704340ed