--------------------------------- Captured Out ---------------------------------
---- new test ----
1788128000.281 sable_ircd     uid=1001
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.283612Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(882025222511792128)), timestamp: 1788128000, clock: EventClock(), target: Server(ServerId(1)), details: NewServer(NewServer { epoch: 1788128000, name: ServerName("My.Little.Server"), ts: 1788128000, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }; event clock=EventClock() my clock=EventClock()
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.283698Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.283821Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun#x1B[0m#x1B[2m:#x1B[0m#x1B[1mapply_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mevent#x1B[0m#x1B[2m=#x1B[0mEvent { id: EventId(Snowflake(882025222511792128)), timestamp: 1788128000, clock: EventClock(), target: Server(ServerId(1)), details: NewServer(NewServer { epoch: 1788128000, name: ServerName("My.Little.Server"), ts: 1788128000, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_server#x1B[0m#x1B[1m{#x1B[0m#x1B[3mdetail#x1B[0m#x1B[2m=#x1B[0mNewServer { server: ServerId(1) }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m enabling peer My.Little.Server
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.283958Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025222511792128)), timestamp: 1788128000, change: NewServer(NewServer { server: ServerId(1) }), users_to_notify: [] })
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.283991Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025222511792128)), timestamp: 1788128000, change: NewServer(NewServer { server: ServerId(1) }), users_to_notify: [] }
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.284028Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025222511792128)), timestamp: 1788128000, change: EventComplete(EventComplete), users_to_notify: [] })
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.284048Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025222511792128)), timestamp: 1788128000, change: EventComplete(EventComplete), users_to_notify: [] }
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.284415Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(882025222515986433)), timestamp: 1788128000, clock: EventClock(1 => 882025222511792128), target: Server(ServerId(1)), details: ServerPing(ServerPing { ts: 1788128000 }) }; event clock=EventClock(1 => 882025222511792128) my clock=EventClock(1 => 882025222511792128)
1788128000.284 sable_ircd     #x1B[2m2026-08-30T22:13:20.284465Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128000.285 sable_ircd     #x1B[2m2026-08-30T22:13:20.284630Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025222515986433)), timestamp: 1788128000, change: EventComplete(EventComplete), users_to_notify: [] })
1788128000.285 sable_ircd     #x1B[2m2026-08-30T22:13:20.284656Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025222515986433)), timestamp: 1788128000, change: EventComplete(EventComplete), users_to_notify: [] }
1788128000.286 sable_ircd     #x1B[2m2026-08-30T22:13:20.285652Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from reap_preclients_timer
1788128000.378 sable_ircd     #x1B[2m2026-08-30T22:13:20.377951Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m got new connection #x1B[3mdata#x1B[0m#x1B[2m=#x1B[0mConnectionData { id: ConnectionId(ListenerId(0), 1), remote_addr: 127.0.0.1, tls_info: None }
1788128000.378 sable_ircd     #x1B[2m2026-08-30T22:13:20.378077Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128000.378 sable_ircd     #x1B[2m2026-08-30T22:13:20.378111Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 1)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got new connection
1788128000.378 sable_ircd     #x1B[2m2026-08-30T22:13:20.378176Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 1)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 1): :My.Little.Server NOTICE * :*** Looking up your hostname
1788128000.378 sable_ircd     #x1B[2m2026-08-30T22:13:20.378271Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128000.378 sable_ircd     #x1B[2m2026-08-30T22:13:20.378310Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 1)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"QUIT :chkport"
1788128000.378 sable_ircd     #x1B[2m2026-08-30T22:13:20.378425Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 1): ERROR :Client quit
1788128000.379 sable_ircd     #x1B[2m2026-08-30T22:13:20.378504Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mCloseConnection(ConnectionId(ListenerId(0), 1))
1788128000.379 sable_ircd     #x1B[2m2026-08-30T22:13:20.378527Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::connection_collection#x1B[0m#x1B[2m:#x1B[0m Removing connection ConnectionId(ListenerId(0), 1)
1788128000.379 sable_ircd     #x1B[2m2026-08-30T22:13:20.378832Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m Connection error #x1B[3mconnection#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 1) #x1B[3merror#x1B[0m#x1B[2m=#x1B[0mClosed
1788128000.379 sable_ircd     #x1B[2m2026-08-30T22:13:20.378899Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128000.379 sable_ircd     #x1B[2m2026-08-30T22:13:20.379062Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from auth_events
1788128000.399 1: connects to server.
1788128000.399 1 -> S: NICK nick1
1788128000.399 1 -> S: USER username * * :Realname
1788128000.399 sable_ircd     #x1B[2m2026-08-30T22:13:20.398951Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m got new connection #x1B[3mdata#x1B[0m#x1B[2m=#x1B[0mConnectionData { id: ConnectionId(ListenerId(0), 2), remote_addr: 127.0.0.1, tls_info: None }
1788128000.399 sable_ircd     #x1B[2m2026-08-30T22:13:20.399046Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128000.399 sable_ircd     #x1B[2m2026-08-30T22:13:20.399073Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got new connection
1788128000.399 sable_ircd     #x1B[2m2026-08-30T22:13:20.399112Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server NOTICE * :*** Looking up your hostname
1788128000.399 sable_ircd     #x1B[2m2026-08-30T22:13:20.399231Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128000.399 sable_ircd     #x1B[2m2026-08-30T22:13:20.399269Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"NICK nick1"
1788128000.399 S -> 1: :My.Little.Server NOTICE * :*** Looking up your hostname
1788128000.399 sable_ircd     #x1B[2m2026-08-30T22:13:20.399419Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 646, tv_nsec: 520718383 }, attach_user_id: OnceLock(<uninit>), user: OnceLock(<uninit>), extra_user_params: OnceLock(<uninit>), nick: OnceLock(Nickname("nick1")), realname: OnceLock(<uninit>), hostname: OnceLock(<uninit>), sasl_session: Mutex { data: None }, sasl_account: OnceLock(<uninit>), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse
1788128000.399 sable_ircd     #x1B[2m2026-08-30T22:13:20.399474Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from async_handlers
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.399515Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.399544Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"USER username * * :Realname"
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.399610Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 646, tv_nsec: 520718383 }, attach_user_id: OnceLock(<uninit>), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(Nickname("nick1")), realname: OnceLock(Realname("Realname")), hostname: OnceLock(<uninit>), sasl_session: Mutex { data: None }, sasl_account: OnceLock(<uninit>), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.399959Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from auth_events
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.399988Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m DNS lookup finished for ConnectionId(ListenerId(0), 2): 127.0.0.1/Some(Hostname("localhost"))
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.400007Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server NOTICE * :*** Found your hostname: localhost
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.400022Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 646, tv_nsec: 520718383 }, attach_user_id: OnceLock(<uninit>), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(Nickname("nick1")), realname: OnceLock(Realname("Realname")), hostname: OnceLock(Hostname("localhost")), sasl_session: Mutex { data: None }, sasl_account: OnceLock(<uninit>), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mtrue #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.400051Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mRegisterClient(ConnectionId(ListenerId(0), 2))
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.400220Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(882025223002525698)), timestamp: 1788128000, clock: EventClock(1 => 882025222515986433), target: User(UserId(Snowflake(882025223002525696))), details: NewUser(NewUser { nickname: Nickname("nick1"), username: Username("username"), visible_hostname: Hostname("localhost"), realname: Realname("Realname"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(882025223002525697)), NewUserConnection { user: UserId(Snowflake(882025223002525696)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1788128000 })) }) }; event clock=EventClock(1 => 882025222515986433) my clock=EventClock(1 => 882025222515986433)
1788128000.400 S -> 1: :My.Little.Server NOTICE * :*** Found your hostname: localhost
1788128000.400 sable_ircd     #x1B[2m2026-08-30T22:13:20.400300Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400529Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025223002525698)), timestamp: 1788128000, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(882025223002525696)), 1) }), users_to_notify: [] })
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400558Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025223002525698)), timestamp: 1788128000, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(882025223002525696)), 1) }), users_to_notify: [] }
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400586Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025223002525698)), timestamp: 1788128000, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(882025223002525696)), 2), connection: UserConnectionId(Snowflake(882025223002525697)) }), users_to_notify: [] })
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400598Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025223002525698)), timestamp: 1788128000, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(882025223002525696)), 2), connection: UserConnectionId(Snowflake(882025223002525697)) }), users_to_notify: [] }
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400633Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 001 nick1 :Welcome to the test Internet Relay Chat network, nick1
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400648Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 002 nick1 :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400664Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 003 nick1 :This server was created 2026-08-30 22:13:20.400656930 UTC
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400675Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 004 nick1 My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400697Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 005 nick1 EXCEPTS INVEX FNC UTF8ONLY MONITOR=64 CASEMAPPING=ascii CLIENTTAGDENY=* HOSTLEN=64 NICKLEN=15 USERLEN=10 CHANMODES=bqeI,k,,ntsim MSGREFTYPES=timestamp PREFIX=(ov)@+ :are supported by this server
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400709Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 422 nick1 :MOTD File is missing
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400722Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :nick1!username@localhost MODE nick1 +
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400732Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server NOTICE nick1 :The network is currently running in debug mode. Do not send any sensitive information such as passwords.
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400748Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025223002525698)), timestamp: 1788128000, change: EventComplete(EventComplete), users_to_notify: [] })
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.400759Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025223002525698)), timestamp: 1788128000, change: EventComplete(EventComplete), users_to_notify: [] }
1788128000.401 S -> 1: :My.Little.Server 001 nick1 :Welcome to the test Internet Relay Chat network, nick1
1788128000.401 1 -> S: PING foo
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.401106Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.401134Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING foo"
1788128000.401 sable_ircd     #x1B[2m2026-08-30T22:13:20.401184Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server PONG My.Little.Server :foo
1788128000.501 1 -> S: PING synchronize646.62271897
1788128000.501 S -> 1: :My.Little.Server 002 nick1 :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432
1788128000.501 S -> 1: :My.Little.Server 003 nick1 :This server was created 2026-08-30 22:13:20.400656930 UTC
1788128000.501 S -> 1: :My.Little.Server 004 nick1 My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov
1788128000.501 S -> 1: :My.Little.Server 005 nick1 EXCEPTS INVEX FNC UTF8ONLY MONITOR=64 CASEMAPPING=ascii CLIENTTAGDENY=* HOSTLEN=64 NICKLEN=15 USERLEN=10 CHANMODES=bqeI,k,,ntsim MSGREFTYPES=timestamp PREFIX=(ov)@+ :are supported by this server
1788128000.501 S -> 1: :My.Little.Server 422 nick1 :MOTD File is missing
1788128000.501 S -> 1: :nick1!username@localhost MODE nick1 +
1788128000.501 S -> 1: :My.Little.Server NOTICE nick1 :The network is currently running in debug mode. Do not send any sensitive information such as passwords.
1788128000.501 S -> 1: :My.Little.Server PONG My.Little.Server :foo
1788128000.502 sable_ircd     #x1B[2m2026-08-30T22:13:20.501638Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128000.502 sable_ircd     #x1B[2m2026-08-30T22:13:20.501696Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize646.62271897"
1788128000.502 sable_ircd     #x1B[2m2026-08-30T22:13:20.501809Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server PONG My.Little.Server :synchronize646.62271897
1788128000.502 S -> 1: :My.Little.Server PONG My.Little.Server :synchronize646.62271897
1788128000.509 sable_history  #x1B[2m2027-08-30T23:58:51.009619Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014323346441183349)), timestamp: 1819670331, clock: EventClock(1 => 1014295401760559126, 50 => 1014323094782943348, 99 => 1014295404927660036), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819670331 }) }; event clock=EventClock(1 => 1014295401760559126, 50 => 1014323094782943348, 99 => 1014295404927660036) my clock=EventClock(1 => 1014295401760559126, 50 => 1014323094782943348, 99 => 1014295404927660036)
1788128000.509 sable_history  #x1B[2m2027-08-30T23:58:51.011031Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128000.899 sable_history  #x1B[2m2027-08-30T23:48:35.383021Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014320764318589034)), timestamp: 1819669715, clock: EventClock(1 => 1014295842380582945, 50 => 1014320512660349033, 99 => 1014295842997547013), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819669715 }) }; event clock=EventClock(1 => 1014295842380582945, 50 => 1014320512660349033, 99 => 1014295842997547013) my clock=EventClock(1 => 1014295842380582945, 50 => 1014320512660349033, 99 => 1014295842997547013)
1788128000.899 sable_history  #x1B[2m2027-08-30T23:48:35.384454Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128001.126 sable_history  #x1B[2m2027-08-31T00:01:40.340061Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014324056666873976)), timestamp: 1819670500, clock: EventClock(1 => 1014295353727389718, 50 => 1014323805004439671, 99 => 1014295356898684932), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819670500 }) }; event clock=EventClock(1 => 1014295353727389718, 50 => 1014323805004439671, 99 => 1014295356898684932) my clock=EventClock(1 => 1014295353727389718, 50 => 1014323805004439671, 99 => 1014295356898684932)
1788128001.126 sable_history  #x1B[2m2027-08-31T00:01:40.341490Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128001.137 sable_history  #x1B[2m2027-08-30T23:45:47.716192Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014320061072220262)), timestamp: 1819669547, clock: EventClock(1 => 1014295135892017153, 50 => 1014319809413980261), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819669547 }) }; event clock=EventClock(1 => 1014295135892017153, 50 => 1014319809413980261) my clock=EventClock(1 => 1014295135892017153, 50 => 1014319809413980261)
1788128001.137 sable_history  #x1B[2m2027-08-30T23:45:47.717482Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128001.203 2: connects to server.
1788128001.203 2 -> S: NICK nick2
1788128001.203 2 -> S: USER username * * :Realname
1788128001.204 sable_ircd     #x1B[2m2026-08-30T22:13:21.203962Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m got new connection #x1B[3mdata#x1B[0m#x1B[2m=#x1B[0mConnectionData { id: ConnectionId(ListenerId(0), 3), remote_addr: 127.0.0.1, tls_info: None }
1788128001.204 sable_ircd     #x1B[2m2026-08-30T22:13:21.204210Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128001.204 sable_ircd     #x1B[2m2026-08-30T22:13:21.204290Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got new connection
1788128001.204 sable_ircd     #x1B[2m2026-08-30T22:13:21.204348Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server NOTICE * :*** Looking up your hostname
1788128001.205 S -> 2: :My.Little.Server NOTICE * :*** Looking up your hostname
1788128001.205 sable_ircd     #x1B[2m2026-08-30T22:13:21.204615Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128001.205 sable_ircd     #x1B[2m2026-08-30T22:13:21.204710Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"NICK nick2"
1788128001.205 sable_ircd     #x1B[2m2026-08-30T22:13:21.204851Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 647, tv_nsec: 325944383 }, attach_user_id: OnceLock(<uninit>), user: OnceLock(<uninit>), extra_user_params: OnceLock(<uninit>), nick: OnceLock(Nickname("nick2")), realname: OnceLock(<uninit>), hostname: OnceLock(<uninit>), sasl_session: Mutex { data: None }, sasl_account: OnceLock(<uninit>), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse
1788128001.205 sable_ircd     #x1B[2m2026-08-30T22:13:21.204900Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from async_handlers
1788128001.205 sable_ircd     #x1B[2m2026-08-30T22:13:21.204974Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128001.205 sable_ircd     #x1B[2m2026-08-30T22:13:21.204989Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"USER username * * :Realname"
1788128001.205 sable_ircd     #x1B[2m2026-08-30T22:13:21.205037Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 647, tv_nsec: 325944383 }, attach_user_id: OnceLock(<uninit>), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(Nickname("nick2")), realname: OnceLock(Realname("Realname")), hostname: OnceLock(<uninit>), sasl_session: Mutex { data: None }, sasl_account: OnceLock(<uninit>), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.205526Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from auth_events
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.205552Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m DNS lookup finished for ConnectionId(ListenerId(0), 3): 127.0.0.1/Some(Hostname("localhost"))
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.205572Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server NOTICE * :*** Found your hostname: localhost
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.205588Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 647, tv_nsec: 325944383 }, attach_user_id: OnceLock(<uninit>), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(Nickname("nick2")), realname: OnceLock(Realname("Realname")), hostname: OnceLock(Hostname("localhost")), sasl_session: Mutex { data: None }, sasl_account: OnceLock(<uninit>), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mtrue #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.205618Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mRegisterClient(ConnectionId(ListenerId(0), 3))
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.205772Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(882025226378940419)), timestamp: 1788128001, clock: EventClock(1 => 882025223002525698), target: User(UserId(Snowflake(882025226378940418))), details: NewUser(NewUser { nickname: Nickname("nick2"), username: Username("username"), visible_hostname: Hostname("localhost"), realname: Realname("Realname"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(882025226378940419)), NewUserConnection { user: UserId(Snowflake(882025226378940418)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1788128001 })) }) }; event clock=EventClock(1 => 882025223002525698) my clock=EventClock(1 => 882025223002525698)
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.205851Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128001.206 S -> 2: :My.Little.Server NOTICE * :*** Found your hostname: localhost
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206057Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025226378940419)), timestamp: 1788128001, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(882025226378940418)), 1) }), users_to_notify: [] })
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206086Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025226378940419)), timestamp: 1788128001, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(882025226378940418)), 1) }), users_to_notify: [] }
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206125Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025226378940419)), timestamp: 1788128001, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(882025226378940418)), 2), connection: UserConnectionId(Snowflake(882025226378940419)) }), users_to_notify: [] })
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206143Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025226378940419)), timestamp: 1788128001, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(882025226378940418)), 2), connection: UserConnectionId(Snowflake(882025226378940419)) }), users_to_notify: [] }
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206192Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 001 nick2 :Welcome to the test Internet Relay Chat network, nick2
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206215Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 002 nick2 :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206241Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 003 nick2 :This server was created 2026-08-30 22:13:21.206231235 UTC
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206262Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 004 nick2 My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206288Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 005 nick2 EXCEPTS INVEX FNC UTF8ONLY MONITOR=64 CASEMAPPING=ascii CLIENTTAGDENY=* HOSTLEN=64 NICKLEN=15 USERLEN=10 CHANMODES=bqeI,k,,ntsim MSGREFTYPES=timestamp PREFIX=(ov)@+ :are supported by this server
1788128001.206 sable_ircd     #x1B[2m2026-08-30T22:13:21.206307Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 422 nick2 :MOTD File is missing
1788128001.207 sable_ircd     #x1B[2m2026-08-30T22:13:21.206496Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :nick2!username@localhost MODE nick2 +
1788128001.207 sable_ircd     #x1B[2m2026-08-30T22:13:21.206546Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server NOTICE nick2 :The network is currently running in debug mode. Do not send any sensitive information such as passwords.
1788128001.207 sable_ircd     #x1B[2m2026-08-30T22:13:21.206609Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025226378940419)), timestamp: 1788128001, change: EventComplete(EventComplete), users_to_notify: [] })
1788128001.207 sable_ircd     #x1B[2m2026-08-30T22:13:21.206630Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025226378940419)), timestamp: 1788128001, change: EventComplete(EventComplete), users_to_notify: [] }
1788128001.207 S -> 2: :My.Little.Server 001 nick2 :Welcome to the test Internet Relay Chat network, nick2
1788128001.207 2 -> S: PING foo
1788128001.208 sable_ircd     #x1B[2m2026-08-30T22:13:21.207779Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128001.208 sable_ircd     #x1B[2m2026-08-30T22:13:21.207922Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING foo"
1788128001.208 sable_ircd     #x1B[2m2026-08-30T22:13:21.207984Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server PONG My.Little.Server :foo
1788128001.307 2 -> S: PING synchronize647.428944466
1788128001.307 S -> 2: :My.Little.Server 002 nick2 :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432
1788128001.307 S -> 2: :My.Little.Server 003 nick2 :This server was created 2026-08-30 22:13:21.206231235 UTC
1788128001.307 S -> 2: :My.Little.Server 004 nick2 My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov
1788128001.308 S -> 2: :My.Little.Server 005 nick2 EXCEPTS INVEX FNC UTF8ONLY MONITOR=64 CASEMAPPING=ascii CLIENTTAGDENY=* HOSTLEN=64 NICKLEN=15 USERLEN=10 CHANMODES=bqeI,k,,ntsim MSGREFTYPES=timestamp PREFIX=(ov)@+ :are supported by this server
1788128001.308 S -> 2: :My.Little.Server 422 nick2 :MOTD File is missing
1788128001.308 S -> 2: :nick2!username@localhost MODE nick2 +
1788128001.308 S -> 2: :My.Little.Server NOTICE nick2 :The network is currently running in debug mode. Do not send any sensitive information such as passwords.
1788128001.308 S -> 2: :My.Little.Server PONG My.Little.Server :foo
1788128001.308 sable_ircd     #x1B[2m2026-08-30T22:13:21.307722Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128001.308 sable_ircd     #x1B[2m2026-08-30T22:13:21.307773Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize647.428944466"
1788128001.308 sable_ircd     #x1B[2m2026-08-30T22:13:21.307865Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server PONG My.Little.Server :synchronize647.428944466
1788128001.308 S -> 2: :My.Little.Server PONG My.Little.Server :synchronize647.428944466
1788128001.637 sable_history  #x1B[2m2027-08-31T00:04:46.047675Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014324835578486907)), timestamp: 1819670686, clock: EventClock(1 => 1014295552021499922, 50 => 1014324583920246906, 99 => 1014295555868078086), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819670686 }) }; event clock=EventClock(1 => 1014295552021499922, 50 => 1014324583920246906, 99 => 1014295555868078086) my clock=EventClock(1 => 1014295552021499922, 50 => 1014324583920246906, 99 => 1014295555868078086)
1788128001.637 sable_history  #x1B[2m2027-08-31T00:04:46.049126Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128001.756 sable_history  #x1B[2m2027-08-30T23:45:48.190623Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014320063060320358)), timestamp: 1819669548, clock: EventClock(1 => 1014295138538622977, 50 => 1014319811410468965), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819669548 }) }; event clock=EventClock(1 => 1014295138538622977, 50 => 1014319811410468965) my clock=EventClock(1 => 1014295138538622977, 50 => 1014319811410468965)
1788128001.756 sable_history  #x1B[2m2027-08-30T23:45:48.192486Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128001.964 sable_history  #x1B[2m2027-08-30T23:51:24.670903Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014321474363924589)), timestamp: 1819669884, clock: EventClock(1 => 1014295541992919062, 50 => 1014321222705684588, 99 => 1014295545160019972), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819669884 }) }; event clock=EventClock(1 => 1014295541992919062, 50 => 1014321222705684588, 99 => 1014295545160019972) my clock=EventClock(1 => 1014295541992919062, 50 => 1014321222705684588, 99 => 1014295545160019972)
1788128001.964 sable_history  #x1B[2m2027-08-30T23:51:24.672326Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128002.009 2 -> S: JOIN #chan1
1788128002.009 2 -> S: JOIN #chan2
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.009449Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.009511Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"JOIN #chan1"
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.009712Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.009737Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"JOIN #chan2"
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.009853Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(882025229751160836)), timestamp: 1788128002, clock: EventClock(1 => 882025226378940419), target: Channel(ChannelId(Snowflake(882025229751160836))), details: NewChannel(NewChannel { name: ChannelName("#chan1"), mode: ChannelMode { modes: ChannelModeSet(0), key: None } }) }; event clock=EventClock(1 => 882025226378940419) my clock=EventClock(1 => 882025226378940419)
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.010011Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.010069Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(882025229755355141)), timestamp: 1788128002, clock: EventClock(1 => 882025229751160836), target: Membership(MembershipId(UserId(Snowflake(882025226378940418)), ChannelId(Snowflake(882025229751160836)))), details: ChannelJoin(ChannelJoin { channel: ChannelId(Snowflake(882025229751160836)), user: UserId(Snowflake(882025226378940418)), permissions: MembershipFlagSet(1) }) }; event clock=EventClock(1 => 882025229751160836) my clock=EventClock(1 => 882025229751160836)
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.010155Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from async_handlers
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.010215Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.010369Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025229751160836)), timestamp: 1788128002, change: EventComplete(EventComplete), users_to_notify: [] })
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.010412Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025229751160836)), timestamp: 1788128002, change: EventComplete(EventComplete), users_to_notify: [] }
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.010447Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025229755355141)), timestamp: 1788128002, change: ChannelJoin(ChannelJoin { membership: MembershipId(UserId(Snowflake(882025226378940418)), ChannelId(Snowflake(882025229751160836))), user: HistoricUserId(UserId(Snowflake(882025226378940418)), 2) }), users_to_notify: [UserId(Snowflake(882025226378940418))] })
1788128002.010 sable_ircd     #x1B[2m2026-08-30T22:13:22.010462Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025229755355141)), timestamp: 1788128002, change: ChannelJoin(ChannelJoin { membership: MembershipId(UserId(Snowflake(882025226378940418)), ChannelId(Snowflake(882025229751160836))), user: HistoricUserId(UserId(Snowflake(882025226378940418)), 2) }), users_to_notify: [UserId(Snowflake(882025226378940418))] }
1788128002.011 sable_ircd     #x1B[2m2026-08-30T22:13:22.010511Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :nick2!username@localhost JOIN #chan1
1788128002.011 sable_ircd     #x1B[2m2026-08-30T22:13:22.010536Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :nick2!username@localhost MODE #chan1 +o nick2
1788128002.011 sable_ircd     #x1B[2m2026-08-30T22:13:22.010564Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 353 nick2 = #chan1 :@nick2
1788128002.011 sable_ircd     #x1B[2m2026-08-30T22:13:22.010575Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 366 nick2 #chan1 :End of names list
1788128002.011 sable_ircd     #x1B[2m2026-08-30T22:13:22.010595Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025229755355141)), timestamp: 1788128002, change: EventComplete(EventComplete), users_to_notify: [] })
1788128002.011 sable_ircd     #x1B[2m2026-08-30T22:13:22.010607Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025229755355141)), timestamp: 1788128002, change: EventComplete(EventComplete), users_to_notify: [] }
1788128002.109 2 -> S: PING synchronize648.230740569
1788128002.109 S -> 2: :nick2!username@localhost JOIN #chan1
1788128002.109 S -> 2: :nick2!username@localhost MODE #chan1 +o nick2
1788128002.109 S -> 2: :My.Little.Server 353 nick2 = #chan1 :@nick2
1788128002.109 S -> 2: :My.Little.Server 366 nick2 #chan1 :End of names list
1788128002.110 sable_ircd     #x1B[2m2026-08-30T22:13:22.109660Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128002.110 sable_ircd     #x1B[2m2026-08-30T22:13:22.109720Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize648.230740569"
1788128002.313 sable_history  #x1B[2m2027-08-30T23:45:48.941650Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014320066210242662)), timestamp: 1819669548, clock: EventClock(1 => 1014295140782575617, 50 => 1014319814556196965), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819669548 }) }; event clock=EventClock(1 => 1014295140782575617, 50 => 1014319814556196965) my clock=EventClock(1 => 1014295140782575617, 50 => 1014319814556196965)
1788128002.313 sable_history  #x1B[2m2027-08-30T23:45:48.943231Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128002.700 sable_history  #x1B[2m2027-08-30T23:54:14.293789Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014322185814351984)), timestamp: 1819670054, clock: EventClock(1 => 1014295494442094614, 50 => 1014321934156111983, 99 => 1014295497634361348), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819670054 }) }; event clock=EventClock(1 => 1014295494442094614, 50 => 1014321934156111983, 99 => 1014295497634361348) my clock=EventClock(1 => 1014295494442094614, 50 => 1014321934156111983, 99 => 1014295497634361348)
1788128002.700 sable_history  #x1B[2m2027-08-30T23:54:14.295200Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128002.746 sable_history  #x1B[2m2027-08-30T23:45:49.167696Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014320067162349670)), timestamp: 1819669549, clock: EventClock(1 => 1014295142766481409, 50 => 1014319815504109669), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819669549 }) }; event clock=EventClock(1 => 1014295142766481409, 50 => 1014319815504109669) my clock=EventClock(1 => 1014295142766481409, 50 => 1014319815504109669)
1788128002.746 sable_history  #x1B[2m2027-08-30T23:45:49.169109Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128003.110 2: waiting…
1788128003.114 sable_ircd     #x1B[2m2026-08-30T22:13:23.114264Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(882025234385866758)), timestamp: 1788128003, clock: EventClock(1 => 882025229755355141), target: Channel(ChannelId(Snowflake(882025234385866757))), details: NewChannel(NewChannel { name: ChannelName("#chan2"), mode: ChannelMode { modes: ChannelModeSet(0), key: None } }) }; event clock=EventClock(1 => 882025229755355141) my clock=EventClock(1 => 882025229755355141)
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.114469Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.114521Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(882025234385866759)), timestamp: 1788128003, clock: EventClock(1 => 882025234385866758), target: Membership(MembershipId(UserId(Snowflake(882025226378940418)), ChannelId(Snowflake(882025234385866757)))), details: ChannelJoin(ChannelJoin { channel: ChannelId(Snowflake(882025234385866757)), user: UserId(Snowflake(882025226378940418)), permissions: MembershipFlagSet(1) }) }; event clock=EventClock(1 => 882025234385866758) my clock=EventClock(1 => 882025234385866758)
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.114627Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from async_handlers
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.114695Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.114879Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025234385866758)), timestamp: 1788128003, change: EventComplete(EventComplete), users_to_notify: [] })
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.114909Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025234385866758)), timestamp: 1788128003, change: EventComplete(EventComplete), users_to_notify: [] }
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.114954Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025234385866759)), timestamp: 1788128003, change: ChannelJoin(ChannelJoin { membership: MembershipId(UserId(Snowflake(882025226378940418)), ChannelId(Snowflake(882025234385866757))), user: HistoricUserId(UserId(Snowflake(882025226378940418)), 2) }), users_to_notify: [UserId(Snowflake(882025226378940418))] })
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.114975Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025234385866759)), timestamp: 1788128003, change: ChannelJoin(ChannelJoin { membership: MembershipId(UserId(Snowflake(882025226378940418)), ChannelId(Snowflake(882025234385866757))), user: HistoricUserId(UserId(Snowflake(882025226378940418)), 2) }), users_to_notify: [UserId(Snowflake(882025226378940418))] }
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.115033Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :nick2!username@localhost JOIN #chan2
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.115079Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :nick2!username@localhost MODE #chan2 +o nick2
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.115117Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 353 nick2 = #chan2 :@nick2
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.115136Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 366 nick2 #chan2 :End of names list
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.115171Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(882025234385866759)), timestamp: 1788128003, change: EventComplete(EventComplete), users_to_notify: [] })
1788128003.115 sable_ircd     #x1B[2m2026-08-30T22:13:23.115187Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(882025234385866759)), timestamp: 1788128003, change: EventComplete(EventComplete), users_to_notify: [] }
1788128003.115 S -> 2: :nick2!username@localhost JOIN #chan2
1788128003.115 S -> 2: :nick2!username@localhost MODE #chan2 +o nick2
1788128003.115 S -> 2: :My.Little.Server 353 nick2 = #chan2 :@nick2
1788128003.115 S -> 2: :My.Little.Server 366 nick2 #chan2 :End of names list
1788128003.128 sable_history  #x1B[2m2027-08-30T23:45:49.548382Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014320068756185190)), timestamp: 1819669549, clock: EventClock(1 => 1014295144268042241, 50 => 1014319817097945189), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819669549 }) }; event clock=EventClock(1 => 1014295144268042241, 50 => 1014319817097945189) my clock=EventClock(1 => 1014295144268042241, 50 => 1014319817097945189)
1788128003.128 sable_history  #x1B[2m2027-08-30T23:45:49.550018Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128003.632 sable_history  #x1B[2m2027-08-30T23:57:02.100801Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014322889643729011)), timestamp: 1819670222, clock: EventClock(1 => 1014295448346693654, 50 => 1014322637985489010, 99 => 1014295451547348996), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819670222 }) }; event clock=EventClock(1 => 1014295448346693654, 50 => 1014322637985489010, 99 => 1014295451547348996) my clock=EventClock(1 => 1014295448346693654, 50 => 1014322637985489010, 99 => 1014295451547348996)
1788128003.632 sable_history  #x1B[2m2027-08-30T23:57:02.102197Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128003.649 sable_history  #x1B[2m2027-08-30T23:45:50.148042Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(1014320071272767591)), timestamp: 1819669550, clock: EventClock(1 => 1014295224354082831, 50 => 1014319819614527590, 99 => 1014295214413983748), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1819669550 }) }; event clock=EventClock(1 => 1014295224354082831, 50 => 1014319819614527590, 99 => 1014295214413983748) my clock=EventClock(1 => 1014295224354082831, 50 => 1014319819614527590, 99 => 1014295214413983748)
1788128003.649 sable_history  #x1B[2m2027-08-30T23:45:50.149210Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message
1788128004.117 2: waiting…
1788128004.120 sable_ircd     #x1B[2m2026-08-30T22:13:24.120335Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server PONG My.Little.Server :synchronize648.230740569
1788128004.121 S -> 2: :My.Little.Server PONG My.Little.Server :synchronize648.230740569
1788128004.221 1 -> S: PING synchronize650.342544625
1788128004.221 sable_ircd     #x1B[2m2026-08-30T22:13:24.221439Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128004.222 sable_ircd     #x1B[2m2026-08-30T22:13:24.221496Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize650.342544625"
1788128004.222 sable_ircd     #x1B[2m2026-08-30T22:13:24.221610Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server PONG My.Little.Server :synchronize650.342544625
1788128004.222 S -> 1: :My.Little.Server PONG My.Little.Server :synchronize650.342544625
1788128004.222 1 -> S: WHOIS nick2
1788128004.222 sable_ircd     #x1B[2m2026-08-30T22:13:24.222054Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128004.222 sable_ircd     #x1B[2m2026-08-30T22:13:24.222090Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"WHOIS nick2"
1788128004.222 sable_ircd     #x1B[2m2026-08-30T22:13:24.222172Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 311 nick1 nick2 username localhost * :Realname
1788128004.222 sable_ircd     #x1B[2m2026-08-30T22:13:24.222202Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 318 nick1 nick2 :End of /WHOIS
1788128004.322 1 -> S: PING synchronize650.443632021
1788128004.322 S -> 1: :My.Little.Server 311 nick1 nick2 username localhost * :Realname
1788128004.322 S -> 1: :My.Little.Server 318 nick1 nick2 :End of /WHOIS
1788128004.323 sable_ircd     #x1B[2m2026-08-30T22:13:24.322638Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events
1788128004.323 sable_ircd     #x1B[2m2026-08-30T22:13:24.322687Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize650.443632021"
1788128004.323 sable_ircd     #x1B[2m2026-08-30T22:13:24.322788Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server PONG My.Little.Server :synchronize650.443632021
1788128004.323 S -> 1: :My.Little.Server PONG My.Little.Server :synchronize650.443632021
1788128004.328 1: disconnects from server.
1788128004.328 2: disconnects from server.