2025/04/30 11:04:45 Increased receive buffer size to 14336 kiB
2025/04/30 11:04:45 Increased send buffer size to 14336 kiB
2025/04/30 11:04:45 Setting DF for IPv4 and IPv6.
2025/04/30 11:04:45 Activating reading of ECN bits for IPv4 and IPv6.
2025/04/30 11:04:45 Activating reading of packet info for IPv4 and IPv6.
2025/04/30 11:04:45 server Listening for udp connections on [::]:443
2025/04/30 11:04:46 server Client offered version 0x57414954, sending Version Negotiation
2025/04/30 11:04:46 server Client offered version 0x57414954, sending Version Negotiation
2025/04/30 11:04:46 server Client offered version 0x57414954, sending Version Negotiation
2025/04/30 11:04:46 server <- Received Initial packet.
2025/04/30 11:04:46 Created qlog file: /logs/qlog/2b103ccba9394978f2.sqlog
2025/04/30 11:04:46 server Changing connection ID to 3f4d7155.
2025/04/30 11:04:46 Adding connection IDs 2b103ccba9394978f2 and 3f4d7155 for a new connection.
2025/04/30 11:04:46 server <- Reading packet 0 (1280 bytes) for connection 2b103ccba9394978f2, Initial
2025/04/30 11:04:46 server 	Long Header{Type: Initial, DestConnectionID: 2b103ccba9394978f2, SrcConnectionID: (empty), Token: (empty), PacketNumber: 0, PacketNumberLen: 2, Length: 1261, Version: v1}
2025/04/30 11:04:46 server 	<- &wire.CryptoFrame{Offset: 0, Data length: 274, Offset + Data length: 274}
2025/04/30 11:04:46 server Installed Handshake Write keys (using TLS_AES_128_GCM_SHA256)
2025/04/30 11:04:46 server Installed Handshake Read keys (using TLS_AES_128_GCM_SHA256)
2025/04/30 11:04:46 server Installed 1-RTT Write keys (using TLS_AES_128_GCM_SHA256)
2025/04/30 11:04:46 server Processed Transport Parameters: &wire.TransportParameters{OriginalDestinationConnectionID: (empty), InitialSourceConnectionID: (empty), InitialMaxStreamDataBidiLocal: 524288, InitialMaxStreamDataBidiRemote: 524288, InitialMaxStreamDataUni: 524288, InitialMaxData: 786432, MaxBidiStreamNum: 100, MaxUniStreamNum: 100, MaxIdleTimeout: 30s, AckDelayExponent: 3, MaxAckDelay: 26ms, ActiveConnectionIDLimit: 4}
2025/04/30 11:04:46 Adding connection ID 5ee52d69.
2025/04/30 11:04:46 Adding connection ID 13fad4f0.
2025/04/30 11:04:46 Adding connection ID 8787b333.
2025/04/30 11:04:46 server -> Sending coalesced packet (2 parts, 1280 bytes) for connection 2b103ccba9394978f2
2025/04/30 11:04:46 server 	Long Header{Type: Initial, DestConnectionID: (empty), SrcConnectionID: 3f4d7155, Token: (empty), PacketNumber: 0, PacketNumberLen: 2, Length: 432, Version: v1}
2025/04/30 11:04:46 server 	-> &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 0s}
2025/04/30 11:04:46 server 	-> &wire.CryptoFrame{Offset: 0, Data length: 90, Offset + Data length: 90}
2025/04/30 11:04:46 server 	Long Header{Type: Handshake, DestConnectionID: (empty), SrcConnectionID: 3f4d7155, PacketNumber: 0, PacketNumberLen: 2, Length: 730, Version: v1}
2025/04/30 11:04:46 server 	-> &wire.CryptoFrame{Offset: 0, Data length: 708, Offset + Data length: 708}
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 0, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.NewConnectionIDFrame{SequenceNumber: 1, RetirePriorTo: 0, ConnectionID: 5ee52d69, StatelessResetToken: 0x5d55523852e47d913fa821b924c6f318}
2025/04/30 11:04:46 server 	-> &wire.NewConnectionIDFrame{SequenceNumber: 2, RetirePriorTo: 0, ConnectionID: 13fad4f0, StatelessResetToken: 0x9464277b81262cd1090291b3d35ba19b}
2025/04/30 11:04:46 server 	-> &wire.NewConnectionIDFrame{SequenceNumber: 3, RetirePriorTo: 0, ConnectionID: 8787b333, StatelessResetToken: 0x83d25114eb51d33d5c867e7c697629c4}
2025/04/30 11:04:46 server Parsed a coalesced packet. Part 1: 1185 bytes. Remaining: 95 bytes.
2025/04/30 11:04:46 server <- Reading packet 1 (1185 bytes) for connection 5ee52d69, Initial
2025/04/30 11:04:46 server 	Long Header{Type: Initial, DestConnectionID: 5ee52d69, SrcConnectionID: (empty), Token: (empty), PacketNumber: 1, PacketNumberLen: 2, Length: 1171, Version: v1}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 0s}
2025/04/30 11:04:46 server 	newly acked packets (1): [0]
2025/04/30 11:04:46 server 	updated RTT: 33.36051ms (σ: 16.680255ms)
2025/04/30 11:04:46 server Parsed a coalesced packet. Part 2: 70 bytes. Remaining: 25 bytes.
2025/04/30 11:04:46 server <- Reading packet 0 (70 bytes) for connection 5ee52d69, Handshake
2025/04/30 11:04:46 server 	Long Header{Type: Handshake, DestConnectionID: 5ee52d69, SrcConnectionID: (empty), PacketNumber: 0, PacketNumberLen: 2, Length: 57, Version: v1}
2025/04/30 11:04:46 server Dropping Initial keys.
2025/04/30 11:04:46 server 	<- &wire.CryptoFrame{Offset: 0, Data length: 36, Offset + Data length: 36}
2025/04/30 11:04:46 server Installed 1-RTT Read keys (using TLS_AES_128_GCM_SHA256)
2025/04/30 11:04:46 Retiring connection ID 2b103ccba9394978f2 in 5s.
2025/04/30 11:04:46 server Dropping Handshake keys.
2025/04/30 11:04:46 server <- Reading packet 0 (25 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 0, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.RetireConnectionIDFrame{SequenceNumber: 0}
2025/04/30 11:04:46 Retiring connection ID 3f4d7155 in 5s.
2025/04/30 11:04:46 server 	Queueing ACK because the first packet should be acknowledged.
2025/04/30 11:04:46 server Dropping %!s(logging.PacketType=1) packet (36 bytes) because we already dropped the keys.
2025/04/30 11:04:46 server -> Sending packet 1 (256 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 1, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 288.708µs}
2025/04/30 11:04:46 server 	-> &wire.NewTokenFrame{Token: 0xd4347ba48555be0e7ebe163c45de94de81b2f420a193fc72d284c212757cc1174f51c5f911126fae8821b2f6c7e62f4ee411adb8c789d73bcf74840bef9350461a7912bf109c70a85d0e1223c8d2b3d84d0079281beb}
2025/04/30 11:04:46 server 	-> &wire.HandshakeDoneFrame{}
2025/04/30 11:04:46 server 	-> &wire.CryptoFrame{Offset: 0, Data length: 138, Offset + Data length: 138}
2025/04/30 11:04:46 server <- Reading packet 1 (48 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 1, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 704µs}
2025/04/30 11:04:46 server 	newly acked packets (1): [0]
2025/04/30 11:04:46 server 	updated RTT: 33.376ms (σ: 12.542ms)
2025/04/30 11:04:46 server 	<- &wire.StreamFrame{StreamID: 0, Fin: true, Offset: 0, Data length: 17, Offset + Data length: 17}
2025/04/30 11:04:46 server 	Setting ACK timer to max ack delay: 25ms
2025/04/30 11:04:46 server <- Reading packet 2 (42 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 2, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.StreamFrame{StreamID: 4, Fin: true, Offset: 0, Data length: 17, Offset + Data length: 17}
2025/04/30 11:04:46 server 	Queueing ACK because packet 2 packets were received after the last ACK (using initial threshold: 2).
2025/04/30 11:04:46 server -> Sending packet 2 (27 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 2, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.AckFrame{LargestAcked: 2, LowestAcked: 0, DelayTime: 282.489µs, ECT0: 2, ECT1: 0, CE: 0}
2025/04/30 11:04:46 Received request: GET /rqikbnschr
2025/04/30 11:04:46 Received request: GET /qlruoilhfi
2025/04/30 11:04:46 server -> Sending packet 3 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 3, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 0, Data length: 1259, Offset + Data length: 1259}
2025/04/30 11:04:46 server -> Sending packet 4 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 4, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 1259, Data length: 1257, Offset + Data length: 2516}
2025/04/30 11:04:46 server -> Sending packet 5 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 5, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 2516, Data length: 1257, Offset + Data length: 3773}
2025/04/30 11:04:46 server -> Sending packet 6 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 6, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 3773, Data length: 1257, Offset + Data length: 5030}
2025/04/30 11:04:46 server -> Sending packet 7 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 7, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 0, Data length: 1259, Offset + Data length: 1259}
2025/04/30 11:04:46 server -> Sending packet 8 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 8, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 5030, Data length: 1257, Offset + Data length: 6287}
2025/04/30 11:04:46 server -> Sending packet 9 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 9, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 1259, Data length: 1257, Offset + Data length: 2516}
2025/04/30 11:04:46 server -> Sending packet 10 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: ECT(0))
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 10, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 6287, Data length: 1257, Offset + Data length: 7544}
2025/04/30 11:04:46 server -> Sending packet 11 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: Not-ECT)
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 11, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 2516, Data length: 1257, Offset + Data length: 3773}
2025/04/30 11:04:46 server -> Sending packet 12 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: Not-ECT)
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 12, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 7544, Data length: 1257, Offset + Data length: 8801}
2025/04/30 11:04:46 server -> Sending packet 13 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: Not-ECT)
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 13, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 4, Fin: false, Offset: 3773, Data length: 1257, Offset + Data length: 5030}
2025/04/30 11:04:46 server -> Sending packet 14 (1280 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: Not-ECT)
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 14, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 8801, Data length: 1257, Offset + Data length: 10058}
2025/04/30 11:04:46 server -> Sending packet 15 (301 bytes) for connection 2b103ccba9394978f2, 1-RTT (ECN: Not-ECT)
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: (empty), PacketNumber: 15, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 4, Fin: true, Offset: 5030, Data length: 90, Offset + Data length: 5120}
2025/04/30 11:04:46 server 	-> &wire.StreamFrame{StreamID: 0, Fin: true, Offset: 10058, Data length: 182, Offset + Data length: 10240}
2025/04/30 11:04:46 server <- Reading packet 3 (31 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 3, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 3, LowestAcked: 1, DelayTime: 56µs, ECT0: 3, ECT1: 0, CE: 0}
2025/04/30 11:04:46 server 	newly acked packets (2): [1 3]
2025/04/30 11:04:46 server 	updated RTT: 33.193ms (σ: 9.771ms)
2025/04/30 11:04:46 server ECN capability confirmed.
2025/04/30 11:04:46 server 	Ignoring all packets below 1.
2025/04/30 11:04:46 server <- Reading packet 4 (31 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 4, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 5, LowestAcked: 1, DelayTime: 40µs, ECT0: 5, ECT1: 0, CE: 0}
2025/04/30 11:04:46 server 	newly acked packets (2): [4 5]
2025/04/30 11:04:46 server 	updated RTT: 33.282ms (σ: 7.507ms)
2025/04/30 11:04:46 server <- Reading packet 5 (31 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 5, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 7, LowestAcked: 1, DelayTime: 64µs, ECT0: 7, ECT1: 0, CE: 0}
2025/04/30 11:04:46 server 	newly acked packets (2): [6 7]
2025/04/30 11:04:46 server 	updated RTT: 33.625ms (σ: 6.317ms)
2025/04/30 11:04:46 server <- Reading packet 6 (31 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 6, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 9, LowestAcked: 1, DelayTime: 40µs, ECT0: 9, ECT1: 0, CE: 0}
2025/04/30 11:04:46 server 	newly acked packets (2): [8 9]
2025/04/30 11:04:46 server 	updated RTT: 34.194ms (σ: 5.876ms)
2025/04/30 11:04:46 server <- Reading packet 7 (31 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 7, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 11, LowestAcked: 1, DelayTime: 40µs, ECT0: 10, ECT1: 0, CE: 0}
2025/04/30 11:04:46 server 	newly acked packets (2): [10 11]
2025/04/30 11:04:46 server 	updated RTT: 34.965ms (σ: 5.949ms)
2025/04/30 11:04:46 server <- Reading packet 8 (31 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 8, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 13, LowestAcked: 1, DelayTime: 32µs, ECT0: 10, ECT1: 0, CE: 0}
2025/04/30 11:04:46 server 	newly acked packets (2): [12 13]
2025/04/30 11:04:46 server 	updated RTT: 35.717ms (σ: 5.965ms)
2025/04/30 11:04:46 server <- Reading packet 9 (31 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 9, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.AckFrame{LargestAcked: 15, LowestAcked: 1, DelayTime: 32µs, ECT0: 10, ECT1: 0, CE: 0}
2025/04/30 11:04:46 server 	newly acked packets (2): [14 15]
2025/04/30 11:04:46 server 	updated RTT: 36.405ms (σ: 5.851ms)
2025/04/30 11:04:46 server Canceling loss detection timer.
2025/04/30 11:04:46 server <- Reading packet 10 (26 bytes) for connection 5ee52d69, 1-RTT
2025/04/30 11:04:46 server 	Short Header{DestConnectionID: 5ee52d69, PacketNumber: 10, PacketNumberLen: 2, KeyPhase: 0}
2025/04/30 11:04:46 server 	<- &wire.ConnectionCloseFrame{IsApplicationError:true, ErrorCode:0x0, FrameType:0x0, ReasonPhrase:""}
2025/04/30 11:04:46 server Closing connection with error: Application error 0x0 (remote)
2025/04/30 11:04:46 Replacing connection for connection IDs [5ee52d69 13fad4f0 8787b333] with a closed connection.
2025/04/30 11:04:46 Error accepting stream: Application error 0x0 (remote)
2025/04/30 11:04:46 server Connection 2b103ccba9394978f2 closed.
2025/04/30 11:04:47 Tracking 5 connection IDs and 0 reset tokens.
2025/04/30 11:04:49 Tracking 5 connection IDs and 0 reset tokens.
2025/04/30 11:04:51 Tracking 5 connection IDs and 0 reset tokens.
2025/04/30 11:04:51 Removing connection ID 3f4d7155 after it has been retired.
2025/04/30 11:04:51 Removing connection ID 2b103ccba9394978f2 after it has been retired.
2025/04/30 11:04:51 Removing connection IDs [5ee52d69 13fad4f0 8787b333] for a closed connection after it has been retired.
2025/04/30 11:04:53 Tracking 0 connection IDs and 0 reset tokens.