2025/04/30 10:11:18 Requesting https://server6:443/uqjnzbjzuf.
2025/04/30 10:11:18 Requesting https://server6:443/oqpfmokffo.
2025/04/30 10:11:18 Increased receive buffer size to 14336 kiB
2025/04/30 10:11:18 Increased send buffer size to 14336 kiB
2025/04/30 10:11:18 Setting DF for IPv4 and IPv6.
2025/04/30 10:11:18 Activating reading of ECN bits for IPv4 and IPv6.
2025/04/30 10:11:18 Activating reading of packet info for IPv4 and IPv6.
2025/04/30 10:11:18 Created qlog file: /logs/qlog/5424443d7383fbf345290ec41195eeb4.sqlog
2025/04/30 10:11:18 client Starting new connection to server6 ([::]:37170 -> [fd00:cafe:cafe:100::100]:443), source connection ID (empty), destination connection ID 5424443d7383fbf345290ec41195eeb4, version v1
2025/04/30 10:11:18 Adding connection ID (empty).
2025/04/30 10:11:18 client Not doing 0-RTT. Has sealer: false, has params: false
2025/04/30 10:11:18 client -> Sending packet 0 (1280 bytes) for connection 5424443d7383fbf345290ec41195eeb4, Initial
2025/04/30 10:11:18 client 	Long Header{Type: Initial, DestConnectionID: 5424443d7383fbf345290ec41195eeb4, SrcConnectionID: (empty), Token: (empty), PacketNumber: 0, PacketNumberLen: 2, Length: 1254, Version: v1}
2025/04/30 10:11:18 client 	-> &wire.CryptoFrame{Offset: 0, Data length: 275, Offset + Data length: 275}
2025/04/30 10:11:18 client Parsed a coalesced packet. Part 1: 146 bytes. Remaining: 1054 bytes.
2025/04/30 10:11:18 client <- Reading packet 0 (146 bytes) for connection (empty), Initial
2025/04/30 10:11:18 client 	Long Header{Type: Initial, DestConnectionID: (empty), SrcConnectionID: 0000000000003006fc8873db2787a8411120e957, Token: (empty), PacketNumber: 0, PacketNumberLen: 1, Length: 116, Version: v1}
2025/04/30 10:11:18 client Received first packet. Switching destination connection ID to: 0000000000003006fc8873db2787a8411120e957
2025/04/30 10:11:18 client 	<- &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 0s}
2025/04/30 10:11:18 client 	newly acked packets (1): [0]
2025/04/30 10:11:18 client 	updated RTT: 40.857183ms (σ: 20.428591ms)
2025/04/30 10:11:18 client 	<- &wire.CryptoFrame{Offset: 0, Data length: 90, Offset + Data length: 90}
2025/04/30 10:11:18 client Installed Handshake Write keys (using TLS_AES_128_GCM_SHA256)
2025/04/30 10:11:18 client Installed Handshake Read keys (using TLS_AES_128_GCM_SHA256)
2025/04/30 10:11:18 client Parsed a coalesced packet. Part 2: 1054 bytes. Remaining: 0 bytes.
2025/04/30 10:11:18 client <- Reading packet 0 (1054 bytes) for connection (empty), Handshake
2025/04/30 10:11:18 client 	Long Header{Type: Handshake, DestConnectionID: (empty), SrcConnectionID: 0000000000003006fc8873db2787a8411120e957, PacketNumber: 0, PacketNumberLen: 1, Length: 1025, Version: v1}
2025/04/30 10:11:18 client 	<- &wire.CryptoFrame{Offset: 0, Data length: 726, Offset + Data length: 726}
2025/04/30 10:11:18 client Installed 1-RTT Write keys (using TLS_AES_128_GCM_SHA256)
2025/04/30 10:11:18 client Installed 1-RTT Read keys (using TLS_AES_128_GCM_SHA256)
2025/04/30 10:11:18 client Processed Transport Parameters: &wire.TransportParameters{OriginalDestinationConnectionID: 5424443d7383fbf345290ec41195eeb4, InitialSourceConnectionID: 0000000000003006fc8873db2787a8411120e957, InitialMaxStreamDataBidiLocal: 65536, InitialMaxStreamDataBidiRemote: 65536, InitialMaxStreamDataUni: 65536, InitialMaxData: 8585216, MaxBidiStreamNum: 128, MaxUniStreamNum: 3, MaxIdleTimeout: 1m15s, AckDelayExponent: 3, MaxAckDelay: 25ms, ActiveConnectionIDLimit: 2, StatelessResetToken: 0x7fd8a18748b33813e00f07e1cf7c6114}
2025/04/30 10:11:18 client -> Sending coalesced packet (2 parts, 1280 bytes) for connection 5424443d7383fbf345290ec41195eeb4
2025/04/30 10:11:18 client 	Long Header{Type: Initial, DestConnectionID: 0000000000003006fc8873db2787a8411120e957, SrcConnectionID: (empty), Token: (empty), PacketNumber: 1, PacketNumberLen: 2, Length: 1164, Version: v1}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 0s}
2025/04/30 10:11:18 client 	Long Header{Type: Handshake, DestConnectionID: 0000000000003006fc8873db2787a8411120e957, SrcConnectionID: (empty), PacketNumber: 0, PacketNumberLen: 2, Length: 57, Version: v1}
2025/04/30 10:11:18 client 	-> &wire.CryptoFrame{Offset: 0, Data length: 36, Offset + Data length: 36}
2025/04/30 10:11:18 client Dropping Initial keys.
2025/04/30 10:11:18 client -> Sending packet 1 (52 bytes) for connection 5424443d7383fbf345290ec41195eeb4, Handshake
2025/04/30 10:11:18 client 	Long Header{Type: Handshake, DestConnectionID: 0000000000003006fc8873db2787a8411120e957, SrcConnectionID: (empty), PacketNumber: 1, PacketNumberLen: 2, Length: 23, Version: v1}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 0s}
2025/04/30 10:11:18 client -> Sending packet 0 (78 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: ECT(0))
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 0000000000003006fc8873db2787a8411120e957, PacketNumber: 0, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.StreamFrame{StreamID: 0, Fin: true, Offset: 0, Data length: 17, Offset + Data length: 17}
2025/04/30 10:11:18 client 	-> &wire.StreamFrame{StreamID: 4, Fin: true, Offset: 0, Data length: 17, Offset + Data length: 17}
2025/04/30 10:11:18 client <- Reading packet 0 (139 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 0, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.HandshakeDoneFrame{}
2025/04/30 10:11:18 client Dropping Handshake keys.
2025/04/30 10:11:18 client 	<- &wire.NewConnectionIDFrame{SequenceNumber: 1, RetirePriorTo: 0, ConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, StatelessResetToken: 0x902adf18d772d8bcfc7760f08430c6db}
2025/04/30 10:11:18 client 	<- &wire.NewConnectionIDFrame{SequenceNumber: 2, RetirePriorTo: 0, ConnectionID: 0000000000003006b5e4b8a4461e1e479fd1d123, StatelessResetToken: 0xac8f080f500473c35a7ddd0694dc2a89}
2025/04/30 10:11:18 client 	<- &wire.NewConnectionIDFrame{SequenceNumber: 3, RetirePriorTo: 0, ConnectionID: 0000000000003006bf6970d280255bb86f108089, StatelessResetToken: 0x7b7c51514da645638750e8fbacc94afd}
2025/04/30 10:11:18 client 	Queueing ACK because the first packet should be acknowledged.
2025/04/30 10:11:18 client -> Sending packet 1 (46 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: ECT(0))
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 1, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 76.924µs}
2025/04/30 10:11:18 client 	-> &wire.RetireConnectionIDFrame{SequenceNumber: 0}
2025/04/30 10:11:18 client <- Reading packet 1 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 1, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 0s}
2025/04/30 10:11:18 client 	newly acked packets (1): [0]
2025/04/30 10:11:18 client 	updated RTT: 39.835ms (σ: 17.363ms)
2025/04/30 10:11:18 client Disabling ECN. ECN-marked packet acknowledged, but no ECN counts on ACK frame.
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 0, Data length: 1172, Offset + Data length: 1172}
2025/04/30 10:11:18 client 	Setting ACK timer to max ack delay: 25ms
2025/04/30 10:11:18 client <- Reading packet 2 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 2, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 1172, Data length: 1176, Offset + Data length: 2348}
2025/04/30 10:11:18 client 	Queueing ACK because packet 2 packets were received after the last ACK (using initial threshold: 2).
2025/04/30 10:11:18 client -> Sending packet 2 (44 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: Not-ECT)
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 2, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 2, LowestAcked: 0, DelayTime: 44.954µs}
2025/04/30 10:11:18 client <- Reading packet 3 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 3, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 2348, Data length: 1176, Offset + Data length: 3524}
2025/04/30 10:11:18 client 	Setting ACK timer to max ack delay: 25ms
2025/04/30 10:11:18 client <- Reading packet 4 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 4, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 3524, Data length: 1176, Offset + Data length: 4700}
2025/04/30 10:11:18 client 	Queueing ACK because packet 2 packets were received after the last ACK (using initial threshold: 2).
2025/04/30 10:11:18 client -> Sending packet 3 (44 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: Not-ECT)
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 3, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 4, LowestAcked: 0, DelayTime: 37.891µs}
2025/04/30 10:11:18 client <- Reading packet 5 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 5, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 4700, Data length: 1176, Offset + Data length: 5876}
2025/04/30 10:11:18 client 	Setting ACK timer to max ack delay: 25ms
2025/04/30 10:11:18 client <- Reading packet 6 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 6, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 5876, Data length: 1176, Offset + Data length: 7052}
2025/04/30 10:11:18 client 	Queueing ACK because packet 2 packets were received after the last ACK (using initial threshold: 2).
2025/04/30 10:11:18 client -> Sending packet 4 (44 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: Not-ECT)
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 4, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 6, LowestAcked: 0, DelayTime: 43.291µs}
2025/04/30 10:11:18 client <- Reading packet 7 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 7, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 7052, Data length: 1176, Offset + Data length: 8228}
2025/04/30 10:11:18 client 	Setting ACK timer to max ack delay: 25ms
2025/04/30 10:11:18 client <- Reading packet 8 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 8, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 8228, Data length: 1176, Offset + Data length: 9404}
2025/04/30 10:11:18 client 	Queueing ACK because packet 2 packets were received after the last ACK (using initial threshold: 2).
2025/04/30 10:11:18 client -> Sending packet 5 (44 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: Not-ECT)
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 5, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 8, LowestAcked: 0, DelayTime: 45.295µs}
2025/04/30 10:11:18 client <- Reading packet 9 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 9, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 9404, Data length: 836, Offset + Data length: 10240}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 0, Fin: true, Offset: 10240, Data length: 0, Offset + Data length: 10240}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 0, Data length: 330, Offset + Data length: 330}
2025/04/30 10:11:18 client 	Setting ACK timer to max ack delay: 25ms
2025/04/30 10:11:18 client <- Reading packet 10 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 10, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 330, Data length: 1176, Offset + Data length: 1506}
2025/04/30 10:11:18 client 	Queueing ACK because packet 2 packets were received after the last ACK (using initial threshold: 2).
2025/04/30 10:11:18 client -> Sending packet 6 (44 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: Not-ECT)
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 6, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 10, LowestAcked: 0, DelayTime: 37.06µs}
2025/04/30 10:11:18 client <- Reading packet 11 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 11, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 1506, Data length: 1176, Offset + Data length: 2682}
2025/04/30 10:11:18 client 	Setting ACK timer to max ack delay: 25ms
2025/04/30 10:11:18 client <- Reading packet 12 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 12, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 2682, Data length: 1176, Offset + Data length: 3858}
2025/04/30 10:11:18 client 	Queueing ACK because packet 2 packets were received after the last ACK (using initial threshold: 2).
2025/04/30 10:11:18 client -> Sending packet 7 (44 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: Not-ECT)
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 7, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 12, LowestAcked: 0, DelayTime: 49.283µs}
2025/04/30 10:11:18 client <- Reading packet 13 (1200 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 13, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 3858, Data length: 1176, Offset + Data length: 5034}
2025/04/30 10:11:18 client 	Setting ACK timer to max ack delay: 25ms
2025/04/30 10:11:18 client <- Reading packet 14 (115 bytes) for connection (empty), 1-RTT
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: (empty), PacketNumber: 14, PacketNumberLen: 1, KeyPhase: 0}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 5034, Data length: 86, Offset + Data length: 5120}
2025/04/30 10:11:18 client 	<- &wire.StreamFrame{StreamID: 4, Fin: true, Offset: 5120, Data length: 0, Offset + Data length: 5120}
2025/04/30 10:11:18 client 	Queueing ACK because packet 2 packets were received after the last ACK (using initial threshold: 2).
2025/04/30 10:11:18 client -> Sending packet 8 (44 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: Not-ECT)
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 8, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.AckFrame{LargestAcked: 14, LowestAcked: 0, DelayTime: 43.672µs}
2025/04/30 10:11:18 client Closing connection with error: Application error 0x0 (local)
2025/04/30 10:11:18 client -> Sending packet 9 (42 bytes) for connection 5424443d7383fbf345290ec41195eeb4, 1-RTT (ECN: Not-ECT)
2025/04/30 10:11:18 client 	Short Header{DestConnectionID: 000000000000300698ecbe0ae8462c4c7fdbd587, PacketNumber: 9, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 10:11:18 client 	-> &wire.ConnectionCloseFrame{IsApplicationError:true, ErrorCode:0x0, FrameType:0x0, ReasonPhrase:""}
2025/04/30 10:11:18 Replacing connection for connection IDs [(empty)] with a closed connection.
2025/04/30 10:11:18 client Connection 5424443d7383fbf345290ec41195eeb4 closed.