--------------------------------- Captured Out --------------------------------- ---- new test ---- 1782833841.127 sable_ircd uid=1001 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.130382Z#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(859819909599727616)), timestamp: 1782833841, clock: EventClock(), target: Server(ServerId(1)), details: NewServer(NewServer { epoch: 1782833841, name: ServerName("My.Little.Server"), ts: 1782833841, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }; event clock=EventClock() my clock=EventClock() 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.130506Z#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 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.130748Z#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(859819909599727616)), timestamp: 1782833841, clock: EventClock(), target: Server(ServerId(1)), details: NewServer(NewServer { epoch: 1782833841, name: ServerName("My.Little.Server"), ts: 1782833841, 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 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.130950Z#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(859819909599727616)), timestamp: 1782833841, change: NewServer(NewServer { server: ServerId(1) }), users_to_notify: [] }) 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.130990Z#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(859819909599727616)), timestamp: 1782833841, change: NewServer(NewServer { server: ServerId(1) }), users_to_notify: [] } 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.130884Z#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(859819909599727617)), timestamp: 1782833841, clock: EventClock(1 => 859819909599727616), target: Server(ServerId(1)), details: ServerPing(ServerPing { ts: 1782833841 }) }; event clock=EventClock(1 => 859819909599727616) my clock=EventClock(1 => 859819909599727616) 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.131050Z#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(859819909599727616)), timestamp: 1782833841, change: EventComplete(EventComplete), users_to_notify: [] }) 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.131059Z#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 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.131076Z#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(859819909599727616)), timestamp: 1782833841, change: EventComplete(EventComplete), users_to_notify: [] } 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.131289Z#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(859819909599727617)), timestamp: 1782833841, change: EventComplete(EventComplete), users_to_notify: [] }) 1782833841.131 sable_ircd #x1B[2m2026-06-30T15:37:21.131313Z#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(859819909599727617)), timestamp: 1782833841, change: EventComplete(EventComplete), users_to_notify: [] } 1782833841.132 sable_ircd #x1B[2m2026-06-30T15:37:21.132157Z#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 1782833841.223 sable_ircd #x1B[2m2026-06-30T15:37:21.223009Z#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 } 1782833841.223 sable_ircd #x1B[2m2026-06-30T15:37:21.223179Z#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 1782833841.223 sable_ircd #x1B[2m2026-06-30T15:37:21.223252Z#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 1782833841.223 sable_ircd #x1B[2m2026-06-30T15:37:21.223346Z#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 1782833841.224 sable_ircd #x1B[2m2026-06-30T15:37:21.223569Z#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 1782833841.224 sable_ircd #x1B[2m2026-06-30T15:37:21.223627Z#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" 1782833841.224 sable_ircd #x1B[2m2026-06-30T15:37:21.223749Z#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 1782833841.224 sable_ircd #x1B[2m2026-06-30T15:37:21.223856Z#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)) 1782833841.224 sable_ircd #x1B[2m2026-06-30T15:37:21.223894Z#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) 1782833841.224 sable_ircd #x1B[2m2026-06-30T15:37:21.224311Z#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 1782833841.224 sable_ircd #x1B[2m2026-06-30T15:37:21.224428Z#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 1782833841.225 sable_ircd #x1B[2m2026-06-30T15:37:21.224642Z#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 1782833841.244 1: connects to server. 1782833841.244 1 -> S: NICK foo 1782833841.244 1 -> S: USER username * * :Realname 1782833841.244 sable_ircd #x1B[2m2026-06-30T15:37:21.244451Z#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 } 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.244552Z#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 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.244593Z#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 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.244635Z#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 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.244792Z#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 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.244863Z#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 foo" 1782833841.245 S -> 1: :My.Little.Server NOTICE * :*** Looking up your hostname 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.245005Z#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 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.245055Z#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" 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.245141Z#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: 625, tv_nsec: 468273102 }, attach_user_id: OnceLock(), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(), realname: OnceLock(Realname("Realname")), hostname: OnceLock(), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.245219Z#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: 625, tv_nsec: 468273102 }, attach_user_id: OnceLock(), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(Nickname("foo")), realname: OnceLock(Realname("Realname")), hostname: OnceLock(), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1782833841.245 sable_ircd #x1B[2m2026-06-30T15:37:21.245277Z#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 1782833841.246 sable_ircd #x1B[2m2026-06-30T15:37:21.245730Z#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 1782833841.246 sable_ircd #x1B[2m2026-06-30T15:37:21.245771Z#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")) 1782833841.246 sable_ircd #x1B[2m2026-06-30T15:37:21.245803Z#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 1782833841.246 sable_ircd #x1B[2m2026-06-30T15:37:21.245825Z#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: 625, tv_nsec: 468273102 }, attach_user_id: OnceLock(), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(Nickname("foo")), realname: OnceLock(Realname("Realname")), hostname: OnceLock(Hostname("localhost")), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mtrue #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1782833841.246 sable_ircd #x1B[2m2026-06-30T15:37:21.245865Z#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)) 1782833841.246 sable_ircd #x1B[2m2026-06-30T15:37:21.246116Z#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(859819910086266882)), timestamp: 1782833841, clock: EventClock(1 => 859819909599727617), target: User(UserId(Snowflake(859819910082072576))), details: NewUser(NewUser { nickname: Nickname("foo"), 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(859819910082072577)), NewUserConnection { user: UserId(Snowflake(859819910082072576)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1782833841 })) }) }; event clock=EventClock(1 => 859819909599727617) my clock=EventClock(1 => 859819909599727617) 1782833841.246 S -> 1: :My.Little.Server NOTICE * :*** Found your hostname: localhost 1782833841.246 sable_ircd #x1B[2m2026-06-30T15:37:21.246216Z#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 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246544Z#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(859819910086266882)), timestamp: 1782833841, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(859819910082072576)), 1) }), users_to_notify: [] }) 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246586Z#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(859819910086266882)), timestamp: 1782833841, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(859819910082072576)), 1) }), users_to_notify: [] } 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246633Z#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(859819910086266882)), timestamp: 1782833841, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(859819910082072576)), 2), connection: UserConnectionId(Snowflake(859819910082072577)) }), users_to_notify: [] }) 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246656Z#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(859819910086266882)), timestamp: 1782833841, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(859819910082072576)), 2), connection: UserConnectionId(Snowflake(859819910082072577)) }), users_to_notify: [] } 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246695Z#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 foo :Welcome to the test Internet Relay Chat network, foo 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246720Z#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 foo :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246739Z#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 foo :This server was created 2026-06-30 15:37:21.246731424 UTC 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246757Z#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 foo My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246786Z#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 foo 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 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246804Z#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 foo :MOTD File is missing 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246819Z#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): :foo!username@localhost MODE foo + 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246834Z#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 foo :The network is currently running in debug mode. Do not send any sensitive information such as passwords. 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246861Z#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(859819910086266882)), timestamp: 1782833841, change: EventComplete(EventComplete), users_to_notify: [] }) 1782833841.247 sable_ircd #x1B[2m2026-06-30T15:37:21.246880Z#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(859819910086266882)), timestamp: 1782833841, change: EventComplete(EventComplete), users_to_notify: [] } 1782833841.247 S -> 1: :My.Little.Server 001 foo :Welcome to the test Internet Relay Chat network, foo 1782833841.247 S -> 1: :My.Little.Server 002 foo :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 1782833841.247 S -> 1: :My.Little.Server 003 foo :This server was created 2026-06-30 15:37:21.246731424 UTC 1782833841.247 S -> 1: :My.Little.Server 004 foo My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov 1782833841.247 S -> 1: :My.Little.Server 005 foo 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 1782833841.247 S -> 1: :My.Little.Server 422 foo :MOTD File is missing 1782833841.247 S -> 1: :foo!username@localhost MODE foo + 1782833841.247 S -> 1: :My.Little.Server NOTICE foo :The network is currently running in debug mode. Do not send any sensitive information such as passwords. 1782833841.247 1 -> S: PING foo 1782833841.248 sable_ircd #x1B[2m2026-06-30T15:37:21.247610Z#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 1782833841.248 sable_ircd #x1B[2m2026-06-30T15:37:21.247665Z#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" 1782833841.248 sable_ircd #x1B[2m2026-06-30T15:37:21.247764Z#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 1782833841.338 sable_history #x1B[2m2027-06-30T16:43:40.204201Z#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(992108169985728587)), timestamp: 1814373820, clock: EventClock(1 => 992090315928113159, 50 => 992107918327488586, 99 => 992090295988793346), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814373820 }) }; event clock=EventClock(1 => 992090315928113159, 50 => 992107918327488586, 99 => 992090295988793346) my clock=EventClock(1 => 992090315928113159, 50 => 992107918327488586, 99 => 992090295988793346) 1782833841.338 sable_history #x1B[2m2027-06-30T16:43:40.206487Z#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 1782833841.819 sable_history #x1B[2m2027-06-30T16:43:40.675297Z#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(992108171961245771)), timestamp: 1814373820, clock: EventClock(1 => 992090370923827215, 50 => 992107920303005770, 99 => 992090360975339524), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814373820 }) }; event clock=EventClock(1 => 992090370923827215, 50 => 992107920303005770, 99 => 992090360975339524) my clock=EventClock(1 => 992090370923827215, 50 => 992107920303005770, 99 => 992090360975339524) 1782833841.819 sable_history #x1B[2m2027-06-30T16:43:40.676975Z#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 1782833841.921 sable_history #x1B[2m2027-06-30T16:54:52.959534Z#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(992110991724716119)), timestamp: 1814374492, clock: EventClock(1 => 992090594522173462, 50 => 992110740062281814, 99 => 992090597802520580), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814374492 }) }; event clock=EventClock(1 => 992090594522173462, 50 => 992110740062281814, 99 => 992090597802520580) my clock=EventClock(1 => 992090594522173462, 50 => 992110740062281814, 99 => 992090597802520580) 1782833841.921 sable_history #x1B[2m2027-06-30T16:54:52.961034Z#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 1782833842.048 1 -> S: PING synchronize626.271957331 1782833842.048 S -> 1: :My.Little.Server PONG My.Little.Server :foo 1782833842.049 sable_ircd #x1B[2m2026-06-30T15:37:22.048846Z#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 1782833842.049 sable_ircd #x1B[2m2026-06-30T15:37:22.048910Z#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 synchronize626.271957331" 1782833842.049 sable_ircd #x1B[2m2026-06-30T15:37:22.049041Z#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 :synchronize626.271957331 1782833842.049 S -> 1: :My.Little.Server PONG My.Little.Server :synchronize626.271957331 1782833842.050 2: connects to server. 1782833842.050 2 -> S: NICK bar 1782833842.050 2 -> S: USER username * * :Realname 1782833842.050 sable_ircd #x1B[2m2026-06-30T15:37:22.049767Z#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 } 1782833842.050 sable_ircd #x1B[2m2026-06-30T15:37:22.049881Z#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 1782833842.050 sable_ircd #x1B[2m2026-06-30T15:37:22.049920Z#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 1782833842.050 sable_ircd #x1B[2m2026-06-30T15:37:22.049969Z#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 1782833842.050 sable_ircd #x1B[2m2026-06-30T15:37:22.050079Z#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 1782833842.050 sable_ircd #x1B[2m2026-06-30T15:37:22.050136Z#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 bar" 1782833842.050 S -> 2: :My.Little.Server NOTICE * :*** Looking up your hostname 1782833842.050 sable_ircd #x1B[2m2026-06-30T15:37:22.050262Z#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 1782833842.050 sable_ircd #x1B[2m2026-06-30T15:37:22.050320Z#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" 1782833842.051 sable_ircd #x1B[2m2026-06-30T15:37:22.050440Z#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: 626, tv_nsec: 273600862 }, attach_user_id: OnceLock(), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(), realname: OnceLock(Realname("Realname")), hostname: OnceLock(), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1782833842.051 sable_ircd #x1B[2m2026-06-30T15:37:22.050555Z#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: 626, tv_nsec: 273600862 }, attach_user_id: OnceLock(), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(Nickname("bar")), realname: OnceLock(Realname("Realname")), hostname: OnceLock(), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1782833842.051 sable_ircd #x1B[2m2026-06-30T15:37:22.050613Z#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 1782833842.051 sable_ircd #x1B[2m2026-06-30T15:37:22.051131Z#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 1782833842.051 sable_ircd #x1B[2m2026-06-30T15:37:22.051164Z#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")) 1782833842.051 sable_ircd #x1B[2m2026-06-30T15:37:22.051189Z#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 1782833842.051 sable_ircd #x1B[2m2026-06-30T15:37:22.051211Z#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: 626, tv_nsec: 273600862 }, attach_user_id: OnceLock(), user: OnceLock(Username("username")), extra_user_params: OnceLock(("*", "*")), nick: OnceLock(Nickname("bar")), realname: OnceLock(Realname("Realname")), hostname: OnceLock(Hostname("localhost")), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mtrue #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1782833842.051 sable_ircd #x1B[2m2026-06-30T15:37:22.051254Z#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)) 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.051453Z#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(859819913462681603)), timestamp: 1782833842, clock: EventClock(1 => 859819910086266882), target: User(UserId(Snowflake(859819913462681602))), details: NewUser(NewUser { nickname: Nickname("bar"), 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(859819913462681603)), NewUserConnection { user: UserId(Snowflake(859819913462681602)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1782833842 })) }) }; event clock=EventClock(1 => 859819910086266882) my clock=EventClock(1 => 859819910086266882) 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.051547Z#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 1782833842.052 S -> 2: :My.Little.Server NOTICE * :*** Found your hostname: localhost 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.051862Z#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(859819913462681603)), timestamp: 1782833842, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(859819913462681602)), 1) }), users_to_notify: [] }) 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.051901Z#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(859819913462681603)), timestamp: 1782833842, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(859819913462681602)), 1) }), users_to_notify: [] } 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.051955Z#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(859819913462681603)), timestamp: 1782833842, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(859819913462681602)), 2), connection: UserConnectionId(Snowflake(859819913462681603)) }), users_to_notify: [] }) 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.051979Z#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(859819913462681603)), timestamp: 1782833842, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(859819913462681602)), 2), connection: UserConnectionId(Snowflake(859819913462681603)) }), users_to_notify: [] } 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052022Z#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 bar :Welcome to the test Internet Relay Chat network, bar 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052048Z#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 bar :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052070Z#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 bar :This server was created 2026-06-30 15:37:22.052062232 UTC 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052088Z#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 bar My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052109Z#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 bar 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 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052127Z#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 bar :MOTD File is missing 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052145Z#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): :bar!username@localhost MODE bar + 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052160Z#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 bar :The network is currently running in debug mode. Do not send any sensitive information such as passwords. 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052206Z#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(859819913462681603)), timestamp: 1782833842, change: EventComplete(EventComplete), users_to_notify: [] }) 1782833842.052 sable_ircd #x1B[2m2026-06-30T15:37:22.052229Z#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(859819913462681603)), timestamp: 1782833842, change: EventComplete(EventComplete), users_to_notify: [] } 1782833842.052 S -> 2: :My.Little.Server 001 bar :Welcome to the test Internet Relay Chat network, bar 1782833842.053 2 -> S: PING foo 1782833842.053 sable_ircd #x1B[2m2026-06-30T15:37:22.052791Z#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 1782833842.053 sable_ircd #x1B[2m2026-06-30T15:37:22.052830Z#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" 1782833842.053 sable_ircd #x1B[2m2026-06-30T15:37:22.052897Z#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 1782833842.153 2 -> S: PING synchronize626.376306802 1782833842.153 S -> 2: :My.Little.Server 002 bar :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 1782833842.153 S -> 2: :My.Little.Server 003 bar :This server was created 2026-06-30 15:37:22.052062232 UTC 1782833842.153 S -> 2: :My.Little.Server 004 bar My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov 1782833842.153 S -> 2: :My.Little.Server 005 bar 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 1782833842.153 S -> 2: :My.Little.Server 422 bar :MOTD File is missing 1782833842.153 S -> 2: :bar!username@localhost MODE bar + 1782833842.153 S -> 2: :My.Little.Server NOTICE bar :The network is currently running in debug mode. Do not send any sensitive information such as passwords. 1782833842.153 S -> 2: :My.Little.Server PONG My.Little.Server :foo 1782833842.153 sable_ircd #x1B[2m2026-06-30T15:37:22.153066Z#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 1782833842.153 sable_ircd #x1B[2m2026-06-30T15:37:22.153120Z#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 synchronize626.376306802" 1782833842.153 sable_ircd #x1B[2m2026-06-30T15:37:22.153213Z#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 :synchronize626.376306802 1782833842.154 S -> 2: :My.Little.Server PONG My.Little.Server :synchronize626.376306802 1782833842.778 sable_history #x1B[2m2027-06-30T16:57:55.473267Z#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(992111757243916378)), timestamp: 1814374675, clock: EventClock(1 => 992090797555847191, 50 => 992111505585676377, 99 => 992090799858921477), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814374675 }) }; event clock=EventClock(1 => 992090797555847191, 50 => 992111505585676377, 99 => 992090799858921477) my clock=EventClock(1 => 992090797555847191, 50 => 992111505585676377, 99 => 992090799858921477) 1782833842.778 sable_history #x1B[2m2027-06-30T16:57:55.474762Z#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 1782833842.854 1 -> S: JOIN #chan 1782833842.855 sable_ircd #x1B[2m2026-06-30T15:37:22.855034Z#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 1782833842.855 sable_ircd #x1B[2m2026-06-30T15:37:22.855105Z#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"JOIN #chan" 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.855451Z#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(859819916834902020)), timestamp: 1782833842, clock: EventClock(1 => 859819913462681603), target: Channel(ChannelId(Snowflake(859819916834902020))), details: NewChannel(NewChannel { name: ChannelName("#chan"), mode: ChannelMode { modes: ChannelModeSet(0), key: None } }) }; event clock=EventClock(1 => 859819913462681603) my clock=EventClock(1 => 859819913462681603) 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.855624Z#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 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.855736Z#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(859819916834902021)), timestamp: 1782833842, clock: EventClock(1 => 859819916834902020), target: Membership(MembershipId(UserId(Snowflake(859819910082072576)), ChannelId(Snowflake(859819916834902020)))), details: ChannelJoin(ChannelJoin { channel: ChannelId(Snowflake(859819916834902020)), user: UserId(Snowflake(859819910082072576)), permissions: MembershipFlagSet(1) }) }; event clock=EventClock(1 => 859819916834902020) my clock=EventClock(1 => 859819916834902020) 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.855877Z#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 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.855955Z#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 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.856033Z#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(859819916834902020)), timestamp: 1782833842, change: EventComplete(EventComplete), users_to_notify: [] }) 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.856077Z#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(859819916834902020)), timestamp: 1782833842, change: EventComplete(EventComplete), users_to_notify: [] } 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.856252Z#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(859819916834902021)), timestamp: 1782833842, change: ChannelJoin(ChannelJoin { membership: MembershipId(UserId(Snowflake(859819910082072576)), ChannelId(Snowflake(859819916834902020))), user: HistoricUserId(UserId(Snowflake(859819910082072576)), 2) }), users_to_notify: [UserId(Snowflake(859819910082072576))] }) 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.856289Z#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(859819916834902021)), timestamp: 1782833842, change: ChannelJoin(ChannelJoin { membership: MembershipId(UserId(Snowflake(859819910082072576)), ChannelId(Snowflake(859819916834902020))), user: HistoricUserId(UserId(Snowflake(859819910082072576)), 2) }), users_to_notify: [UserId(Snowflake(859819910082072576))] } 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.856350Z#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): :foo!username@localhost JOIN #chan 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.856420Z#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): :foo!username@localhost MODE #chan +o foo 1782833842.856 sable_ircd #x1B[2m2026-06-30T15:37:22.856459Z#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 353 foo = #chan :@foo 1782833842.857 sable_ircd #x1B[2m2026-06-30T15:37:22.856481Z#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 366 foo #chan :End of names list 1782833842.857 sable_ircd #x1B[2m2026-06-30T15:37:22.856523Z#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(859819916834902021)), timestamp: 1782833842, change: EventComplete(EventComplete), users_to_notify: [] }) 1782833842.857 sable_ircd #x1B[2m2026-06-30T15:37:22.856544Z#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(859819916834902021)), timestamp: 1782833842, change: EventComplete(EventComplete), users_to_notify: [] } 1782833842.955 1 -> S: PING synchronize627.178262041 1782833842.955 S -> 1: :foo!username@localhost JOIN #chan 1782833842.955 S -> 1: :foo!username@localhost MODE #chan +o foo 1782833842.955 S -> 1: :My.Little.Server 353 foo = #chan :@foo 1782833842.955 S -> 1: :My.Little.Server 366 foo #chan :End of names list 1782833842.955 sable_ircd #x1B[2m2026-06-30T15:37:22.955073Z#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 1782833842.955 sable_ircd #x1B[2m2026-06-30T15:37:22.955131Z#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 synchronize627.178262041" 1782833843.207 sable_ircd #x1B[2m2026-06-30T15:37:23.206706Z#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 :synchronize627.178262041 1782833843.207 S -> 1: :My.Little.Server PONG My.Little.Server :synchronize627.178262041 1782833843.207 2 -> S: PART #chan 1782833843.208 sable_ircd #x1B[2m2026-06-30T15:37:23.207545Z#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 1782833843.208 sable_ircd #x1B[2m2026-06-30T15:37:23.207588Z#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"PART #chan" 1782833843.208 sable_ircd #x1B[2m2026-06-30T15:37:23.207708Z#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 442 bar #chan :You're not on that channel 1782833843.208 sable_ircd #x1B[2m2026-06-30T15:37:23.207752Z#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 1782833843.307 2 -> S: PING synchronize627.531000115 1782833843.308 S -> 2: :My.Little.Server 442 bar #chan :You're not on that channel 1782833843.308 sable_ircd #x1B[2m2026-06-30T15:37:23.307897Z#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 1782833843.308 sable_ircd #x1B[2m2026-06-30T15:37:23.307959Z#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 synchronize627.531000115" 1782833843.327 sable_history #x1B[2m2027-06-30T16:47:26.204429Z#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(992109117898432591)), timestamp: 1814374046, clock: EventClock(1 => 992090986400190497, 50 => 992108866240192590, 99 => 992090992696242181), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814374046 }) }; event clock=EventClock(1 => 992090986400190497, 50 => 992108866240192590, 99 => 992090992696242181) my clock=EventClock(1 => 992090986400190497, 50 => 992108866240192590, 99 => 992090992696242181) 1782833843.327 sable_history #x1B[2m2027-06-30T16:47:26.206039Z#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 1782833843.553 sable_history #x1B[2m2027-06-30T16:44:38.916706Z#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(992108416245899339)), timestamp: 1814373878, clock: EventClock(1 => 992090282621145089, 50 => 992108164587659338), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814373878 }) }; event clock=EventClock(1 => 992090282621145089, 50 => 992108164587659338) my clock=EventClock(1 => 992090282621145089, 50 => 992108164587659338) 1782833843.553 sable_history #x1B[2m2027-06-30T16:44:38.918225Z#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 1782833844.001 sable_history #x1B[2m2027-06-30T16:44:38.827031Z#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(992108415868411979)), timestamp: 1814373878, clock: EventClock(1 => 992090284479221761, 50 => 992108164210171978), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814373878 }) }; event clock=EventClock(1 => 992090284479221761, 50 => 992108164210171978) my clock=EventClock(1 => 992090284479221761, 50 => 992108164210171978) 1782833844.001 sable_history #x1B[2m2027-06-30T16:44:38.828724Z#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 1782833844.062 sable_ircd #x1B[2m2026-06-30T15:37:24.061646Z#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 :synchronize627.531000115 1782833844.062 S -> 2: :My.Little.Server PONG My.Little.Server :synchronize627.531000115 1782833844.162 2 -> S: PING synchronize628.386041987 1782833844.163 sable_ircd #x1B[2m2026-06-30T15:37:24.162791Z#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 1782833844.163 sable_ircd #x1B[2m2026-06-30T15:37:24.162844Z#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 synchronize628.386041987" 1782833844.394 sable_history #x1B[2m2027-06-30T16:50:15.217053Z#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(992109826790334546)), timestamp: 1814374215, clock: EventClock(1 => 992090688797544470, 50 => 992109575132094545, 99 => 992090692702842884), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814374215 }) }; event clock=EventClock(1 => 992090688797544470, 50 => 992109575132094545, 99 => 992090692702842884) my clock=EventClock(1 => 992090688797544470, 50 => 992109575132094545, 99 => 992090692702842884) 1782833844.395 sable_history #x1B[2m2027-06-30T16:50:15.219162Z#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 1782833844.447 sable_history #x1B[2m2027-06-30T16:44:39.242980Z#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(992108417613242443)), timestamp: 1814373879, clock: EventClock(1 => 992090293064962051, 50 => 992108165955002442), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814373879 }) }; event clock=EventClock(1 => 992090293064962051, 50 => 992108165955002442) my clock=EventClock(1 => 992090293064962051, 50 => 992108165955002442) 1782833844.447 sable_history #x1B[2m2027-06-30T16:44:39.244349Z#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 1782833844.901 sable_history #x1B[2m2027-06-30T16:44:39.932021Z#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(992108420503117899)), timestamp: 1814373879, clock: EventClock(1 => 992090288103100417, 50 => 992108168840683594), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814373879 }) }; event clock=EventClock(1 => 992090288103100417, 50 => 992108168840683594) my clock=EventClock(1 => 992090288103100417, 50 => 992108168840683594) 1782833844.901 sable_history #x1B[2m2027-06-30T16:44:39.934217Z#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 1782833845.014 sable_history #x1B[2m2027-06-30T16:53:03.932099Z#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(992110534432333909)), timestamp: 1814374383, clock: EventClock(1 => 992090641066364950, 50 => 992110282774093908, 99 => 992090644996829188), target: Server(ServerId(50)), details: ServerPing(ServerPing { ts: 1814374383 }) }; event clock=EventClock(1 => 992090641066364950, 50 => 992110282774093908, 99 => 992090644996829188) my clock=EventClock(1 => 992090641066364950, 50 => 992110282774093908, 99 => 992090644996829188) 1782833845.014 sable_history #x1B[2m2027-06-30T16:53:03.933728Z#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 1782833845.163 2: waiting… 1782833845.167 sable_ircd #x1B[2m2026-06-30T15:37:25.167082Z#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 :synchronize628.386041987 1782833845.168 S -> 2: :My.Little.Server PONG My.Little.Server :synchronize628.386041987 1782833845.171 1: disconnects from server. 1782833845.171 2: disconnects from server.