2025-04-30 12:29:05,634 Generated random file: mgmwtozwzv of size: 5120
2025-04-30 12:29:05,634 Generated random file: rdpycdanpr of size: 10240
2025-04-30 12:29:05,634 Requests: https://server6:443/mgmwtozwzv https://server6:443/rdpycdanpr
2025-04-30 12:29:05,695 
2025-04-30 12:29:05,695 Command: WAITFORSERVER=server:443 CERTS=/tmp/certs_9hj53lui/ TESTCASE_SERVER=transfer TESTCASE_CLIENT=transfer WWW=/tmp/www_4ow0vldf/ DOWNLOADS=/tmp/download_wyoe4bi0/ SERVER_LOGS=/tmp/logs_server_0gf83pm8 CLIENT_LOGS=/tmp/logs_client_kfbvlear SCENARIO="simple-p2p --delay=15ms --bandwidth=10Mbps --queue=25" CLIENT=litespeedtech/lsquic-qir:latest SERVER=ghcr.io/mozilla/neqo-qns:latest REQUESTS="https://server6:443/mgmwtozwzv https://server6:443/rdpycdanpr"  docker compose --env-file empty.env up --abort-on-container-exit --timeout 1 sim client server 
2025-04-30 12:29:17,719  Container sim  Recreate
 Container sim  Recreated
 Container server  Recreate
 Container client  Recreate
 Container server  Recreated
 Container client  Recreated
Attaching to client, server, sim
sim     | waiting 10s for server:443
server  | Setting up routes...
server  | Actual changes:
server  | tx-checksum-ip-generic: off
server  | tx-tcp-segmentation: off [not requested]
server  | tx-tcp-ecn-segmentation: off [not requested]
server  | tx-tcp-mangleid-segmentation: off [not requested]
server  | tx-tcp6-segmentation: off [not requested]
server  | tx-udp-segmentation: off [not requested]
server  | tx-checksum-sctp: off
server  | Endpoint's IPv4 address is 193.167.100.100
server  | Endpoint's IPv6 address is fd00:cafe:cafe:100::100
server  | + export PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/neqo/bin
server  | + PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/neqo/bin
server  | + '[' -n transfer ']'
server  | + '[' -n /logs/qlog/ ']'
server  | + case "$ROLE" in
server  | + DB=/neqo/db
server  | + CERT=cert
server  | ++ mktemp
server  | + P12CERT=/tmp/tmp.fgRePYxDm3
server  | + mkdir -p /neqo/db
server  | + certutil -N -d sql:/neqo/db --empty-password
client  | Setting up routes...
client  | Actual changes:
client  | tx-checksumming: off
client  | 	tx-checksum-ip-generic: off
client  | 	tx-checksum-sctp: off
client  | tcp-segmentation-offload: off
client  | 	tx-tcp-segmentation: off [requested on]
client  | 	tx-tcp-ecn-segmentation: off [requested on]
client  | 	tx-tcp-mangleid-segmentation: off [requested on]
client  | 	tx-tcp6-segmentation: off [requested on]
client  | tx-udp-segmentation: off [requested on]
client  | Endpoint's IPv4 address is 193.167.0.100
server  | + openssl pkcs12 -export -nodes -in /certs/cert.pem -inkey /certs/priv.key -name cert -passout pass: -out /tmp/tmp.fgRePYxDm3
client  | Endpoint's IPv6 address is fd00:cafe:cafe::100
server  | Warning: output encryption option -nodes ignored with -export
server  | + pk12util -d sql:/neqo/db -i /tmp/tmp.fgRePYxDm3 -W ''
client  | wait-for-it.sh: waiting 30 seconds for sim:57832
server  | pk12util: PKCS12 IMPORT SUCCESSFUL
server  | + certutil -L -d sql:/neqo/db -n cert
server  | Certificate:
server  |     Data:
server  |         Version: 3 (0x2)
server  |         Serial Number:
server  |             34:ae:35:8f:73:ff:59:61:a6:0c:f8:4c:94:0f:7e:9c:
server  |             ac:fe:80:27
server  |         Signature Algorithm: X9.62 ECDSA signature with SHA256
server  |         Issuer: "O=interop runner Root Certificate Authority"
server  |         Validity:
server  |             Not Before: Wed Apr 30 12:29:05 2025
server  |             Not After : Sat May 10 12:29:05 2025
server  |         Subject: "O=interop runner leaf"
server  |         Subject Public Key Info:
server  |             Public Key Algorithm: X9.62 elliptic curve public key
server  |                 Args:
server  |                     06:08:2a:86:48:ce:3d:03:01:07
server  |             EC Public Key:
server  |                 PublicValue:
server  |                     04:ff:29:7e:87:85:f1:01:5a:05:97:43:ad:0f:06:5f:
server  |                     f0:b0:82:f1:cf:6a:a9:6b:80:bd:b4:72:e3:ae:69:ef:
server  |                     a2:5f:d1:87:91:bd:9f:16:1e:4d:54:9f:ee:6c:4c:2f:
server  |                     a6:7c:5a:9c:55:0a:08:df:e3:24:02:d5:13:dd:5a:f3:
server  |                     40
server  |                 Curve: ANSI X9.62 elliptic curve prime256v1 (aka secp256r1, NIST P-256)
server  |         Signed Extensions:
server  |             Name: Certificate Subject Alt Name
server  |             DNS name: "server"
server  |             DNS name: "server4"
server  |             DNS name: "server6"
server  |             DNS name: "server46"
server  | 
server  |             Name: Certificate Subject Key ID
server  |             Data:
server  |                 0a:3b:4b:72:e8:94:8e:29:e7:11:52:81:1a:ed:e7:30:
server  |                 c8:26:10:c9
server  | 
server  |             Name: Certificate Authority Key Identifier
server  |             Key ID:
server  |                 8a:87:2b:34:c6:64:d3:b1:4c:54:25:45:d6:74:46:bc:
server  |                 47:7b:f6:0a
server  | 
server  |     Signature Algorithm: X9.62 ECDSA signature with SHA256
server  |     Signature:
server  |         30:46:02:21:00:a2:f3:f7:de:2c:8a:2e:98:09:29:7a:
server  |         d1:31:9d:b1:ab:22:d8:74:9f:31:34:cb:7c:a1:31:64:
server  |         6c:86:fe:ad:6d:02:21:00:b3:f4:43:eb:96:cf:41:ec:
server  |         4b:a6:0b:d5:a7:83:fe:dc:d5:8d:41:18:db:1d:2d:3f:
server  |         8d:03:58:42:63:3c:58:05
server  |     Fingerprint (SHA-256):
server  |         D6:5B:6A:AA:BF:35:89:84:A0:6D:DF:5B:C3:B5:EE:5E:59:19:5A:0A:67:1A:D4:44:69:00:A5:40:57:9C:AA:81
server  |     Fingerprint (SHA1):
server  |         FC:9C:7C:AA:07:E5:5D:48:29:B2:51:20:AD:D4:11:4E:E4:C4:09:2B
server  | 
server  |     Mozilla-CA-Policy: false (attribute missing)
server  |     Certificate Trust Flags:
server  |         SSL Flags:
server  |             User
server  |         Email Flags:
server  |             User
server  |         Object Signing Flags:
server  |             User
server  | 
server  | + OPTIONS=(--cc cubic --qns-test "$TESTCASE" --qlog-dir "$QLOGDIR" -d "$DB" -k "$CERT")
server  | + '[' transfer = connectionmigration ']'
server  | + RUST_LOG=debug
server  | + RUST_BACKTRACE=1
server  | + neqo-server --cc cubic --qns-test transfer --qlog-dir /logs/qlog/ -d /neqo/db -k cert '[::]:443'
server  | ++ tee -i -a /logs/server.log
server  | 0.000 DEBUG Logging initialized
server  | 0.002 DEBUG Default socket send buffer size is 212992
server  | 0.002 DEBUG Default socket receive buffer size is 1048576, not changing
server  | 0.002 INFO Server waiting for connection on: [::]:443
server  | 0.806 DEBUG [Server] Unsupported version: 57414954
server  | 0.806 DEBUG [Server] type=VersionNegotiation path: [::]:443->[::ffff:193.167.100.2]:52658 IpTos(Cs0, NotEct) len 15
sim     | server:443 is available after 1.03969594s
server  | 0.807 DEBUG [Server] Unsupported version: 57414954
server  | 0.807 DEBUG [Server] type=VersionNegotiation path: [::]:443->[::ffff:193.167.100.2]:52658 IpTos(Cs0, NotEct) len 15
server  | 0.807 ERROR failed to create NeqoQlog: IoError(Os { code: 17, kind: AlreadyExists, message: "File exists" })
server  | 0.807 DEBUG [Server] Unsupported version: 57414954
server  | 0.807 DEBUG [Server] type=VersionNegotiation path: [::]:443->[::ffff:193.167.100.2]:52658 IpTos(Cs0, NotEct) len 15
server  | 0.807 ERROR failed to create NeqoQlog: IoError(Os { code: 17, kind: AlreadyExists, message: "File exists" })
sim     | Using scenario: simple-p2p --delay=15ms --bandwidth=10Mbps --queue=25
sim     | tcpdump: listening on eth1, link-type EN10MB (Ethernet), snapshot length 262144 bytes
sim     | tcpdump: listening on eth0, link-type EN10MB (Ethernet), snapshot length 262144 bytes
client  | wait-for-it.sh: sim:57832 is available after 1 seconds
client  | TEST_PARAMS:
client  | REQUESTS: 'https://server6:443/mgmwtozwzv https://server6:443/rdpycdanpr'
client  | paths: -p /mgmwtozwzv -p /rdpycdanpr
client  | server: server6
client  | port: 443
client  | CLIENT_PARAMS:
server  | 1.018 DEBUG [Server] Handle initial
server  | 1.018 INFO AddressValidation: no token; accepting
server  | 1.018 INFO [Server] Accept connection CID [19]: a25da82dab548073396991242bfbb454d36a71
server  | 1.018 DEBUG Overwrite initial version Version1 ==> Version1
server  | 1.019 DEBUG Outbound interface eth0 for destination fd00:cafe:cafe::100 has MTU 1500
server  | 1.019 INFO [Server ...] Received valid Initial packet with scid CID [8]: 2e8164f07032415d dcid CID [19]: a25da82dab548073396991242bfbb454d36a71
server  | 1.019 DEBUG [CryptoStates] Creating initial cipher state v=Version1, role=Server dcid=a25da82dab548073396991242bfbb454d36a71
server  | 1.019 DEBUG Making Write Initial CryptoDxState, v=Version1 cipher=4865
server  | 1.019 DEBUG Making Read Initial CryptoDxState, v=Version1 cipher=4865
server  | 1.019 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] State change from Init -> WaitInitial
server  | 1.019 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=0 type=Initial unv-path [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 1200
server  |   -> RX Crypto { offset: 0, len: 248 }
server  |   -> RX Padding { len: 894 }
server  | 1.019 DEBUG Read Ok(248) bytes
server  | 1.019 DEBUG 0-RTT: no token, no 0-RTT
server  | 1.020 DEBUG Read secret available for Handshake: SymKey [32]: 2425e760c1454f022dd1d520e11165ac78a78ef2105726a133c238a317f1a9a6
server  | 1.020 DEBUG Write secret available for Handshake: SymKey [32]: 9d22ee7896f337412da9bdccdd2ea63939f0c3b2c18886b6e462bcd6caff931f
server  | 1.020 DEBUG Writing transport parameters, msg=8
server  | 1.020 DEBUG Read secret available for ApplicationData: SymKey [32]: 23d94a6ef9da9c7c1ac16fbedafc24bb6362801c4947c09668ec0eb74e817f30
server  | 1.020 DEBUG Write secret available for ApplicationData: SymKey [32]: bccc1873b9ddc1bc562dd15ce0ccd71bb16f9acb9d1ad95e65a14a8a975dcf6c
server  | 1.020 DEBUG [Agent 0x5581594e01d0] state -> InProgress
server  | 1.020 DEBUG Making Write Handshake CryptoDxState, v=Version1 cipher=4865
server  | 1.020 DEBUG Making Read Handshake CryptoDxState, v=Version1 cipher=4865
server  | 1.020 DEBUG [Crypto] Handshake keys installed
server  | 1.020 DEBUG Making Write ApplicationData CryptoDxState, v=Version1 cipher=4865
server  | 1.021 DEBUG [Crypto] Application write key installed
server  | 1.021 DEBUG [Recvd-in] Set ACK timer to Instant { tv_sec: 615, tv_nsec: 596618991 }
server  | 1.021 DEBUG [unv-path [::]:443->[fd00:cafe:cafe::100]:60971] Make permanent
server  | 1.021 DEBUG [unv-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971] set as primary path
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] State change from WaitInitial -> Handshaking
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.021 DEBUG Building Initial dcid Some(CID [8]: 2e8164f07032415d) scid Some(CID [10]: 6873d003f6ad09c5534c)
server  | 1.021 DEBUG CRYPTO for in offset=0, len=90
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=0 type=Initial pri-unv-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 147
server  |   TX -> Ack { largest_acknowledged: 0, ack_delay: 0, first_ack_range: 0, ack_ranges: [], ecn_count: Some(Count({NotEct: 0, Ect1: 1, Ect0: 0, Ce: 0})) }
server  |   TX -> Crypto { offset: 0, len: 90 }
server  | 1.021 DEBUG Building Handshake dcid Some(CID [8]: 2e8164f07032415d) scid Some(CID [10]: 6873d003f6ad09c5534c)
server  | 1.021 DEBUG CRYPTO for hs offset=0, len=735
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=0 type=Handshake pri-unv-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 930
server  |   TX -> Crypto { offset: 0, len: 735 }
server  | 1.021 DEBUG packet_sent this=0x5581594dfb40, pn=0, ps=783
server  | 1.021 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pad Initial from 930 to PLPMTU 1232
server  | 1.021 DEBUG packet_sent this=0x5581594dfb40, pn=0, ps=449
server  | 1.021 DEBUG ECN probing: sent 1 probes
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.021 DEBUG Building Initial dcid Some(CID [8]: 2e8164f07032415d) scid Some(CID [10]: 6873d003f6ad09c5534c)
server  | 1.021 DEBUG Building Handshake dcid Some(CID [8]: 2e8164f07032415d) scid Some(CID [10]: 6873d003f6ad09c5534c)
server  | 1.021 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.021 DEBUG TX blocked, profile=SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 297.111198ms
server  | 1.021 DEBUG Setting timeout of 297.111198ms
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.021 DEBUG Building Initial dcid Some(CID [8]: 2e8164f07032415d) scid Some(CID [10]: 6873d003f6ad09c5534c)
server  | 1.021 DEBUG Building Handshake dcid Some(CID [8]: 2e8164f07032415d) scid Some(CID [10]: 6873d003f6ad09c5534c)
server  | 1.021 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.021 DEBUG TX blocked, profile=SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.021 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 297.081182ms
server  | 1.021 DEBUG Setting timeout of 297.081182ms
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=1 type=Initial pri-unv-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 1035
server  |   -> RX Ack { largest_acknowledged: 0, ack_delay: 179, first_ack_range: 0, ack_ranges: [], ecn_count: None }
server  |   -> RX Padding { len: 983 }
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=in, ranges=[0..=0]
server  | 1.055 DEBUG [LossRecovery] ACK for Initial - largest_acked=0
server  | 1.055 DEBUG on_packets_acked this=0x5581594dfb40, limited=1, bytes_in_flight=783, cwnd=12320, state=SlowStart, new_acked=449
server  | 1.055 DEBUG Acked crypto frame space=in offset=0 length=90
server  | 1.055 DEBUG [pri-unv-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971] Path validated Instant { tv_sec: 615, tv_nsec: 633596439 }
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Drop packet number space in
server  | 1.055 DEBUG [LossRecovery] Reset loss recovery state for Initial
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=2 type=Handshake pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 89
server  |   -> RX Ack { largest_acknowledged: 0, ack_delay: 92, first_ack_range: 0, ack_ranges: [], ecn_count: None }
server  |   -> RX Crypto { offset: 0, len: 36 }
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=hs, ranges=[0..=0]
server  | 1.055 DEBUG [LossRecovery] ACK for Handshake - largest_acked=0
server  | 1.055 DEBUG on_packets_acked this=0x5581594dfb40, limited=1, bytes_in_flight=0, cwnd=12320, state=SlowStart, new_acked=783
server  | 1.055 DEBUG Acked crypto frame space=hs offset=0 length=735
server  | 1.055 DEBUG Read Ok(36) bytes
server  | 1.055 DEBUG [Agent 0x5581594e01d0] state -> Complete(SecretAgentInfo { version: 772, cipher: 4865, group: 29, resumed: false, early_data: false, ech_accepted: false, alpn: Some("hq-interop"), signature_scheme: 1027 })
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] TLS connection complete
server  | 1.055 DEBUG [pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971] Path validated Instant { tv_sec: 615, tv_nsec: 633596439 }
server  | 1.055 DEBUG Making Read ApplicationData CryptoDxState, v=Version1 cipher=4865
server  | 1.055 DEBUG [Crypto] application read keys installed
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] State change from Handshaking -> Connected
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] State change from Connected -> Confirmed
server  | 1.055 DEBUG PMTUD started with probe size 1380
server  | 1.055 INFO [Server a25da82dab548073396991242bfbb454d36a71] Connection established
server  | 1.055 DEBUG [Recvd-hs] Set ACK timer to Instant { tv_sec: 615, tv_nsec: 633596439 }
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=3 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 76
server  |   -> RX NewConnectionId { sequence_number: 1, retire_prior: 0, connection_id: [211, 123, 58, 183, 179, 94, 1, 14], stateless_reset_token: [250, 192, 99, 72, 9, 15, 224, 39, 180, 176, 205, 60, 102, 118, 69, 5] }
server  |   -> RX Stream { stream_id: 0, offset: 0, len: 17, fin: true }
server  | 1.055 DEBUG [Recvd-ap] Set ACK timer to Instant { tv_sec: 615, tv_nsec: 633596439 }
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.055 DEBUG Building Handshake dcid Some(CID [8]: 2e8164f07032415d) scid Some(CID [10]: 6873d003f6ad09c5534c)
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=1 type=Handshake pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 52
server  |   TX -> Ack { largest_acknowledged: 2, ack_delay: 0, first_ack_range: 0, ack_ranges: [], ecn_count: Some(Count({NotEct: 0, Ect1: 1, Ect0: 0, Ce: 0})) }
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Drop packet number space hs
server  | 1.055 DEBUG [LossRecovery] Reset loss recovery state for Handshake
server  | 1.055 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=0 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 1332
server  |   TX -> Ack { largest_acknowledged: 3, ack_delay: 0, first_ack_range: 0, ack_ranges: [], ecn_count: Some(Count({NotEct: 0, Ect1: 1, Ect0: 0, Ce: 0})) }
server  |   TX -> HandshakeDone
server  |   TX -> NewConnectionId { sequence_number: 1, retire_prior: 0, connection_id: [166, 200, 21, 234, 203, 23, 39, 94, 144, 80], stateless_reset_token: [122, 9, 190, 168, 210, 66, 36, 106, 231, 250, 194, 110, 70, 13, 57, 52] }
server  |   TX -> NewConnectionId { sequence_number: 2, retire_prior: 0, connection_id: [115, 88, 66, 93, 15, 59, 98, 165, 146, 128], stateless_reset_token: [128, 50, 65, 108, 156, 75, 81, 66, 62, 218, 16, 85, 210, 179, 129, 190] }
server  |   TX -> NewConnectionId { sequence_number: 3, retire_prior: 0, connection_id: [187, 195, 60, 11, 147, 105, 47, 97, 131, 10], stateless_reset_token: [117, 182, 116, 84, 6, 181, 88, 165, 11, 48, 156, 86, 239, 13, 84, 232] }
server  |   TX -> NewConnectionId { sequence_number: 4, retire_prior: 0, connection_id: [79, 208, 146, 96, 164, 233, 83, 232, 91, 52], stateless_reset_token: [116, 111, 163, 166, 157, 142, 240, 218, 5, 166, 121, 171, 184, 238, 132, 160] }
server  |   TX -> NewConnectionId { sequence_number: 5, retire_prior: 0, connection_id: [1, 238, 169, 112, 114, 146, 71, 204, 27, 24], stateless_reset_token: [205, 73, 159, 105, 199, 28, 144, 202, 187, 224, 102, 56, 241, 130, 70, 34] }
server  |   TX -> NewConnectionId { sequence_number: 6, retire_prior: 0, connection_id: [80, 84, 81, 243, 126, 214, 14, 254, 29, 69], stateless_reset_token: [209, 253, 187, 134, 153, 236, 175, 170, 52, 14, 89, 251, 123, 216, 33, 163] }
server  |   TX -> NewConnectionId { sequence_number: 7, retire_prior: 0, connection_id: [242, 248, 235, 25, 34, 101, 201, 55, 64, 67], stateless_reset_token: [244, 16, 215, 48, 115, 224, 28, 108, 169, 43, 63, 24, 168, 62, 1, 203] }
server  |   TX -> AckFrequency { seqno: 0, tolerance: 2, delay: 10000, ignore_order: false }
server  |   TX -> Padding { len: 1028 }
server  | 1.055 DEBUG packet_sent this=0x5581594dfb40, pn=0, ps=1280
server  | 1.055 DEBUG ECN probing: sent 2 probes
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.055 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.055 DEBUG Sending PMTUD probe of size 1380, count 1
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=1 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 1332
server  |   TX -> Ping
server  |   TX -> Padding { len: 1305 }
server  | 1.055 DEBUG packet_sent this=0x5581594dfb40, pn=1, ps=1332
server  | 1.055 DEBUG ECN probing: sent 3 probes
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.055 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.055 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.055 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 1.419585ms
server  | 1.055 DEBUG Setting timeout of 1.419585ms
server  | 1.056 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] send session ticket 406e0013a25da82dab548073396991242bfbb454d36a710104800075300408ffffffffffffffff0504801000000604801000000704801000000801100901100b01140e01080f0a6873d003f6ad09c5534c110c00000001cafada7a000000016ab200c0000000ff02de1a0243e8200100686921
server  | 1.056 DEBUG Path = 'mgmwtozwzv'
server  | 1.056 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.056 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.056 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.056 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 426.441µs
server  | 1.056 DEBUG Setting timeout of 426.441µs
server  | 1.057 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.057 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.057 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=2 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 1232
server  |   TX -> Stream { stream_id: 0, offset: 0, len: >>1204, fin: false }
server  | 1.058 DEBUG packet_sent this=0x5581594dfb40, pn=2, ps=1232
server  | 1.058 DEBUG ECN probing: sent 4 probes
server  | 1.058 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.058 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.058 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.058 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 1.093379ms
server  | 1.058 DEBUG Setting timeout of 1.093379ms
server  | 1.058 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.058 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.058 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.058 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 1.059719ms
server  | 1.058 DEBUG Setting timeout of 1.059719ms
server  | 1.060 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.060 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.060 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=3 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 1232
server  |   TX -> Stream { stream_id: 0, offset: 1204, len: >>1202, fin: false }
server  | 1.060 DEBUG packet_sent this=0x5581594dfb40, pn=3, ps=1232
server  | 1.060 DEBUG ECN probing: sent 5 probes
server  | 1.060 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.060 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.060 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=4 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 1232
server  |   TX -> Stream { stream_id: 0, offset: 2406, len: >>1202, fin: false }
server  | 1.060 DEBUG packet_sent this=0x5581594dfb40, pn=4, ps=1232
server  | 1.060 DEBUG ECN probing: sent 6 probes
server  | 1.060 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.060 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.060 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.060 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 1.768301ms
server  | 1.060 DEBUG Setting timeout of 1.768301ms
server  | 1.060 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.060 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.060 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.060 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 1.742873ms
server  | 1.060 DEBUG Setting timeout of 1.742873ms
server  | 1.063 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.063 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.063 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=5 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 1232
server  |   TX -> Stream { stream_id: 0, offset: 3608, len: >>1202, fin: false }
server  | 1.063 DEBUG packet_sent this=0x5581594dfb40, pn=5, ps=1232
server  | 1.063 DEBUG ECN probing: sent 7 probes
server  | 1.063 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.063 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.063 DEBUG CRYPTO for ap offset=0, len=321
server  | 1.063 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=6 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 712
server  |   TX -> Stream { stream_id: 0, offset: 4810, len: 310, fin: true }
server  |   TX -> Crypto { offset: 0, len: 321 }
server  |   TX -> NewToken { token: [173, 154, 139, 141, 134, 1, 0, 74, 30, 181, 235, 60, 151, 43, 7, 39, 139, 100, 116, 186, 72, 205, 40, 128, 253, 134, 211, 26, 0, 162, 149, 70, 51, 27, 192, 32, 55, 52, 196, 14, 152, 241, 58] }
server  | 1.063 DEBUG packet_sent this=0x5581594dfb40, pn=6, ps=712
server  | 1.063 DEBUG ECN probing: sent 8 probes
server  | 1.063 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.063 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.063 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.063 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 1.415069ms
server  | 1.063 DEBUG Setting timeout of 1.415069ms
server  | 1.063 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.063 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.063 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.063 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 1.39455ms
server  | 1.063 DEBUG Setting timeout of 1.39455ms
server  | 1.066 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.066 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.066 DEBUG TX blocked, profile=SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.066 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 114.226172ms
server  | 1.066 DEBUG Setting timeout of 114.226172ms
server  | 1.066 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.066 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.066 DEBUG TX blocked, profile=SendProfile { limit: 1232, pto: None, probe: EnumSet(), paced: false }
server  | 1.066 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 114.202838ms
server  | 1.066 DEBUG Setting timeout of 114.202838ms
server  | 1.088 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=4 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 34
server  |   -> RX Ack { largest_acknowledged: 1, ack_delay: 4, first_ack_range: 1, ack_ranges: [], ecn_count: None }
server  | 1.088 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[0..=1]
server  | 1.088 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=1
server  | 1.088 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 5640/14932 ssthresh 18446744073709551615] slow start += 2612
server  | 1.088 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 5640/14932 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=5640, cwnd=14932, state=SlowStart, new_acked=2612
server  | 1.088 DEBUG PMTUD probe of size 1380 succeeded
server  | 1.088 DEBUG PMTUD started with probe size 1420
server  | 1.088 DEBUG PLPMTU changed from 1232 to 1332, updating pacer
server  | 1.088 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.088 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.088 DEBUG Sending PMTUD probe of size 1420, count 1
server  | 1.088 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=7 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 1372
server  |   TX -> Ping
server  |   TX -> Padding { len: 1345 }
server  | 1.088 DEBUG packet_sent this=0x5581594dfb40, pn=7, ps=1372
server  | 1.088 DEBUG ECN probing: sent 9 probes
server  | 1.088 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.088 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.088 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.088 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 92.033574ms
server  | 1.088 DEBUG Setting timeout of 92.033574ms
server  | 1.088 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.088 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.088 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.088 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 92.004129ms
server  | 1.088 DEBUG Setting timeout of 92.004129ms
server  | 1.091 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=5 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 34
server  |   -> RX Ack { largest_acknowledged: 3, ack_delay: 6, first_ack_range: 3, ack_ranges: [], ecn_count: None }
server  | 1.091 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[0..=3]
server  | 1.091 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=3
server  | 1.091 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 4548/17396 ssthresh 18446744073709551615] slow start += 2464
server  | 1.091 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 4548/17396 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=4548, cwnd=17396, state=SlowStart, new_acked=2464
server  | 1.091 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.091 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.091 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.091 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 81.903935ms
server  | 1.091 DEBUG Setting timeout of 81.903935ms
server  | 1.091 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.091 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.091 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.091 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 81.840547ms
server  | 1.091 DEBUG Setting timeout of 81.840547ms
server  | 1.095 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=6 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 34
server  |   -> RX Ack { largest_acknowledged: 5, ack_delay: 8, first_ack_range: 5, ack_ranges: [], ecn_count: None }
server  | 1.095 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[0..=5]
server  | 1.095 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=5
server  | 1.095 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 2084/19860 ssthresh 18446744073709551615] slow start += 2464
server  | 1.095 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 2084/19860 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=2084, cwnd=19860, state=SlowStart, new_acked=2464
server  | 1.095 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.095 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.095 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.095 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 72.291282ms
server  | 1.095 DEBUG Setting timeout of 72.291282ms
server  | 1.095 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.095 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.095 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.095 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 72.247039ms
server  | 1.095 DEBUG Setting timeout of 72.247039ms
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=7 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 54
server  |   -> RX Ack { largest_acknowledged: 6, ack_delay: 10, first_ack_range: 6, ack_ranges: [], ecn_count: None }
server  |   -> RX Stream { stream_id: 4, offset: 0, len: 17, fin: true }
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[0..=6]
server  | 1.096 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=6
server  | 1.096 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 1372/20572 ssthresh 18446744073709551615] slow start += 712
server  | 1.096 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 1372/20572 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=1372, cwnd=20572, state=SlowStart, new_acked=712
server  | 1.096 DEBUG Acked crypto frame space=ap offset=0 length=321
server  | 1.096 DEBUG [Recvd-ap] Set ACK timer to Instant { tv_sec: 615, tv_nsec: 694435047 }
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.096 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=8 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect0) len 36
server  |   TX -> Ack { largest_acknowledged: 7, ack_delay: 0, first_ack_range: 4, ack_ranges: [], ecn_count: Some(Count({NotEct: 0, Ect1: 5, Ect0: 0, Ce: 0})) }
server  |   TX -> MaxStreams { stream_type: BiDi, maximum_streams: 17 }
server  | 1.096 DEBUG packet_sent this=0x5581594dfb40, pn=8, ps=36
server  | 1.096 DEBUG ECN probing: sent 10 probes
server  | 1.096 DEBUG ECN probing concluded with 10 probes sent
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.096 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.096 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 72.902104ms
server  | 1.096 DEBUG Setting timeout of 72.902104ms
server  | 1.096 DEBUG Path = 'rdpycdanpr'
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.096 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=9 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1332
server  |   TX -> Stream { stream_id: 4, offset: 0, len: >>1304, fin: false }
server  | 1.096 DEBUG packet_sent this=0x5581594dfb40, pn=9, ps=1332
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.096 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=10 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1332
server  |   TX -> Stream { stream_id: 4, offset: 1304, len: >>1302, fin: false }
server  | 1.096 DEBUG packet_sent this=0x5581594dfb40, pn=10, ps=1332
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.096 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.096 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.096 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 948.104µs
server  | 1.096 DEBUG Setting timeout of 948.104µs
server  | 1.098 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.098 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.098 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=11 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1332
server  |   TX -> Stream { stream_id: 4, offset: 2606, len: >>1302, fin: false }
server  | 1.098 DEBUG packet_sent this=0x5581594dfb40, pn=11, ps=1332
server  | 1.098 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.098 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.098 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=12 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1332
server  |   TX -> Stream { stream_id: 4, offset: 3908, len: >>1302, fin: false }
server  | 1.098 DEBUG packet_sent this=0x5581594dfb40, pn=12, ps=1332
server  | 1.098 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.098 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.098 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.098 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 983.784µs
server  | 1.098 DEBUG Setting timeout of 983.784µs
server  | 1.098 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.098 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.098 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.098 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 961.862µs
server  | 1.098 DEBUG Setting timeout of 961.862µs
server  | 1.100 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.100 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.100 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=13 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1332
server  |   TX -> Stream { stream_id: 4, offset: 5210, len: >>1302, fin: false }
server  | 1.100 DEBUG packet_sent this=0x5581594dfb40, pn=13, ps=1332
server  | 1.100 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.100 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.100 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=14 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1332
server  |   TX -> Stream { stream_id: 4, offset: 6512, len: >>1302, fin: false }
server  | 1.100 DEBUG packet_sent this=0x5581594dfb40, pn=14, ps=1332
server  | 1.100 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.100 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.100 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.100 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 999.673µs
server  | 1.100 DEBUG Setting timeout of 999.673µs
server  | 1.101 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.101 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.101 DEBUG TX blocked, profile=SendProfile { limit: 255, pto: None, probe: EnumSet(), paced: true }
server  | 1.101 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 903.833µs
server  | 1.101 DEBUG Setting timeout of 903.833µs
server  | 1.103 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.103 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.103 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=15 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1332
server  |   TX -> Stream { stream_id: 4, offset: 7814, len: >>1302, fin: false }
server  | 1.103 DEBUG packet_sent this=0x5581594dfb40, pn=15, ps=1332
server  | 1.103 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.103 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.103 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=16 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1156
server  |   TX -> Stream { stream_id: 4, offset: 9116, len: 1124, fin: true }
server  | 1.103 DEBUG packet_sent this=0x5581594dfb40, pn=16, ps=1156
server  | 1.103 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.103 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.103 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.103 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 72.95371ms
server  | 1.103 DEBUG Setting timeout of 72.95371ms
server  | 1.103 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.103 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.103 DEBUG TX blocked, profile=SendProfile { limit: 1332, pto: None, probe: EnumSet(), paced: false }
server  | 1.103 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 72.933312ms
server  | 1.103 DEBUG Setting timeout of 72.933312ms
client  | /logs/2E8164F07032415D.keys
client  | /logs/keys.log exists
server  | 1.126 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=8 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 34
server  |   -> RX Ack { largest_acknowledged: 8, ack_delay: 6, first_ack_range: 1, ack_ranges: [], ecn_count: None }
server  | 1.126 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[7..=8]
server  | 1.126 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=8
server  | 1.126 WARN ECN validation failed, no ECN counts in ACK frame
server  | 1.126 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 10480/21980 ssthresh 18446744073709551615] slow start += 1408
server  | 1.126 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 10480/21980 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=10480, cwnd=21980, state=SlowStart, new_acked=1408
server  | 1.126 DEBUG PMTUD probe of size 1420 succeeded
server  | 1.126 DEBUG PMTUD started with probe size 1470
server  | 1.126 DEBUG PLPMTU changed from 1332 to 1372, updating pacer
server  | 1.126 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.126 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.126 DEBUG Sending PMTUD probe of size 1470, count 1
server  | 1.126 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=17 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 1422
server  |   TX -> Ping
server  |   TX -> Padding { len: 1395 }
server  | 1.126 DEBUG packet_sent this=0x5581594dfb40, pn=17, ps=1422
server  | 1.127 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.127 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.127 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.127 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 69.465069ms
server  | 1.127 DEBUG Setting timeout of 69.465069ms
server  | 1.127 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.127 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.127 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.127 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 69.373086ms
server  | 1.127 DEBUG Setting timeout of 69.373086ms
server  | 1.129 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=9 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 34
server  |   -> RX Ack { largest_acknowledged: 10, ack_delay: 5, first_ack_range: 3, ack_ranges: [], ecn_count: None }
server  | 1.129 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[7..=10]
server  | 1.129 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=10
server  | 1.129 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 9238/24644 ssthresh 18446744073709551615] slow start += 2664
server  | 1.129 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 9238/24644 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=9238, cwnd=24644, state=SlowStart, new_acked=2664
server  | 1.129 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.129 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.129 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.129 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 62.67135ms
server  | 1.129 DEBUG Setting timeout of 62.67135ms
server  | 1.129 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.129 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.129 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.129 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 62.617148ms
server  | 1.129 DEBUG Setting timeout of 62.617148ms
server  | 1.131 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=10 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 34
server  |   -> RX Ack { largest_acknowledged: 12, ack_delay: 5, first_ack_range: 5, ack_ranges: [], ecn_count: None }
server  | 1.131 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[7..=12]
server  | 1.131 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=12
server  | 1.131 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 6574/27308 ssthresh 18446744073709551615] slow start += 2664
server  | 1.131 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 6574/27308 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=6574, cwnd=27308, state=SlowStart, new_acked=2664
server  | 1.131 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.131 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.131 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.131 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 56.615106ms
server  | 1.131 DEBUG Setting timeout of 56.615106ms
server  | 1.131 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.131 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.131 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.131 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 56.480814ms
server  | 1.131 DEBUG Setting timeout of 56.480814ms
server  | 1.133 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=11 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 34
server  |   -> RX Ack { largest_acknowledged: 14, ack_delay: 6, first_ack_range: 7, ack_ranges: [], ecn_count: None }
server  | 1.133 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[7..=14]
server  | 1.133 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=14
server  | 1.133 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 3910/29972 ssthresh 18446744073709551615] slow start += 2664
server  | 1.133 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 3910/29972 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=3910, cwnd=29972, state=SlowStart, new_acked=2664
server  | 1.133 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.133 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.133 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.133 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 51.359487ms
server  | 1.133 DEBUG Setting timeout of 51.359487ms
server  | 1.133 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.133 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.133 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.133 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 51.284857ms
server  | 1.133 DEBUG Setting timeout of 51.284857ms
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=12 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 34
server  |   -> RX Ack { largest_acknowledged: 16, ack_delay: 6, first_ack_range: 9, ack_ranges: [], ecn_count: None }
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] Rx ACK space=ap, ranges=[7..=16]
server  | 1.135 DEBUG [LossRecovery] ACK for ApplicationData - largest_acked=16
server  | 1.135 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 1422/32460 ssthresh 18446744073709551615] slow start += 2488
server  | 1.135 DEBUG [Cubic [last_max_cwnd: 0, k: 0, w_max: 0, ca_epoch_start: None] CongCtrl 1422/32460 ssthresh 18446744073709551615] on_packets_acked this=0x5581594dfb40, limited=0, bytes_in_flight=1422, cwnd=32460, state=SlowStart, new_acked=2488
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.135 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=18 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 28
server  |   TX -> MaxStreams { stream_type: BiDi, maximum_streams: 18 }
server  | 1.135 DEBUG packet_sent this=0x5581594dfb40, pn=18, ps=29
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.135 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.135 DEBUG TX blocked, profile=SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] delay duration 55.564852ms
server  | 1.135 DEBUG Setting timeout of 55.564852ms
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=13 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, Ect1) len 32
server  |   -> RX ConnectionClose { error_code: Transport(0), frame_type: 0, reason_phrase: "" }
server  | 1.135 INFO [Server a25da82dab548073396991242bfbb454d36a71] ConnectionClose received. Error code: Transport(0) frame type 0 reason 
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] State change from Confirmed -> Draining { error: Transport(PeerError(0)), timeout: Instant { tv_sec: 615, tv_nsec: 881193585 } }
server  | 1.135 DEBUG [pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971] Path validated Instant { tv_sec: 615, tv_nsec: 714210939 }
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] output_path send_profile SendProfile { limit: 1372, pto: None, probe: EnumSet(), paced: false }
server  | 1.135 DEBUG Building Short dcid Some(CID [8]: 2e8164f07032415d)
server  | 1.135 DEBUG [Recvd-ap] immediate_ack at Instant { tv_sec: 615, tv_nsec: 714210939 }
server  | 1.135 DEBUG [Server a25da82dab548073396991242bfbb454d36a71] pn=19 type=Short pri-path:2e8164f07032415d [::]:443->[fd00:cafe:cafe::100]:60971 IpTos(Cs0, NotEct) len 38
server  |   TX -> Ack { largest_acknowledged: 13, ack_delay: 0, first_ack_range: 10, ack_ranges: [], ecn_count: Some(Count({NotEct: 0, Ect1: 11, Ect0: 0, Ce: 0})) }
server  |   TX -> ConnectionClose { error_code: Transport(0), frame_type: 28, reason_phrase: "" }
server  | 1.135 DEBUG Setting timeout of 166.88362ms
server  | 1.135 DEBUG Setting timeout of 166.876607ms

client exited with code 0
Aborting on container exit...
 Container server  Stopping
 Container client  Stopping
 Container client  Stopped
 Container server  Stopped
 Container sim  Stopping
 Container sim  Stopped

2025-04-30 12:29:17,821 Using the client's key log file.
2025-04-30 12:29:17,831 
2025-04-30 12:29:17,832 Using the client's key log file.
2025-04-30 12:29:17,832 Using the client's key log file.
2025-04-30 12:29:17,840 
2025-04-30 12:29:17,841 Using the client's key log file.
2025-04-30 12:29:18,404 Check of downloaded files succeeded.
2025-04-30 12:29:18,970 Check of downloaded files succeeded.