0.048010960s s2n_quic:server: platform_feature_configured: configuration=Gso { max_segments: 1 } 0.048143168s s2n_quic:server: platform_feature_configured: configuration=BaseMtu { mtu: 1228 } 0.048159719s s2n_quic:server: platform_feature_configured: configuration=InitialMtu { mtu: 1280 } 0.048169427s s2n_quic:server: platform_feature_configured: configuration=MaxMtu { mtu: 9000 } 0.048258985s s2n_quic:server: platform_feature_configured: configuration=Gro { enabled: true } 0.048280144s s2n_quic:server: platform_feature_configured: configuration=Ecn { enabled: true } 0.049717629s s2n_quic:server: platform_event_loop_started: local_address=[::]:443 0.049834658s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=false tx_ready=true application_wakeup=false 0.049871196s s2n_quic:server: platform_rx: count=0 syscalls=1 blocked_syscalls=1 total_errors=0 dropped_errors=0 0.049944484s s2n_quic:server: platform_event_loop_sleep: timeout=None processing_duration=113µs 0.810238325s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 0.810336459s s2n_quic:server: platform_rx: count=3 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 0.810433952s s2n_quic:server: version_information: server_versions=[1] client_versions=[1463896404] chosen_version=None 0.810460531s s2n_quic:server: endpoint_datagram_dropped: len=1207 reason=UnsupportedVersion 0.810481911s s2n_quic:server: version_information: server_versions=[1] client_versions=[1463896404] chosen_version=None 0.810494575s s2n_quic:server: endpoint_datagram_dropped: len=1207 reason=UnsupportedVersion 0.810510324s s2n_quic:server: version_information: server_versions=[1] client_versions=[1463896404] chosen_version=None 0.810522327s s2n_quic:server: endpoint_datagram_dropped: len=1207 reason=UnsupportedVersion 0.810564095s s2n_quic:server: endpoint_packet_sent: packet_header=VersionNegotiation 0.810577801s s2n_quic:server: endpoint_datagram_sent: len=15 gso_offset=0 0.810590775s s2n_quic:server: endpoint_packet_sent: packet_header=VersionNegotiation 0.810600163s s2n_quic:server: endpoint_datagram_sent: len=15 gso_offset=0 0.810611855s s2n_quic:server: endpoint_packet_sent: packet_header=VersionNegotiation 0.810621002s s2n_quic:server: endpoint_datagram_sent: len=15 gso_offset=0 0.810637213s s2n_quic:server: platform_event_loop_sleep: timeout=None processing_duration=415µs 1.024669538s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.024753556s s2n_quic:server: platform_tx: count=3 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.024770367s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.024820170s s2n_quic:server: version_information: server_versions=[1] client_versions=[] chosen_version=Some(1) 1.025202858s s2n_quic:server:conn: key_update: key_type=Initial cipher_suite=TLS_AES_128_GCM_SHA256 id=0 1.025272208s s2n_quic:server:conn: connection_started: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } id=0 1.025297936s s2n_quic:server:conn: mtu_updated: path_id=0 mtu=1232 cause=NewPath search_complete=false id=0 1.025337099s s2n_quic:server:conn: datagram_received: len=1280 id=0 1.025402622s s2n_quic:server:conn: frame_received: packet_header=Initial { number: 0, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Padding id=0 1.025426006s s2n_quic:server:conn: frame_received: packet_header=Initial { number: 0, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Crypto { offset: 0, len: 281 } id=0 1.025485537s s2n_quic:server:conn: tls_client_hello: payload=[[3, 3, 7, 215, 63, 237, 49, 131, 137, 115, 92, 202, 74, 194, 68, 11, 54, 165, 164, 187, 216, 107, 80, 150, 9, 40, 128, 63, 126, 211, 161, 94, 199, 139, 0, 0, 6, 19, 1, 19, 2, 19, 3, 1, 0, 0, 230, 0, 0, 0, 12, 0, 10, 0, 0, 7, 115, 101, 114, 118, 101, 114, 52, 0, 11, 0, 2, 1, 0, 0, 35, 0, 0, 255, 1, 0, 1, 0, 0, 23, 0, 0, 0, 18, 0, 0, 0, 57, 0, 62, 84, 208, 9, 131, 214, 116, 8, 64, 90, 68, 206, 255, 5, 4, 128, 8, 0, 0, 6, 4, 128, 8, 0, 0, 7, 4, 128, 8, 0, 0, 4, 4, 128, 12, 0, 0, 8, 2, 64, 100, 9, 2, 64, 100, 1, 4, 128, 0, 117, 48, 3, 2, 69, 172, 11, 1, 26, 14, 1, 4, 15, 0, 0, 5, 0, 5, 1, 0, 0, 0, 0, 0, 10, 0, 10, 0, 8, 0, 29, 0, 23, 0, 24, 0, 25, 0, 13, 0, 26, 0, 24, 8, 4, 4, 3, 8, 7, 8, 5, 8, 6, 4, 1, 5, 1, 6, 1, 5, 3, 6, 3, 2, 1, 2, 3, 0, 16, 0, 13, 0, 11, 10, 104, 113, 45, 105, 110, 116, 101, 114, 111, 112, 0, 43, 0, 3, 2, 3, 4, 0, 51, 0, 38, 0, 36, 0, 29, 0, 32, 230, 123, 79, 39, 24, 127, 21, 38, 234, 158, 243, 160, 73, 197, 207, 137, 146, 181, 225, 136, 22, 63, 93, 17, 166, 75, 8, 161, 86, 165, 81, 1, 0, 45, 0, 2, 1, 1]] id=0 1.025790980s s2n_quic:server:conn: key_update: key_type=Handshake cipher_suite=TLS_AES_128_GCM_SHA256 id=0 1.025985324s s2n_quic:server:conn: application_protocol_information: chosen_application_protocol=[104, 113, 45, 105, 110, 116, 101, 114, 111, 112] id=0 1.026018496s s2n_quic:server:conn: server_name_information: chosen_server_name="server4" id=0 1.026034456s s2n_quic:server:conn: key_exchange_group: chosen_group_name="x25519" contains_kem=false id=0 1.026074612s s2n_quic:server:conn: transport_parameters_received: transport_parameters=TransportParameters { original_destination_connection_id: None, initial_source_connection_id: Some(0x), retry_source_connection_id: None, stateless_reset_token: None, preferred_address: None, migration_support: true, max_idle_timeout: 30s, ack_delay_exponent: 3, max_ack_delay: 26ms, max_udp_payload_size: 1452, active_connection_id_limit: 4, initial_max_stream_data_bidi_local: 524288, initial_max_stream_data_bidi_remote: 524288, initial_max_stream_data_uni: 524288, initial_max_streams_bidi: 100, initial_max_streams_uni: 100, max_datagram_frame_size: 0, dc_supported_versions: [] } id=0 1.026143951s s2n_quic:server:conn: key_update: key_type=OneRtt { generation: 0 } cipher_suite=TLS_AES_128_GCM_SHA256 id=0 1.026356620s s2n_quic:server:conn: frame_sent: packet_header=Initial { number: 0, version: 1 } path_id=0 frame=Ack { ecn_counts: None, largest_acknowledged: 0, ack_range_count: 1 } id=0 1.026388069s s2n_quic:server:conn: ack_range_sent: packet_header=Initial { number: 0, version: 1 } path_id=0 ack_range=0..=0 id=0 1.026419508s s2n_quic:server:conn: frame_sent: packet_header=Initial { number: 0, version: 1 } path_id=0 frame=Crypto { offset: 0, len: 90 } id=0 1.026465945s s2n_quic:server:conn: packet_sent: packet_header=Initial { number: 0, version: 1 } packet_len=143 id=0 1.026501271s s2n_quic:server:conn: frame_sent: packet_header=Handshake { number: 0, version: 1 } path_id=0 frame=Crypto { offset: 0, len: 694 } id=0 1.026525436s s2n_quic:server:conn: frame_sent: packet_header=Handshake { number: 0, version: 1 } path_id=0 frame=Padding id=0 1.026559981s s2n_quic:server:conn: packet_sent: packet_header=Handshake { number: 0, version: 1 } packet_len=1089 id=0 1.026599575s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=0 1.026649098s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=333ms smoothed_rtt=333ms latest_rtt=333ms rtt_variance=166.5ms max_ack_delay=26ms pto_count=0 congestion_window=12320 bytes_in_flight=1232 congestion_limited=false id=0 1.026720422s s2n_quic:server: platform_event_loop_sleep: timeout=Some(998.569ms) processing_duration=2.064ms 1.060141529s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.060183748s s2n_quic:server: platform_tx: count=1 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.060200530s s2n_quic:server: platform_rx: count=3 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.060232420s s2n_quic:server: version_information: server_versions=[1] client_versions=[] chosen_version=Some(1) 1.060269669s s2n_quic:server:conn: datagram_received: len=1280 id=0 1.060311548s s2n_quic:server:conn: packet_received: packet_header=Initial { number: 1, version: 1 } id=0 1.060339180s s2n_quic:server:conn: frame_received: packet_header=Initial { number: 1, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 1, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 0, ack_range_count: 1 } id=0 1.060377912s s2n_quic:server:conn: ack_range_received: packet_header=Initial { number: 1, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=0 id=0 1.060432334s s2n_quic:server:conn: pacing_rate_updated: path_id=0 bytes_per_second=995525 burst_size=12320 pacing_gain=2.77 id=0 1.060478852s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 33.937ms, delivered_bytes: 143, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 0, bytes_in_flight: 143, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 4213 } id=0 1.060511082s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.937ms smoothed_rtt=33.937ms latest_rtt=33.937ms rtt_variance=16.9685ms max_ack_delay=26ms pto_count=0 congestion_window=12463 bytes_in_flight=1089 congestion_limited=false id=0 1.060572287s s2n_quic:server:conn: frame_received: packet_header=Initial { number: 1, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Padding id=0 1.060639903s s2n_quic:server:conn: packet_received: packet_header=Handshake { number: 0, version: 1 } id=0 1.060681020s s2n_quic:server:conn: frame_received: packet_header=Handshake { number: 0, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Crypto { offset: 0, len: 36 } id=0 1.060748878s s2n_quic:server:conn: key_space_discarded: space=Initial id=0 1.060769176s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.937ms smoothed_rtt=33.937ms latest_rtt=33.937ms rtt_variance=16.9685ms max_ack_delay=26ms pto_count=0 congestion_window=12463 bytes_in_flight=1089 congestion_limited=false id=0 1.060947740s s2n_quic:server:conn: handshake_status_updated: status=Complete id=0 1.060976985s s2n_quic:server:conn: handshake_status_updated: status=Confirmed id=0 1.061003435s s2n_quic:server:conn: tls_exporter_ready: session=TlsSession { .. } id=0 1.061036296s s2n_quic:server:conn: key_space_discarded: space=Handshake id=0 1.061051795s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.937ms smoothed_rtt=33.937ms latest_rtt=33.937ms rtt_variance=16.9685ms max_ack_delay=26ms pto_count=0 congestion_window=12463 bytes_in_flight=1089 congestion_limited=false id=0 1.061153386s s2n_quic:server:conn: datagram_received: len=51 id=0 1.061199262s s2n_quic:server:conn: datagram_received: len=54 id=0 1.061233245s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 0 } id=0 1.061257210s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 0 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Stream { id: 0, offset: 0, len: 17, is_fin: true } id=0 1.061331109s s2n_quic:server:conn: rx_stream_progress: bytes=17 id=0 1.061429553s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 0 } path_id=0 frame=Ping id=0 1.061464308s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 0 } path_id=0 frame=Padding id=0 1.061497982s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 0 } packet_len=1452 id=0 1.061513220s s2n_quic:server:conn: datagram_sent: len=1452 gso_offset=0 id=0 1.061546783s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 1, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 0, ack_range_count: 1 } id=0 1.061564947s s2n_quic:server:conn: ack_range_sent: packet_header=OneRtt { number: 1 } path_id=0 ack_range=0..=0 id=0 1.061578833s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=HandshakeDone id=0 1.061597809s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=Crypto { offset: 0, len: 157 } id=0 1.061618888s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=NewConnectionId { sequence_number: 1, retire_prior_to: 1 } id=0 1.061632684s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=NewConnectionId { sequence_number: 2, retire_prior_to: 1 } id=0 1.061644977s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=NewConnectionId { sequence_number: 3, retire_prior_to: 1 } id=0 1.061681355s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 1 } packet_len=297 id=0 1.061698187s s2n_quic:server:conn: datagram_sent: len=297 gso_offset=0 id=0 1.061729996s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.937ms smoothed_rtt=33.937ms latest_rtt=33.937ms rtt_variance=16.9685ms max_ack_delay=26ms pto_count=0 congestion_window=12463 bytes_in_flight=1749 congestion_limited=false id=0 1.061787865s s2n_quic:server: platform_event_loop_sleep: timeout=Some(127.43ms) processing_duration=1.649ms Accepted a QUIC connection from [::ffff:193.167.0.100]:35653 on 193.167.100.100:443 1.062414740s s2n_quic_qns::server::h09: 4096 bytes ready to send on Stream(0) 1.062462599s s2n_quic_qns::server::h09: 4096 bytes sent on Stream(0) 1.062532561s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=false tx_ready=false application_wakeup=true 1.062560713s s2n_quic:server: platform_tx: count=2 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.062596601s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 2 } path_id=0 frame=HandshakeDone id=0 1.062632778s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 2 } path_id=0 frame=Stream { id: 0, offset: 0, len: 1211, is_fin: false } id=0 1.062672683s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 2 } packet_len=1232 id=0 1.062689054s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=0 1.062718148s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 3 } path_id=0 frame=HandshakeDone id=0 1.062748625s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 3 } path_id=0 frame=Stream { id: 0, offset: 1211, len: 1209, is_fin: false } id=0 1.062783240s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 3 } packet_len=1232 id=0 1.062799401s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=0 1.062826932s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 4 } path_id=0 frame=HandshakeDone id=0 1.062856337s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 4 } path_id=0 frame=Stream { id: 0, offset: 2420, len: 1209, is_fin: false } id=0 1.062914757s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 4 } packet_len=1232 id=0 1.062937910s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=0 1.062968046s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 5 } path_id=0 frame=HandshakeDone id=0 1.063000607s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 5 } path_id=0 frame=Stream { id: 0, offset: 3629, len: 467, is_fin: false } id=0 1.063036595s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 5 } packet_len=492 id=0 1.063053086s s2n_quic:server:conn: datagram_sent: len=492 gso_offset=0 id=0 1.063084274s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.937ms smoothed_rtt=33.937ms latest_rtt=33.937ms rtt_variance=16.9685ms max_ack_delay=26ms pto_count=0 congestion_window=12463 bytes_in_flight=5937 congestion_limited=false id=0 1.063117286s s2n_quic:server:conn: tx_stream_progress: bytes=4096 id=0 1.063152532s s2n_quic:server: platform_event_loop_sleep: timeout=Some(127.236ms) processing_duration=620µs 1.063194842s s2n_quic_qns::server::h09: 1024 bytes ready to send on Stream(0) 1.063228184s s2n_quic_qns::server::h09: 1024 bytes sent on Stream(0) 1.063351135s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=false tx_ready=false application_wakeup=true 1.063379878s s2n_quic:server: platform_tx: count=4 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.063415836s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 6 } path_id=0 frame=HandshakeDone id=0 1.063450280s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 6 } path_id=0 frame=Stream { id: 0, offset: 4096, len: 1024, is_fin: false } id=0 1.063489414s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 6 } packet_len=1049 id=0 1.063506165s s2n_quic:server:conn: datagram_sent: len=1049 gso_offset=0 id=0 1.063538526s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.937ms smoothed_rtt=33.937ms latest_rtt=33.937ms rtt_variance=16.9685ms max_ack_delay=26ms pto_count=0 congestion_window=12463 bytes_in_flight=6986 congestion_limited=false id=0 1.063578230s s2n_quic:server:conn: tx_stream_progress: bytes=1024 id=0 1.063613486s s2n_quic:server: platform_event_loop_sleep: timeout=Some(127.594ms) processing_duration=263µs 1.063753869s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=false tx_ready=false application_wakeup=true 1.063783144s s2n_quic:server: platform_tx: count=1 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.063819011s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 7 } path_id=0 frame=HandshakeDone id=0 1.063851813s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 7 } path_id=0 frame=Stream { id: 0, offset: 5120, len: 0, is_fin: true } id=0 1.063871289s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 7 } path_id=0 frame=Padding id=0 1.063928867s s2n_quic:server:conn: ecn_state_changed: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } state=Unknown id=0 1.063951510s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 7 } packet_len=43 id=0 1.063964073s s2n_quic:server:conn: datagram_sent: len=43 gso_offset=0 id=0 1.063997897s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.937ms smoothed_rtt=33.937ms latest_rtt=33.937ms rtt_variance=16.9685ms max_ack_delay=26ms pto_count=0 congestion_window=12463 bytes_in_flight=7029 congestion_limited=false id=0 1.064047409s s2n_quic:server: platform_event_loop_sleep: timeout=Some(127.563ms) processing_duration=295µs 1.093593950s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.093629306s s2n_quic:server: platform_tx: count=1 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.093643443s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.093676835s s2n_quic:server:conn: datagram_received: len=43 id=0 1.093708555s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 1 } id=0 1.093730336s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 1, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 0, ack_range_count: 1 } id=0 1.093761173s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=0 id=0 1.093785048s s2n_quic:server:conn: mtu_updated: path_id=0 mtu=1452 cause=ProbeAcknowledged search_complete=false id=0 1.093835172s s2n_quic:server:conn: ecn_state_changed: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } state=Capable id=0 1.093859718s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.256ms, delivered_bytes: 1452, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 143, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 45014 } id=0 1.093913198s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.256ms smoothed_rtt=33.726875ms latest_rtt=32.256ms rtt_variance=13.146625ms max_ack_delay=26ms pto_count=0 congestion_window=16140 bytes_in_flight=5577 congestion_limited=false id=0 1.093997406s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 8 } path_id=0 frame=Ping id=0 1.094054323s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 8 } path_id=0 frame=Padding id=0 1.094086012s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 8 } packet_len=5202 id=0 1.094101381s s2n_quic:server:conn: datagram_sent: len=5202 gso_offset=0 id=0 1.094133431s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x8e358badec2f5ee69636bb6ce5ced3e2, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.256ms smoothed_rtt=33.726875ms latest_rtt=32.256ms rtt_variance=13.146625ms max_ack_delay=26ms pto_count=0 congestion_window=16140 bytes_in_flight=10779 congestion_limited=false id=0 1.094182954s s2n_quic:server: platform_event_loop_sleep: timeout=Some(112.108ms) processing_duration=591µs 1.094260068s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.094286348s s2n_quic:server: platform_tx_error: errno=90 1.094297899s s2n_quic:server: platform_tx: count=0 syscalls=1 blocked_syscalls=0 total_errors=1 dropped_errors=0 1.094310152s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.094341200s s2n_quic:server:conn: datagram_received: len=45 id=0 1.094371447s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 2 } id=0 1.094388880s s2n_quic:server:conn: connection_id_updated: path_id=0 cid_consumer=Remote previous=0x8e358badec2f5ee69636bb6ce5ced3e2 current=0x1446b800e89346f44ee2a855ae692f04 id=0 1.094412284s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 2 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 2, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 1, ack_range_count: 1 } id=0 1.094433974s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 2 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=1 id=0 1.094456717s s2n_quic:server:conn: handshake_status_updated: status=HandshakeDoneAcked id=0 1.094498916s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.256ms, delivered_bytes: 1749, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 143, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 54222 } id=0 1.094527860s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.256ms smoothed_rtt=33.623763ms latest_rtt=32.922ms rtt_variance=10.066186ms max_ack_delay=26ms pto_count=0 congestion_window=16437 bytes_in_flight=10482 congestion_limited=false id=0 1.094560592s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 2 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=RetireConnectionId id=0 1.094628639s s2n_quic:server: platform_event_loop_sleep: timeout=Some(24.703ms) processing_duration=368µs 1.095765540s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.095795065s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.095827757s s2n_quic:server:conn: datagram_received: len=43 id=0 1.095858204s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 3 } id=0 1.095901064s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 3 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 4, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 3, ack_range_count: 1 } id=0 1.095930078s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 3 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=3 id=0 1.095983959s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.256ms, delivered_bytes: 4213, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 143, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 130611 } id=0 1.096014517s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.256ms smoothed_rtt=33.57479ms latest_rtt=33.237ms rtt_variance=7.647578ms max_ack_delay=26ms pto_count=0 congestion_window=18901 bytes_in_flight=8018 congestion_limited=false id=0 1.096073237s s2n_quic:server: platform_event_loop_sleep: timeout=Some(23.257ms) processing_duration=309µs 1.097222561s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.097252136s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.097284517s s2n_quic:server:conn: datagram_received: len=43 id=0 1.097314613s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 4 } id=0 1.097336003s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 4 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 6, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 5, ack_range_count: 1 } id=0 1.097358135s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 4 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=5 id=0 1.097406445s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.256ms, delivered_bytes: 5937, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 143, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 184058 } id=0 1.097435600s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.256ms smoothed_rtt=33.713561ms latest_rtt=34.694ms rtt_variance=6.013234ms max_ack_delay=26ms pto_count=0 congestion_window=20625 bytes_in_flight=6294 congestion_limited=false id=0 1.097500892s s2n_quic:server: platform_event_loop_sleep: timeout=Some(21.83ms) processing_duration=279µs 1.098085318s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.098114613s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.098146893s s2n_quic:server:conn: datagram_received: len=43 id=0 1.098177030s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 5 } id=0 1.098198300s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 5 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 8, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 7, ack_range_count: 1 } id=0 1.098220201s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 5 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=7 id=0 1.098275494s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.256ms, delivered_bytes: 7029, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 143, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 217912 } id=0 1.098306111s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.256ms smoothed_rtt=33.79024ms latest_rtt=34.334ms rtt_variance=4.663283ms max_ack_delay=26ms pto_count=0 congestion_window=21717 bytes_in_flight=5202 congestion_limited=false id=0 1.098384388s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 9 } path_id=0 frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 6, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 5, ack_range_count: 1 } id=0 1.098410307s s2n_quic:server:conn: ack_range_sent: packet_header=OneRtt { number: 9 } path_id=0 ack_range=1..=5 id=0 1.098435424s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 9 } path_id=0 frame=Padding id=0 1.098465220s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 9 } packet_len=43 id=0 1.098480118s s2n_quic:server:conn: datagram_sent: len=43 gso_offset=0 id=0 1.098511977s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.256ms smoothed_rtt=33.79024ms latest_rtt=34.334ms rtt_variance=4.663283ms max_ack_delay=26ms pto_count=0 congestion_window=21717 bytes_in_flight=5202 congestion_limited=false id=0 1.098561019s s2n_quic:server: platform_event_loop_sleep: timeout=Some(32.057ms) processing_duration=477µs 1.098666858s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.098693538s s2n_quic:server: platform_tx: count=1 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.098706352s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.098743261s s2n_quic:server:conn: datagram_received: len=38 id=0 1.098774640s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 6 } id=0 1.098793495s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 6 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=ConnectionClose id=0 1.098816458s s2n_quic:server:conn: connection_close_frame_received: packet_header=OneRtt { number: 6 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x1446b800e89346f44ee2a855ae692f04, remote_addr: [::ffff:193.167.0.100]:35653, remote_cid: 0x, id: 0, is_active: true } frame=ConnectionCloseFrame { error_code: 0, frame_type: None, reason: None } id=0 1.098838930s s2n_quic:server:conn: connection_closed: error=Application { error: application::Error(0), initiator: Remote, source: Location { file: "/app/quic/s2n-quic-transport/src/space/mod.rs", line: 966, col: 32 } } id=0 1.098908480s s2n_quic:server: platform_event_loop_sleep: timeout=None processing_duration=243µs 1.098991656s s2n_quic_qns::server::h09: Final stats: MyConnectionContext { packet_sent: 12, stream_requests: 1 } 1.099916520s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.099960502s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.099989506s s2n_quic:server: version_information: server_versions=[1] client_versions=[] chosen_version=Some(1) 1.100174373s s2n_quic:server:conn: key_update: key_type=Initial cipher_suite=TLS_AES_128_GCM_SHA256 id=1 1.100219658s s2n_quic:server:conn: connection_started: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } id=1 1.100247470s s2n_quic:server:conn: mtu_updated: path_id=0 mtu=1232 cause=NewPath search_complete=false id=1 1.100267417s s2n_quic:server:conn: datagram_received: len=1280 id=1 1.100305258s s2n_quic:server:conn: frame_received: packet_header=Initial { number: 0, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Padding id=1 1.100336036s s2n_quic:server:conn: frame_received: packet_header=Initial { number: 0, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Crypto { offset: 0, len: 464 } id=1 1.100368687s s2n_quic:server:conn: tls_client_hello: payload=[[3, 3, 146, 234, 42, 213, 206, 154, 170, 61, 44, 115, 102, 149, 148, 238, 166, 19, 45, 139, 19, 205, 59, 210, 133, 42, 70, 53, 207, 32, 145, 87, 233, 157, 0, 0, 6, 19, 1, 19, 2, 19, 3, 1, 0, 1, 157, 0, 0, 0, 12, 0, 10, 0, 0, 7, 115, 101, 114, 118, 101, 114, 52, 0, 11, 0, 2, 1, 0, 0, 35, 0, 0, 255, 1, 0, 1, 0, 0, 23, 0, 0, 0, 18, 0, 0, 0, 57, 0, 60, 83, 185, 7, 249, 105, 136, 149, 213, 222, 131, 5, 4, 128, 8, 0, 0, 6, 4, 128, 8, 0, 0, 7, 4, 128, 8, 0, 0, 4, 4, 128, 12, 0, 0, 8, 2, 64, 100, 9, 2, 64, 100, 1, 4, 128, 0, 117, 48, 3, 2, 69, 172, 11, 1, 26, 14, 1, 4, 15, 0, 0, 5, 0, 5, 1, 0, 0, 0, 0, 0, 10, 0, 10, 0, 8, 0, 29, 0, 23, 0, 24, 0, 25, 0, 13, 0, 26, 0, 24, 8, 4, 4, 3, 8, 7, 8, 5, 8, 6, 4, 1, 5, 1, 6, 1, 5, 3, 6, 3, 2, 1, 2, 3, 0, 16, 0, 13, 0, 11, 10, 104, 113, 45, 105, 110, 116, 101, 114, 111, 112, 0, 43, 0, 3, 2, 3, 4, 0, 51, 0, 38, 0, 36, 0, 29, 0, 32, 218, 94, 64, 159, 115, 56, 40, 124, 196, 43, 253, 2, 226, 81, 107, 240, 3, 205, 96, 7, 61, 122, 131, 53, 130, 163, 241, 42, 176, 159, 104, 76, 0, 45, 0, 2, 1, 1, 0, 41, 0, 181, 0, 144, 0, 138, 1, 107, 101, 121, 110, 97, 109, 101, 0, 0, 0, 0, 0, 0, 0, 0, 0, 80, 216, 3, 210, 109, 82, 1, 139, 252, 228, 215, 58, 148, 65, 115, 187, 114, 166, 34, 47, 93, 141, 219, 106, 33, 27, 218, 108, 130, 84, 14, 252, 244, 89, 176, 99, 185, 89, 162, 77, 60, 154, 189, 124, 111, 186, 254, 35, 192, 64, 126, 244, 126, 177, 171, 120, 219, 37, 45, 192, 20, 239, 114, 213, 67, 193, 121, 235, 126, 161, 18, 188, 147, 136, 226, 224, 201, 140, 36, 224, 151, 179, 247, 189, 219, 81, 191, 79, 49, 162, 18, 5, 121, 128, 85, 23, 15, 48, 55, 96, 78, 196, 148, 67, 85, 73, 102, 51, 186, 28, 223, 248, 73, 149, 152, 16, 211, 6, 43, 181, 46, 129, 135, 250, 111, 0, 33, 32, 219, 96, 195, 226, 144, 207, 74, 230, 43, 122, 184, 172, 211, 44, 219, 227, 60, 51, 112, 192, 214, 57, 81, 58, 183, 127, 51, 73, 15, 223, 128, 252]] id=1 1.100692674s s2n_quic:server:conn: key_update: key_type=Handshake cipher_suite=TLS_AES_128_GCM_SHA256 id=1 1.100809974s s2n_quic:server:conn: application_protocol_information: chosen_application_protocol=[104, 113, 45, 105, 110, 116, 101, 114, 111, 112] id=1 1.100841654s s2n_quic:server:conn: server_name_information: chosen_server_name="server4" id=1 1.100865619s s2n_quic:server:conn: key_exchange_group: chosen_group_name="x25519" contains_kem=false id=1 1.100909210s s2n_quic:server:conn: transport_parameters_received: transport_parameters=TransportParameters { original_destination_connection_id: None, initial_source_connection_id: Some(0x), retry_source_connection_id: None, stateless_reset_token: None, preferred_address: None, migration_support: true, max_idle_timeout: 30s, ack_delay_exponent: 3, max_ack_delay: 26ms, max_udp_payload_size: 1452, active_connection_id_limit: 4, initial_max_stream_data_bidi_local: 524288, initial_max_stream_data_bidi_remote: 524288, initial_max_stream_data_uni: 524288, initial_max_streams_bidi: 100, initial_max_streams_uni: 100, max_datagram_frame_size: 0, dc_supported_versions: [] } id=1 1.100975625s s2n_quic:server:conn: key_update: key_type=OneRtt { generation: 0 } cipher_suite=TLS_AES_128_GCM_SHA256 id=1 1.101126357s s2n_quic:server:conn: frame_sent: packet_header=Initial { number: 0, version: 1 } path_id=0 frame=Ack { ecn_counts: None, largest_acknowledged: 0, ack_range_count: 1 } id=1 1.101160160s s2n_quic:server:conn: ack_range_sent: packet_header=Initial { number: 0, version: 1 } path_id=0 ack_range=0..=0 id=1 1.101181611s s2n_quic:server:conn: frame_sent: packet_header=Initial { number: 0, version: 1 } path_id=0 frame=Crypto { offset: 0, len: 96 } id=1 1.101221596s s2n_quic:server:conn: packet_sent: packet_header=Initial { number: 0, version: 1 } packet_len=149 id=1 1.101258565s s2n_quic:server:conn: frame_sent: packet_header=Handshake { number: 0, version: 1 } path_id=0 frame=Crypto { offset: 0, len: 132 } id=1 1.101282470s s2n_quic:server:conn: frame_sent: packet_header=Handshake { number: 0, version: 1 } path_id=0 frame=Padding id=1 1.101321974s s2n_quic:server:conn: packet_sent: packet_header=Handshake { number: 0, version: 1 } packet_len=1083 id=1 1.101351459s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=1 1.101398918s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=333ms smoothed_rtt=333ms latest_rtt=333ms rtt_variance=166.5ms max_ack_delay=26ms pto_count=0 congestion_window=12320 bytes_in_flight=1232 congestion_limited=false id=1 1.101463118s s2n_quic:server: platform_event_loop_sleep: timeout=Some(998.63ms) processing_duration=1.548ms 1.134628338s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.134663614s s2n_quic:server: platform_tx: count=1 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.134683883s s2n_quic:server: platform_rx: count=2 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.134710332s s2n_quic:server: version_information: server_versions=[1] client_versions=[] chosen_version=Some(1) 1.134735499s s2n_quic:server:conn: datagram_received: len=1280 id=1 1.134764443s s2n_quic:server:conn: packet_received: packet_header=Initial { number: 1, version: 1 } id=1 1.134785523s s2n_quic:server:conn: frame_received: packet_header=Initial { number: 1, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 1, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 0, ack_range_count: 1 } id=1 1.134808005s s2n_quic:server:conn: ack_range_received: packet_header=Initial { number: 1, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=0 id=1 1.134841548s s2n_quic:server:conn: pacing_rate_updated: path_id=0 bytes_per_second=1005122 burst_size=12320 pacing_gain=2.77 id=1 1.134864782s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 33.613ms, delivered_bytes: 149, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 0, bytes_in_flight: 149, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 4432 } id=1 1.134915477s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.613ms smoothed_rtt=33.613ms latest_rtt=33.613ms rtt_variance=16.8065ms max_ack_delay=26ms pto_count=0 congestion_window=12469 bytes_in_flight=1083 congestion_limited=false id=1 1.134969688s s2n_quic:server:conn: frame_received: packet_header=Initial { number: 1, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Padding id=1 1.135020984s s2n_quic:server:conn: packet_received: packet_header=Handshake { number: 0, version: 1 } id=1 1.135043306s s2n_quic:server:conn: frame_received: packet_header=Handshake { number: 0, version: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Crypto { offset: 0, len: 36 } id=1 1.135088160s s2n_quic:server:conn: key_space_discarded: space=Initial id=1 1.135102948s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.613ms smoothed_rtt=33.613ms latest_rtt=33.613ms rtt_variance=16.8065ms max_ack_delay=26ms pto_count=0 congestion_window=12469 bytes_in_flight=1083 congestion_limited=false id=1 1.135189270s s2n_quic:server:conn: handshake_status_updated: status=Complete id=1 1.135210129s s2n_quic:server:conn: handshake_status_updated: status=Confirmed id=1 1.135237049s s2n_quic:server:conn: tls_exporter_ready: session=TlsSession { .. } id=1 1.135265542s s2n_quic:server:conn: key_space_discarded: space=Handshake id=1 1.135280491s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.613ms smoothed_rtt=33.613ms latest_rtt=33.613ms rtt_variance=16.8065ms max_ack_delay=26ms pto_count=0 congestion_window=12469 bytes_in_flight=1083 congestion_limited=false id=1 1.135381500s s2n_quic:server:conn: datagram_received: len=51 id=1 1.135466129s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 0 } path_id=0 frame=Ping id=1 1.135499200s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 0 } path_id=0 frame=Padding id=1 1.135529668s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 0 } packet_len=1452 id=1 1.135544916s s2n_quic:server:conn: datagram_sent: len=1452 gso_offset=0 id=1 1.135572959s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=HandshakeDone id=1 1.135604578s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=NewConnectionId { sequence_number: 1, retire_prior_to: 1 } id=1 1.135618845s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=NewConnectionId { sequence_number: 2, retire_prior_to: 1 } id=1 1.135631468s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 1 } path_id=0 frame=NewConnectionId { sequence_number: 3, retire_prior_to: 1 } id=1 1.135662146s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 1 } packet_len=127 id=1 1.135678747s s2n_quic:server:conn: datagram_sent: len=127 gso_offset=0 id=1 1.135709485s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.613ms smoothed_rtt=33.613ms latest_rtt=33.613ms rtt_variance=16.8065ms max_ack_delay=26ms pto_count=0 congestion_window=12469 bytes_in_flight=1579 congestion_limited=false id=1 1.135766812s s2n_quic:server: platform_event_loop_sleep: timeout=Some(126.521ms) processing_duration=1.14ms Accepted a QUIC connection from [::ffff:193.167.0.100]:51205 on 193.167.100.100:443 1.135945797s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.135974732s s2n_quic:server: platform_tx: count=2 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.135987596s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.136018965s s2n_quic:server:conn: datagram_received: len=54 id=1 1.136049031s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 0 } id=1 1.136067506s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 0 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Stream { id: 0, offset: 0, len: 17, is_fin: true } id=1 1.136132838s s2n_quic:server:conn: rx_stream_progress: bytes=17 id=1 1.136187441s s2n_quic:server: platform_event_loop_sleep: timeout=Some(24.82ms) processing_duration=243µs 1.136395030s s2n_quic_qns::server::h09: 4096 bytes ready to send on Stream(0) 1.136434573s s2n_quic_qns::server::h09: 4096 bytes sent on Stream(0) 1.136494536s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=false tx_ready=false application_wakeup=true 1.136550471s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 2 } path_id=0 frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 1, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 0, ack_range_count: 1 } id=1 1.136571520s s2n_quic:server:conn: ack_range_sent: packet_header=OneRtt { number: 2 } path_id=0 ack_range=0..=0 id=1 1.136591127s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 2 } path_id=0 frame=HandshakeDone id=1 1.136619781s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 2 } path_id=0 frame=Stream { id: 0, offset: 0, len: 1202, is_fin: false } id=1 1.136659896s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 2 } packet_len=1232 id=1 1.136676637s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=1 1.136706593s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 3 } path_id=0 frame=HandshakeDone id=1 1.136737040s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 3 } path_id=0 frame=Stream { id: 0, offset: 1202, len: 1209, is_fin: false } id=1 1.136771395s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 3 } packet_len=1232 id=1 1.136787515s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=1 1.136815708s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 4 } path_id=0 frame=HandshakeDone id=1 1.136845253s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 4 } path_id=0 frame=Stream { id: 0, offset: 2411, len: 1209, is_fin: false } id=1 1.136904364s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 4 } packet_len=1232 id=1 1.136929912s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=1 1.136962854s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 5 } path_id=0 frame=HandshakeDone id=1 1.136996537s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 5 } path_id=0 frame=Stream { id: 0, offset: 3620, len: 476, is_fin: false } id=1 1.137034087s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 5 } packet_len=501 id=1 1.137050718s s2n_quic:server:conn: datagram_sent: len=501 gso_offset=0 id=1 1.137083239s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.613ms smoothed_rtt=33.613ms latest_rtt=33.613ms rtt_variance=16.8065ms max_ack_delay=26ms pto_count=0 congestion_window=12469 bytes_in_flight=5776 congestion_limited=false id=1 1.137112835s s2n_quic:server:conn: tx_stream_progress: bytes=4096 id=1 1.137147279s s2n_quic:server: platform_event_loop_sleep: timeout=Some(126.217ms) processing_duration=653µs 1.137259319s s2n_quic_qns::server::h09: 4096 bytes ready to send on Stream(0) 1.137296158s s2n_quic_qns::server::h09: 4096 bytes sent on Stream(0) 1.137356471s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=false tx_ready=false application_wakeup=true 1.137383672s s2n_quic:server: platform_tx: count=4 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.137419550s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 6 } path_id=0 frame=HandshakeDone id=1 1.137453263s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 6 } path_id=0 frame=Stream { id: 0, offset: 4096, len: 1209, is_fin: false } id=1 1.137491655s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 6 } packet_len=1232 id=1 1.137507945s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=1 1.137537921s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 7 } path_id=0 frame=HandshakeDone id=1 1.137567697s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 7 } path_id=0 frame=Stream { id: 0, offset: 5305, len: 1209, is_fin: false } id=1 1.137601520s s2n_quic:server:conn: ecn_state_changed: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } state=Unknown id=1 1.137628161s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 7 } packet_len=1232 id=1 1.137641656s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=1 1.137671031s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 8 } path_id=0 frame=HandshakeDone id=1 1.137701859s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 8 } path_id=0 frame=Stream { id: 0, offset: 6514, len: 1209, is_fin: false } id=1 1.137741874s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 8 } packet_len=1232 id=1 1.137758425s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=1 1.137791427s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 9 } path_id=0 frame=HandshakeDone id=1 1.137823476s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 9 } path_id=0 frame=Stream { id: 0, offset: 7723, len: 469, is_fin: false } id=1 1.137858322s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 9 } packet_len=494 id=1 1.137874302s s2n_quic:server:conn: datagram_sent: len=494 gso_offset=0 id=1 1.137939063s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.613ms smoothed_rtt=33.613ms latest_rtt=33.613ms rtt_variance=16.8065ms max_ack_delay=26ms pto_count=0 congestion_window=12469 bytes_in_flight=9966 congestion_limited=false id=1 1.137969821s s2n_quic:server:conn: tx_stream_progress: bytes=4096 id=1 1.138003865s s2n_quic:server: platform_event_loop_sleep: timeout=Some(126.235ms) processing_duration=648µs 1.138113861s s2n_quic_qns::server::h09: 2048 bytes ready to send on Stream(0) 1.138150389s s2n_quic_qns::server::h09: 2048 bytes sent on Stream(0) 1.138208097s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=false tx_ready=false application_wakeup=true 1.138234847s s2n_quic:server: platform_tx: count=4 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.138270374s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 10 } path_id=0 frame=HandshakeDone id=1 1.138304117s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 10 } path_id=0 frame=Stream { id: 0, offset: 8192, len: 1209, is_fin: false } id=1 1.138346888s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 10 } packet_len=1232 id=1 1.138364290s s2n_quic:server:conn: datagram_sent: len=1232 gso_offset=0 id=1 1.138393315s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 11 } path_id=0 frame=HandshakeDone id=1 1.138424343s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 11 } path_id=0 frame=Stream { id: 0, offset: 9401, len: 839, is_fin: false } id=1 1.138457986s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 11 } packet_len=864 id=1 1.138473445s s2n_quic:server:conn: datagram_sent: len=864 gso_offset=0 id=1 1.138505014s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=33.613ms smoothed_rtt=33.613ms latest_rtt=33.613ms rtt_variance=16.8065ms max_ack_delay=26ms pto_count=0 congestion_window=12469 bytes_in_flight=12062 congestion_limited=true id=1 1.138534369s s2n_quic:server:conn: tx_stream_progress: bytes=2048 id=1 1.138574675s s2n_quic:server: platform_event_loop_sleep: timeout=Some(126.516ms) processing_duration=366µs 1.138720348s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=false tx_ready=false application_wakeup=true 1.138749712s s2n_quic:server: platform_tx: count=2 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.138768879s s2n_quic:server: platform_event_loop_sleep: timeout=Some(126.32ms) processing_duration=51µs 1.167642822s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.167689951s s2n_quic:server: platform_rx: count=2 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.167735086s s2n_quic:server:conn: datagram_received: len=43 id=1 1.167776183s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 1 } id=1 1.167805307s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 1, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 0, ack_range_count: 1 } id=1 1.167835494s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 1 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=0 id=1 1.167864929s s2n_quic:server:conn: mtu_updated: path_id=0 mtu=1452 cause=ProbeAcknowledged search_complete=false id=1 1.167955960s s2n_quic:server:conn: ecn_state_changed: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } state=Capable id=1 1.167989713s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.268ms, delivered_bytes: 1452, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 149, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 44998 } id=1 1.168022053s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x309da64f9c3d22ac4818dad8ce2664f6, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=33.444875ms latest_rtt=32.268ms rtt_variance=12.941125ms max_ack_delay=26ms pto_count=0 congestion_window=16147 bytes_in_flight=10610 congestion_limited=false id=1 1.168114106s s2n_quic:server:conn: datagram_received: len=45 id=1 1.168153169s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 2 } id=1 1.168168287s s2n_quic:server:conn: connection_id_updated: path_id=0 cid_consumer=Remote previous=0x309da64f9c3d22ac4818dad8ce2664f6 current=0x84749ea7c95317696d0f57b73d878613 id=1 1.168190619s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 2 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 2, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 1, ack_range_count: 1 } id=1 1.168211528s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 2 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=1 id=1 1.168232067s s2n_quic:server:conn: handshake_status_updated: status=HandshakeDoneAcked id=1 1.168272813s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.268ms, delivered_bytes: 1579, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 149, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 48933 } id=1 1.168301327s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=33.297763ms latest_rtt=32.268ms rtt_variance=10.000061ms max_ack_delay=26ms pto_count=0 congestion_window=16274 bytes_in_flight=10483 congestion_limited=false id=1 1.168327877s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 2 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=RetireConnectionId id=1 1.168394381s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 12 } path_id=0 frame=Ping id=1 1.168449505s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 12 } path_id=0 frame=Padding id=1 1.168477958s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 12 } packet_len=5202 id=1 1.168492595s s2n_quic:server:conn: datagram_sent: len=5202 gso_offset=0 id=1 1.168522892s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=33.297763ms latest_rtt=32.268ms rtt_variance=10.000061ms max_ack_delay=26ms pto_count=0 congestion_window=16274 bytes_in_flight=15685 congestion_limited=true id=1 1.168578717s s2n_quic:server: platform_event_loop_sleep: timeout=Some(24.14ms) processing_duration=939µs 1.169661045s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.169690520s s2n_quic:server: platform_tx_error: errno=90 1.169701761s s2n_quic:server: platform_tx: count=0 syscalls=1 blocked_syscalls=0 total_errors=1 dropped_errors=0 1.169714044s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.169745443s s2n_quic:server:conn: datagram_received: len=43 id=1 1.169775520s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 3 } id=1 1.169796970s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 3 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 4, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 3, ack_range_count: 1 } id=1 1.169819372s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 3 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=3 id=1 1.169868584s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.268ms, delivered_bytes: 4043, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 149, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 125294 } id=1 1.169925210s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=33.28579ms latest_rtt=33.207ms rtt_variance=7.523985ms max_ack_delay=26ms pto_count=0 congestion_window=18738 bytes_in_flight=13221 congestion_limited=false id=1 1.170011061s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 13 } path_id=0 frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 4, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 3, ack_range_count: 1 } id=1 1.170037681s s2n_quic:server:conn: ack_range_sent: packet_header=OneRtt { number: 13 } path_id=0 ack_range=1..=3 id=1 1.170064912s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 13 } path_id=0 frame=Stream { id: 0, offset: 10240, len: 0, is_fin: true } id=1 1.170085190s s2n_quic:server:conn: frame_sent: packet_header=OneRtt { number: 13 } path_id=0 frame=Padding id=1 1.170116008s s2n_quic:server:conn: packet_sent: packet_header=OneRtt { number: 13 } packet_len=43 id=1 1.170131327s s2n_quic:server:conn: datagram_sent: len=43 gso_offset=0 id=1 1.170165200s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=33.28579ms latest_rtt=33.207ms rtt_variance=7.523985ms max_ack_delay=26ms pto_count=0 congestion_window=18738 bytes_in_flight=13264 congestion_limited=false id=1 1.170216246s s2n_quic:server: platform_event_loop_sleep: timeout=Some(89.15ms) processing_duration=557µs 1.171111955s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.171143454s s2n_quic:server: platform_tx: count=1 syscalls=1 blocked_syscalls=0 total_errors=0 dropped_errors=0 1.171156658s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.171188197s s2n_quic:server:conn: datagram_received: len=43 id=1 1.171218364s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 4 } id=1 1.171239904s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 4 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 6, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 5, ack_range_count: 1 } id=1 1.171261986s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 4 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=5 id=1 1.171311037s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.268ms, delivered_bytes: 5776, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 149, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 179000 } id=1 1.171340272s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=33.455436ms latest_rtt=34.649ms rtt_variance=5.98229ms max_ack_delay=26ms pto_count=0 congestion_window=20471 bytes_in_flight=11531 congestion_limited=false id=1 1.171407168s s2n_quic:server: platform_event_loop_sleep: timeout=Some(81.966ms) processing_duration=296µs 1.173189789s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.173228922s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.173280308s s2n_quic:server:conn: datagram_received: len=43 id=1 1.173322507s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 5 } id=1 1.173350951s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 5 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 8, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 7, ack_range_count: 1 } id=1 1.173380456s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 5 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=7 id=1 1.173443654s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.268ms, delivered_bytes: 8240, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 149, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 255361 } id=1 1.173482638s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=33.755378ms latest_rtt=35.861ms rtt_variance=5.086607ms max_ack_delay=26ms pto_count=0 congestion_window=22935 bytes_in_flight=9067 congestion_limited=false id=1 1.173571434s s2n_quic:server: platform_event_loop_sleep: timeout=Some(76.519ms) processing_duration=382µs 1.174574123s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.174613447s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.174645988s s2n_quic:server:conn: datagram_received: len=43 id=1 1.174676204s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 6 } id=1 1.174697444s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 6 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 8, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 9, ack_range_count: 1 } id=1 1.174719616s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 6 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=9 id=1 1.174768488s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.268ms, delivered_bytes: 9966, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 149, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 308850 } id=1 1.174797782s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=34.189329ms latest_rtt=37.232ms rtt_variance=4.682858ms max_ack_delay=26ms pto_count=0 congestion_window=24661 bytes_in_flight=7341 congestion_limited=false id=1 1.174864507s s2n_quic:server: platform_event_loop_sleep: timeout=Some(74.043ms) processing_duration=290µs 1.176267707s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.176297182s s2n_quic:server: platform_rx: count=1 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.176335284s s2n_quic:server:conn: datagram_received: len=43 id=1 1.176366753s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 7 } id=1 1.176387983s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 7 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 8, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 11, ack_range_count: 1 } id=1 1.176409984s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 7 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=0..=11 id=1 1.176457683s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 32.268ms, delivered_bytes: 12062, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 149, bytes_in_flight: 1452, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 373806 } id=1 1.176494813s s2n_quic:server:conn: pacing_rate_updated: path_id=0 bytes_per_second=1025091 burst_size=2904 pacing_gain=2.77 id=1 1.176524298s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=32.268ms smoothed_rtt=34.673787ms latest_rtt=38.07ms rtt_variance=4.481059ms max_ack_delay=26ms pto_count=0 congestion_window=26757 bytes_in_flight=5245 congestion_limited=false id=1 1.176588018s s2n_quic:server: platform_event_loop_sleep: timeout=Some(71.999ms) processing_duration=321µs 1.201105023s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=false rx_ready=true tx_ready=false application_wakeup=false 1.201185203s s2n_quic:server: platform_rx: count=2 syscalls=2 blocked_syscalls=1 total_errors=0 dropped_errors=0 1.201254523s s2n_quic:server:conn: datagram_received: len=45 id=1 1.201329404s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 8 } id=1 1.201383034s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 8 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=Ack { ecn_counts: Some(EcnCounts { ect_0_count: 9, ect_1_count: 0, ce_count: 0 }), largest_acknowledged: 13, ack_range_count: 2 } id=1 1.201439129s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 8 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=13..=13 id=1 1.201540690s s2n_quic:server:conn: ack_range_received: packet_header=OneRtt { number: 8 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } ack_range=2..=11 id=1 1.201606663s s2n_quic:server:conn: delivery_rate_sampled: path_id=0 rate_sample=RateSample { interval: 34.539ms, delivered_bytes: 8062, lost_bytes: 0, ecn_ce_count: 0, is_app_limited: true, prior_delivered_bytes: 4192, bytes_in_flight: 13264, prior_lost_bytes: 0, prior_ecn_ce_count: 0, delivery_rate_bytes_per_second: 233417 } id=1 1.201655725s s2n_quic:server:conn: recovery_metrics: path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } min_rtt=31.23ms smoothed_rtt=34.243311ms latest_rtt=31.23ms rtt_variance=4.221738ms max_ack_delay=26ms pto_count=0 congestion_window=26800 bytes_in_flight=5202 congestion_limited=false id=1 1.201784657s s2n_quic:server:conn: datagram_received: len=38 id=1 1.201836965s s2n_quic:server:conn: packet_received: packet_header=OneRtt { number: 9 } id=1 1.201868324s s2n_quic:server:conn: frame_received: packet_header=OneRtt { number: 9 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=ConnectionClose id=1 1.201950748s s2n_quic:server:conn: connection_close_frame_received: packet_header=OneRtt { number: 9 } path=Path { local_addr: 193.167.100.100:443, local_cid: 0x84749ea7c95317696d0f57b73d878613, remote_addr: [::ffff:193.167.0.100]:51205, remote_cid: 0x, id: 0, is_active: true } frame=ConnectionCloseFrame { error_code: 0, frame_type: None, reason: None } id=1 1.201983459s s2n_quic:server:conn: connection_closed: error=Application { error: application::Error(0), initiator: Remote, source: Location { file: "/app/quic/s2n-quic-transport/src/space/mod.rs", line: 966, col: 32 } } id=1 1.202057108s s2n_quic:server: platform_event_loop_sleep: timeout=None processing_duration=962µs 1.202161603s s2n_quic_qns::server::h09: Final stats: MyConnectionContext { packet_sent: 16, stream_requests: 1 } 1.248690399s s2n_quic:server: platform_event_loop_wakeup: timeout_expired=true rx_ready=false tx_ready=false application_wakeup=false 1.248802609s s2n_quic:server: platform_event_loop_sleep: timeout=None processing_duration=125µs