2025/04/30 08:43:00 Increased receive buffer size to 14336 kiB 2025/04/30 08:43:00 Increased send buffer size to 14336 kiB 2025/04/30 08:43:00 Setting DF for IPv4 and IPv6. 2025/04/30 08:43:00 Activating reading of ECN bits for IPv4 and IPv6. 2025/04/30 08:43:00 Activating reading of packet info for IPv4 and IPv6. 2025/04/30 08:43:00 server Listening for udp connections on [::]:443 2025/04/30 08:43:00 server Client offered version 0x57414954, sending Version Negotiation 2025/04/30 08:43:00 server Client offered version 0x57414954, sending Version Negotiation 2025/04/30 08:43:00 server Client offered version 0x57414954, sending Version Negotiation 2025/04/30 08:43:01 server <- Received Initial packet. 2025/04/30 08:43:01 server Long Header{Type: Initial, DestConnectionID: 85fb219e9ac89090e1cf2b3ff7, SrcConnectionID: 724f352d0fb43fae, Token: (empty), PacketNumber: 0, PacketNumberLen: 0, Length: 1169, Version: v1} 2025/04/30 08:43:01 server Changing connection ID to 537ab783. 2025/04/30 08:43:01 server -> Sending Retry 2025/04/30 08:43:01 server Long Header{Type: Retry, DestConnectionID: 724f352d0fb43fae, SrcConnectionID: 537ab783, Token: 0x85c893ba55db7aeeca9a6e183cd3e48dc05724c0f10ab4c0c663be498ea4a97ffbae4a11fb9d525af6c4fada1516e95c6752dc1fb8dbe3d0a147ea49e8cca245bf5dc32e9fdc91f04ba672562f14a8755eb522623e9fb8d1a2b563dbda79007c2c279bee62e0bc, Version: v1} 2025/04/30 08:43:01 server <- Received Initial packet. 2025/04/30 08:43:01 Created qlog file: /logs/qlog/85fb219e9ac89090e1cf2b3ff7.sqlog 2025/04/30 08:43:01 server Changing connection ID to 2c4821b1. 2025/04/30 08:43:01 Adding connection IDs 537ab783 and 2c4821b1 for a new connection. 2025/04/30 08:43:01 server <- Reading packet 1 (1200 bytes) for connection 537ab783, Initial 2025/04/30 08:43:01 server Long Header{Type: Initial, DestConnectionID: 537ab783, SrcConnectionID: 724f352d0fb43fae, Token: 0x85c893ba55db7aeeca9a6e183cd3e48dc05724c0f10ab4c0c663be498ea4a97ffbae4a11fb9d525af6c4fada1516e95c6752dc1fb8dbe3d0a147ea49e8cca245bf5dc32e9fdc91f04ba672562f14a8755eb522623e9fb8d1a2b563dbda79007c2c279bee62e0bc, PacketNumber: 1, PacketNumberLen: 1, Length: 1074, Version: v1} 2025/04/30 08:43:01 server <- &wire.CryptoFrame{Offset: 0, Data length: 248, Offset + Data length: 248} 2025/04/30 08:43:01 server Installed Handshake Write keys (using TLS_AES_128_GCM_SHA256) 2025/04/30 08:43:01 server Installed Handshake Read keys (using TLS_AES_128_GCM_SHA256) 2025/04/30 08:43:01 server Installed 1-RTT Write keys (using TLS_AES_128_GCM_SHA256) 2025/04/30 08:43:01 server Processed Transport Parameters: &wire.TransportParameters{OriginalDestinationConnectionID: (empty), InitialSourceConnectionID: 724f352d0fb43fae, InitialMaxStreamDataBidiLocal: 6291456, InitialMaxStreamDataBidiRemote: 0, InitialMaxStreamDataUni: 32768, InitialMaxData: 15728640, MaxBidiStreamNum: 100, MaxUniStreamNum: 100, MaxIdleTimeout: 30s, AckDelayExponent: 3, MaxAckDelay: 25ms, ActiveConnectionIDLimit: 8} 2025/04/30 08:43:01 Adding connection ID d33f40fd. 2025/04/30 08:43:01 Adding connection ID d9da7392. 2025/04/30 08:43:01 Adding connection ID ebf5625b. 2025/04/30 08:43:01 Adding connection ID 02a7a8e3. 2025/04/30 08:43:01 Adding connection ID f34ad3cc. 2025/04/30 08:43:01 server -> Sending coalesced packet (2 parts, 1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7 2025/04/30 08:43:01 server Long Header{Type: Initial, DestConnectionID: 724f352d0fb43fae, SrcConnectionID: 2c4821b1, Token: (empty), PacketNumber: 0, PacketNumberLen: 2, Length: 360, Version: v1} 2025/04/30 08:43:01 server -> &wire.AckFrame{LargestAcked: 1, LowestAcked: 1, DelayTime: 0s, ECT0: 0, ECT1: 1, CE: 0} 2025/04/30 08:43:01 server -> &wire.CryptoFrame{Offset: 0, Data length: 90, Offset + Data length: 90} 2025/04/30 08:43:01 server Long Header{Type: Handshake, DestConnectionID: 724f352d0fb43fae, SrcConnectionID: 2c4821b1, PacketNumber: 0, PacketNumberLen: 2, Length: 730, Version: v1} 2025/04/30 08:43:01 server -> &wire.CryptoFrame{Offset: 0, Data length: 708, Offset + Data length: 708} 2025/04/30 08:43:01 server Short Header{DestConnectionID: 724f352d0fb43fae, PacketNumber: 0, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.NewConnectionIDFrame{SequenceNumber: 3, RetirePriorTo: 0, ConnectionID: ebf5625b, StatelessResetToken: 0xa7f4ae9370400fa5b43007dc83f9d844} 2025/04/30 08:43:01 server -> &wire.NewConnectionIDFrame{SequenceNumber: 5, RetirePriorTo: 0, ConnectionID: f34ad3cc, StatelessResetToken: 0x9ceed27b4f744149eac1471ec7dabced} 2025/04/30 08:43:01 server -> &wire.NewConnectionIDFrame{SequenceNumber: 4, RetirePriorTo: 0, ConnectionID: 02a7a8e3, StatelessResetToken: 0x14444702d1544c7e6b7010267c3308ef} 2025/04/30 08:43:01 server -> &wire.NewConnectionIDFrame{SequenceNumber: 2, RetirePriorTo: 0, ConnectionID: d9da7392, StatelessResetToken: 0xdc66c46f2eb6d9ef1343fa4bb2576a40} 2025/04/30 08:43:01 server -> &wire.NewConnectionIDFrame{SequenceNumber: 1, RetirePriorTo: 0, ConnectionID: d33f40fd, StatelessResetToken: 0xf6e08b8dbd3ffef8e8b19cd3d802176a} 2025/04/30 08:43:01 server Parsed a coalesced packet. Part 1: 1047 bytes. Remaining: 153 bytes. 2025/04/30 08:43:01 server <- Reading packet 2 (1047 bytes) for connection 2c4821b1, Initial 2025/04/30 08:43:01 server Long Header{Type: Initial, DestConnectionID: 2c4821b1, SrcConnectionID: 724f352d0fb43fae, Token: 0x85c893ba55db7aeeca9a6e183cd3e48dc05724c0f10ab4c0c663be498ea4a97ffbae4a11fb9d525af6c4fada1516e95c6752dc1fb8dbe3d0a147ea49e8cca245bf5dc32e9fdc91f04ba672562f14a8755eb522623e9fb8d1a2b563dbda79007c2c279bee62e0bc, PacketNumber: 2, PacketNumberLen: 2, Length: 921, Version: v1} 2025/04/30 08:43:01 server <- &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 1.72ms} 2025/04/30 08:43:01 server newly acked packets (1): [0] 2025/04/30 08:43:01 server updated RTT: 34.52838ms (σ: 17.26419ms) 2025/04/30 08:43:01 server Parsed a coalesced packet. Part 2: 83 bytes. Remaining: 70 bytes. 2025/04/30 08:43:01 server <- Reading packet 3 (83 bytes) for connection 2c4821b1, Handshake 2025/04/30 08:43:01 server Long Header{Type: Handshake, DestConnectionID: 2c4821b1, SrcConnectionID: 724f352d0fb43fae, PacketNumber: 3, PacketNumberLen: 1, Length: 62, Version: v1} 2025/04/30 08:43:01 server Dropping Initial keys. 2025/04/30 08:43:01 server <- &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 800µs} 2025/04/30 08:43:01 server newly acked packets (1): [0] 2025/04/30 08:43:01 server updated RTT: 34.528ms (σ: 12.948ms) 2025/04/30 08:43:01 server Canceling loss detection timer. 2025/04/30 08:43:01 server <- &wire.CryptoFrame{Offset: 0, Data length: 36, Offset + Data length: 36} 2025/04/30 08:43:01 server Installed 1-RTT Read keys (using TLS_AES_128_GCM_SHA256) 2025/04/30 08:43:01 Retiring connection ID 537ab783 in 5s. 2025/04/30 08:43:01 server Dropping Handshake keys. 2025/04/30 08:43:01 server <- Reading packet 4 (70 bytes) for connection 2c4821b1, 1-RTT 2025/04/30 08:43:01 server Short Header{DestConnectionID: 2c4821b1, PacketNumber: 4, PacketNumberLen: 1, KeyPhase: 0} 2025/04/30 08:43:01 server <- &wire.NewConnectionIDFrame{SequenceNumber: 1, RetirePriorTo: 0, ConnectionID: dd916e8c8540ec44, StatelessResetToken: 0x5cb636394c340e3629995dd8cd03bfb7} 2025/04/30 08:43:01 server <- &wire.StreamFrame{StreamID: 0, Fin: true, Offset: 0, Data length: 17, Offset + Data length: 17} 2025/04/30 08:43:01 server Queueing ACK because the first packet should be acknowledged. 2025/04/30 08:43:01 server -> Sending packet 1 (269 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 1, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.AckFrame{LargestAcked: 4, LowestAcked: 4, DelayTime: 281.898µs, ECT0: 0, ECT1: 1, CE: 0} 2025/04/30 08:43:01 server -> &wire.CryptoFrame{Offset: 0, Data length: 138, Offset + Data length: 138} 2025/04/30 08:43:01 server -> &wire.HandshakeDoneFrame{} 2025/04/30 08:43:01 server -> &wire.RetireConnectionIDFrame{SequenceNumber: 0} 2025/04/30 08:43:01 server -> &wire.NewTokenFrame{Token: 0x28b87cbc2593d48b57e76a754d598c7984764d89f82958b3e9584a06e139b83988c5822cb976dd77c564a8ab15292fb7a25a72586416e22666fb8740a1ac94ef2ddcc5f0a930b49fcc43b855e179547655efafc39181} 2025/04/30 08:43:01 Received request: GET /mzffihqoat 2025/04/30 08:43:01 server -> Sending packet 2 (1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 2, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 0, Data length: 1251, Offset + Data length: 1251} 2025/04/30 08:43:01 server -> Sending packet 3 (1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 3, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 1251, Data length: 1249, Offset + Data length: 2500} 2025/04/30 08:43:01 server -> Sending packet 4 (1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 4, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 2500, Data length: 1249, Offset + Data length: 3749} 2025/04/30 08:43:01 server -> Sending packet 5 (1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 5, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 3749, Data length: 1249, Offset + Data length: 4998} 2025/04/30 08:43:01 server -> Sending packet 6 (1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 6, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 4998, Data length: 1249, Offset + Data length: 6247} 2025/04/30 08:43:01 server -> Sending packet 7 (1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 7, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 6247, Data length: 1249, Offset + Data length: 7496} 2025/04/30 08:43:01 server -> Sending packet 8 (1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 8, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 7496, Data length: 1249, Offset + Data length: 8745} 2025/04/30 08:43:01 server -> Sending packet 9 (1280 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 9, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 8745, Data length: 1249, Offset + Data length: 9994} 2025/04/30 08:43:01 server -> Sending packet 10 (277 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: ECT(0)) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 10, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: false, Offset: 9994, Data length: 246, Offset + Data length: 10240} 2025/04/30 08:43:01 server -> Sending packet 11 (31 bytes) for connection 85fb219e9ac89090e1cf2b3ff7, 1-RTT (ECN: Not-ECT) 2025/04/30 08:43:01 server Short Header{DestConnectionID: dd916e8c8540ec44, PacketNumber: 11, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server -> &wire.StreamFrame{StreamID: 0, Fin: true, Offset: 10240, Data length: 0, Offset + Data length: 10240} 2025/04/30 08:43:01 server <- Reading packet 5 (28 bytes) for connection 2c4821b1, 1-RTT 2025/04/30 08:43:01 server Short Header{DestConnectionID: 2c4821b1, PacketNumber: 5, PacketNumberLen: 1, KeyPhase: 0} 2025/04/30 08:43:01 server <- &wire.AckFrame{LargestAcked: 0, LowestAcked: 0, DelayTime: 8.504ms} 2025/04/30 08:43:01 server newly acked packets (1): [0] 2025/04/30 08:43:01 server updated RTT: 35.445ms (σ: 11.545ms) 2025/04/30 08:43:01 server <- Reading packet 6 (28 bytes) for connection 2c4821b1, 1-RTT 2025/04/30 08:43:01 server Short Header{DestConnectionID: 2c4821b1, PacketNumber: 6, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server <- &wire.AckFrame{LargestAcked: 2, LowestAcked: 0, DelayTime: 40µs} 2025/04/30 08:43:01 server newly acked packets (2): [1 2] 2025/04/30 08:43:01 server updated RTT: 35.001ms (σ: 9.546ms) 2025/04/30 08:43:01 server Disabling ECN. ECN-marked packet acknowledged, but no ECN counts on ACK frame. 2025/04/30 08:43:01 server Ignoring all packets below 5. 2025/04/30 08:43:01 server <- Reading packet 7 (28 bytes) for connection 2c4821b1, 1-RTT 2025/04/30 08:43:01 server Short Header{DestConnectionID: 2c4821b1, PacketNumber: 7, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server <- &wire.AckFrame{LargestAcked: 4, LowestAcked: 0, DelayTime: 32µs} 2025/04/30 08:43:01 server newly acked packets (2): [3 4] 2025/04/30 08:43:01 server updated RTT: 34.86ms (σ: 7.439ms) 2025/04/30 08:43:01 server <- Reading packet 8 (28 bytes) for connection 2c4821b1, 1-RTT 2025/04/30 08:43:01 server Short Header{DestConnectionID: 2c4821b1, PacketNumber: 8, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server <- &wire.AckFrame{LargestAcked: 6, LowestAcked: 0, DelayTime: 32µs} 2025/04/30 08:43:01 server newly acked packets (2): [5 6] 2025/04/30 08:43:01 server updated RTT: 34.999ms (σ: 5.858ms) 2025/04/30 08:43:01 server <- Reading packet 9 (28 bytes) for connection 2c4821b1, 1-RTT 2025/04/30 08:43:01 server Short Header{DestConnectionID: 2c4821b1, PacketNumber: 9, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server <- &wire.AckFrame{LargestAcked: 8, LowestAcked: 0, DelayTime: 40µs} 2025/04/30 08:43:01 server newly acked packets (2): [7 8] 2025/04/30 08:43:01 server updated RTT: 35.388ms (σ: 5.171ms) 2025/04/30 08:43:01 server <- Reading packet 10 (28 bytes) for connection 2c4821b1, 1-RTT 2025/04/30 08:43:01 server Short Header{DestConnectionID: 2c4821b1, PacketNumber: 10, PacketNumberLen: 2, KeyPhase: 0} 2025/04/30 08:43:01 server <- &wire.AckFrame{LargestAcked: 11, LowestAcked: 0, DelayTime: 24µs} 2025/04/30 08:43:01 server newly acked packets (3): [9 10 11] 2025/04/30 08:43:01 server updated RTT: 35.871ms (σ: 4.845ms) 2025/04/30 08:43:01 server Canceling loss detection timer. 2025/04/30 08:43:01 server <- Reading packet 11 (26 bytes) for connection 2c4821b1, 1-RTT 2025/04/30 08:43:01 server Short Header{DestConnectionID: 2c4821b1, PacketNumber: 11, PacketNumberLen: 1, KeyPhase: 0} 2025/04/30 08:43:01 server <- &wire.ConnectionCloseFrame{IsApplicationError:false, ErrorCode:0x0, FrameType:0x0, ReasonPhrase:""} 2025/04/30 08:43:01 server Closing connection with error: NO_ERROR (remote) 2025/04/30 08:43:01 Replacing connection for connection IDs [d9da7392 ebf5625b 02a7a8e3 f34ad3cc 2c4821b1 d33f40fd] with a closed connection. 2025/04/30 08:43:01 Error accepting stream: NO_ERROR (remote) 2025/04/30 08:43:01 server Connection 85fb219e9ac89090e1cf2b3ff7 closed. 2025/04/30 08:43:02 Tracking 7 connection IDs and 0 reset tokens. 2025/04/30 08:43:04 Tracking 7 connection IDs and 0 reset tokens. 2025/04/30 08:43:06 Tracking 7 connection IDs and 0 reset tokens. 2025/04/30 08:43:06 Removing connection ID 537ab783 after it has been retired. 2025/04/30 08:43:06 Removing connection IDs [d9da7392 ebf5625b 02a7a8e3 f34ad3cc 2c4821b1 d33f40fd] for a closed connection after it has been retired. 2025/04/30 08:43:08 Tracking 0 connection IDs and 0 reset tokens.