Oct 18 18:49:00 volumiobookwormdev dhcpcd[656]: wlan0: probing for an IPv4LL address Oct 18 18:49:01 volumiobookwormdev volumio[1105]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600 Oct 18 18:49:03 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: upnp , onRestart Oct 18 18:49:03 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , onNetworkingRestart Oct 18 18:49:03 volumiobookwormdev volumio[1105]: info: Refreshing Cached IP Addresses Oct 18 18:49:03 volumiobookwormdev sudo[2330]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/killall upmpdcli Oct 18 18:49:03 volumiobookwormdev sudo[2330]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:03 volumiobookwormdev sudo[2332]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 18 18:49:03 volumiobookwormdev sudo[2332]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:03 volumiobookwormdev sudo[2332]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:03 volumiobookwormdev sudo[2330]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:03 volumiobookwormdev volumio[1105]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600 Oct 18 18:49:03 volumiobookwormdev sudo[2334]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 18 18:49:03 volumiobookwormdev sudo[2334]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:03 volumiobookwormdev sudo[2334]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:04 volumiobookwormdev volumio[1105]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: Mozilla/5.0 (X11; CrOS x86_64 14541.0.0) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/129.0.0.0 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 4 Oct 18 18:49:04 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetVisibleSources Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: Received Get System Info Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: Discovery: Getting this device information Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: Listing playlists Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 18 18:49:05 volumiobookwormdev dhcpcd[656]: wlan0: using IPv4LL address 169.254.186.45 Oct 18 18:49:05 volumiobookwormdev avahi-daemon[523]: Registering new address record for 169.254.186.45 on wlan0.IPv4. Oct 18 18:49:05 volumiobookwormdev dhcpcd[656]: wlan0: adding route to 169.254.0.0/16 Oct 18 18:49:05 volumiobookwormdev dhcpcd[656]: wlan0: adding default route Oct 18 18:49:05 volumiobookwormdev systemd[1]: Stopped target ip-changed@wlan0.target - IP Address changed on wlan0. Oct 18 18:49:05 volumiobookwormdev systemd[1]: Stopping ip-changed@wlan0.target - IP Address changed on wlan0... Oct 18 18:49:05 volumiobookwormdev systemd[1]: welcome.service: Deactivated successfully. Oct 18 18:49:05 volumiobookwormdev systemd[1]: Stopped welcome.service - Show a welcome message on console. Oct 18 18:49:05 volumiobookwormdev systemd[1]: Stopping welcome.service - Show a welcome message on console... Oct 18 18:49:05 volumiobookwormdev systemd[1]: Starting welcome.service - Show a welcome message on console... Oct 18 18:49:05 volumiobookwormdev welcome[2350]: Resolved ip:[2] 192.168.211.1 169.254.186.45 Oct 18 18:49:05 volumiobookwormdev systemd[1]: Finished welcome.service - Show a welcome message on console. Oct 18 18:49:05 volumiobookwormdev systemd[1]: Reached target ip-changed@wlan0.target - IP Address changed on wlan0. Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Oct 18 18:49:05 volumiobookwormdev sudo[2357]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Oct 18 18:49:05 volumiobookwormdev sudo[2357]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:05 volumiobookwormdev sudo[2362]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 18 18:49:05 volumiobookwormdev sudo[2357]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:05 volumiobookwormdev sudo[2362]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:05 volumiobookwormdev sudo[2372]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 18 18:49:05 volumiobookwormdev sudo[2368]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 18 18:49:05 volumiobookwormdev sudo[2372]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:05 volumiobookwormdev sudo[2368]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:05 volumiobookwormdev sudo[2362]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:05 volumiobookwormdev sudo[2368]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:05 volumiobookwormdev sudo[2372]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:05 volumiobookwormdev sudo[2384]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 18 18:49:05 volumiobookwormdev sudo[2384]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:05 volumiobookwormdev sudo[2378]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 18 18:49:05 volumiobookwormdev sudo[2378]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:05 volumiobookwormdev sudo[2384]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:05 volumiobookwormdev sudo[2378]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Oct 18 18:49:05 volumiobookwormdev sudo[2389]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Oct 18 18:49:05 volumiobookwormdev sudo[2389]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:05 volumiobookwormdev sudo[2389]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:05 volumiobookwormdev volumio[1105]: error: An error occurred while scanning: Error: Command failed: sudo /sbin/iwlist wlan0 scan Oct 18 18:49:05 volumiobookwormdev volumio[1105]: wlan0 Interface doesn't support scanning : Invalid exchange Oct 18 18:49:05 volumiobookwormdev volumio[1105]: info: Cannot use regular scanning, forcing with ap-force Oct 18 18:49:05 volumiobookwormdev kernel: ieee80211 phy0: brcmf_vif_set_mgmt_ie: vndr ie set error : -52 Oct 18 18:49:05 volumiobookwormdev kernel: ieee80211 phy0: brcmf_cfg80211_scan: scan error (-52) Oct 18 18:49:05 volumiobookwormdev systemd[1]: upmpdcli.service: Main process exited, code=exited, status=1/FAILURE Oct 18 18:49:05 volumiobookwormdev systemd[1]: upmpdcli.service: Failed with result 'exit-code'. Oct 18 18:49:05 volumiobookwormdev sudo[2393]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 scan ap-force Oct 18 18:49:05 volumiobookwormdev sudo[2393]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:07 volumiobookwormdev ntpd[912]: IO: Listen normally on 4 wlan0 169.254.186.45:123 Oct 18 18:49:07 volumiobookwormdev ntpd[912]: IO: new interface(s) found: waking up resolver Oct 18 18:49:07 volumiobookwormdev ntpd[912]: DNS: dns_probe: 3.debian.pool.ntp.org, cast_flags:8, flags:101 Oct 18 18:49:09 volumiobookwormdev sudo[2393]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: Received Get System Info Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: Discovery: Getting this device information Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 18 18:49:09 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Oct 18 18:49:13 volumiobookwormdev ntpd[912]: DNS: dns_check: processing 3.debian.pool.ntp.org, 8, 101 Oct 18 18:49:13 volumiobookwormdev ntpd[912]: DNS: dns_check: DNS error: -11, System error Oct 18 18:49:13 volumiobookwormdev ntpd[912]: DNS: dns_take_status: 3.debian.pool.ntp.org=>error, 12 Oct 18 18:49:13 volumiobookwormdev sudo[2397]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 18 18:49:13 volumiobookwormdev sudo[2397]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:13 volumiobookwormdev sudo[2399]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 18 18:49:13 volumiobookwormdev sudo[2399]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:13 volumiobookwormdev sudo[2397]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:13 volumiobookwormdev sudo[2399]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:13 volumiobookwormdev sudo[2403]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Oct 18 18:49:13 volumiobookwormdev sudo[2403]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:14 volumiobookwormdev systemd[1]: Started upmpdcli.service - UPnP Renderer front-end to MPD. Oct 18 18:49:14 volumiobookwormdev sudo[2403]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:14 volumiobookwormdev volumio[1105]: info: Upmpdcli Daemon Started Oct 18 18:49:14 volumiobookwormdev volumio[1105]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600 Oct 18 18:49:14 volumiobookwormdev ntpd[912]: DNS: dns_probe: 2.debian.pool.ntp.org, cast_flags:8, flags:101 Oct 18 18:49:14 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Oct 18 18:49:18 volumiobookwormdev volumio[1105]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600 Oct 18 18:49:20 volumiobookwormdev hostapd[2296]: wlan0: STA e2:8c:a3:a9:65:cf IEEE 802.11: associated Oct 18 18:49:20 volumiobookwormdev hostapd[2296]: wlan0: STA e2:8c:a3:a9:65:cf RADIUS: starting accounting session F00EAE164BECB897 Oct 18 18:49:21 volumiobookwormdev ntpd[912]: DNS: dns_check: processing 2.debian.pool.ntp.org, 8, 101 Oct 18 18:49:21 volumiobookwormdev ntpd[912]: DNS: dns_check: DNS error: -11, System error Oct 18 18:49:21 volumiobookwormdev ntpd[912]: DNS: dns_take_status: 2.debian.pool.ntp.org=>error, 12 Oct 18 18:49:22 volumiobookwormdev ntpd[912]: DNS: dns_probe: 1.debian.pool.ntp.org, cast_flags:8, flags:101 Oct 18 18:49:24 volumiobookwormdev volumio[1105]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600 Oct 18 18:49:24 volumiobookwormdev dnsmasq-dhcp[2311]: DHCPDISCOVER(wlan0) e2:8c:a3:a9:65:cf Oct 18 18:49:24 volumiobookwormdev dnsmasq-dhcp[2311]: DHCPOFFER(wlan0) 192.168.211.134 e2:8c:a3:a9:65:cf Oct 18 18:49:25 volumiobookwormdev dnsmasq-dhcp[2311]: DHCPDISCOVER(wlan0) e2:8c:a3:a9:65:cf Oct 18 18:49:25 volumiobookwormdev dnsmasq-dhcp[2311]: DHCPOFFER(wlan0) 192.168.211.134 e2:8c:a3:a9:65:cf Oct 18 18:49:25 volumiobookwormdev dnsmasq-dhcp[2311]: DHCPDISCOVER(wlan0) e2:8c:a3:a9:65:cf Oct 18 18:49:25 volumiobookwormdev dnsmasq-dhcp[2311]: DHCPOFFER(wlan0) 192.168.211.134 e2:8c:a3:a9:65:cf Oct 18 18:49:25 volumiobookwormdev dnsmasq-dhcp[2311]: DHCPREQUEST(wlan0) 192.168.211.134 e2:8c:a3:a9:65:cf Oct 18 18:49:25 volumiobookwormdev dnsmasq-dhcp[2311]: DHCPACK(wlan0) 192.168.211.134 e2:8c:a3:a9:65:cf Oct 18 18:49:27 volumiobookwormdev sudo[2426]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 18 18:49:27 volumiobookwormdev sudo[2426]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:27 volumiobookwormdev sudo[2428]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 18 18:49:27 volumiobookwormdev sudo[2428]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:27 volumiobookwormdev sudo[2426]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:27 volumiobookwormdev sudo[2428]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:27 volumiobookwormdev volumio[1105]: verbose: New Socket.io Connection to 192.168.211.1 from 192.168.211.134 UA: Mozilla/5.0 (Linux; Android 14; Pixel 8 Build/AP2A.240905.003; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/130.0.6723.58 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 5 Oct 18 18:49:27 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Oct 18 18:49:28 volumiobookwormdev sudo[2432]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 18 18:49:28 volumiobookwormdev sudo[2432]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:28 volumiobookwormdev sudo[2432]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:28 volumiobookwormdev sudo[2434]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 18 18:49:28 volumiobookwormdev sudo[2434]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:28 volumiobookwormdev sudo[2434]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:28 volumiobookwormdev volumio[1105]: verbose: New Socket.io Connection to 192.168.211.1 from 192.168.211.134 UA: Mozilla/5.0 (Linux; Android 14; Pixel 8 Build/AP2A.240905.003; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/130.0.6723.58 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 6 Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetVisibleSources Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: Received Get System Info Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: Discovery: Getting this device information Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: Listing playlists Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Oct 18 18:49:28 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Oct 18 18:49:29 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Oct 18 18:49:30 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 18 18:49:30 volumiobookwormdev volumio[1105]: info: Received Get System Info Oct 18 18:49:30 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 18 18:49:30 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 18 18:49:30 volumiobookwormdev volumio[1105]: info: Discovery: Getting this device information Oct 18 18:49:30 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:49:30 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:49:30 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 18 18:49:30 volumiobookwormdev ntpd[912]: DNS: dns_check: processing 1.debian.pool.ntp.org, 8, 101 Oct 18 18:49:30 volumiobookwormdev ntpd[912]: DNS: dns_check: DNS error: -11, System error Oct 18 18:49:30 volumiobookwormdev ntpd[912]: DNS: dns_take_status: 1.debian.pool.ntp.org=>error, 12 Oct 18 18:49:31 volumiobookwormdev ntpd[912]: DNS: dns_probe: 0.debian.pool.ntp.org, cast_flags:8, flags:101 Oct 18 18:49:34 volumiobookwormdev volumio[1105]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600 Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode Oct 18 18:49:35 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 18 18:49:38 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Oct 18 18:49:40 volumiobookwormdev ntpd[912]: DNS: dns_check: processing 0.debian.pool.ntp.org, 8, 101 Oct 18 18:49:40 volumiobookwormdev ntpd[912]: DNS: dns_check: DNS error: -11, System error Oct 18 18:49:40 volumiobookwormdev ntpd[912]: DNS: dns_take_status: 0.debian.pool.ntp.org=>error, 12 Oct 18 18:49:42 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 18 18:49:42 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 18 18:49:42 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Oct 18 18:49:42 volumiobookwormdev sudo[2451]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Oct 18 18:49:42 volumiobookwormdev sudo[2451]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:42 volumiobookwormdev sudo[2451]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:42 volumiobookwormdev sudo[2456]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 18 18:49:42 volumiobookwormdev sudo[2456]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:42 volumiobookwormdev sudo[2456]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:42 volumiobookwormdev sudo[2462]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 18 18:49:42 volumiobookwormdev sudo[2462]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:42 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Oct 18 18:49:42 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Oct 18 18:49:42 volumiobookwormdev sudo[2474]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 18 18:49:42 volumiobookwormdev sudo[2474]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:42 volumiobookwormdev sudo[2462]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:42 volumiobookwormdev sudo[2470]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 18 18:49:42 volumiobookwormdev sudo[2470]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:42 volumiobookwormdev sudo[2474]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:42 volumiobookwormdev sudo[2477]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 18 18:49:42 volumiobookwormdev sudo[2477]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:42 volumiobookwormdev sudo[2470]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:42 volumiobookwormdev sudo[2477]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:42 volumiobookwormdev sudo[2481]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Oct 18 18:49:42 volumiobookwormdev sudo[2481]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:49:46 volumiobookwormdev sudo[2481]: pam_unix(sudo:session): session closed for user root Oct 18 18:49:52 volumiobookwormdev volumio[1105]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600 Oct 18 18:50:24 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: network , saveWirelessNetworkSettings Oct 18 18:50:24 volumiobookwormdev volumio[1105]: info: Saving new wireless network Oct 18 18:50:24 volumiobookwormdev sudo[2486]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/wpa_supplicant/wpa_supplicant.conf Oct 18 18:50:24 volumiobookwormdev sudo[2486]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:24 volumiobookwormdev sudo[2486]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:24 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , onNetworkingRestart Oct 18 18:50:24 volumiobookwormdev volumio[1105]: info: Discovery: Restarting Advertising due to device name change Oct 18 18:50:24 volumiobookwormdev sudo[2489]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart wireless.service Oct 18 18:50:24 volumiobookwormdev sudo[2489]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:24 volumiobookwormdev systemd[1]: Starting wireless.service - Wireless Services... Oct 18 18:50:24 volumiobookwormdev wireless.js[2491]: Cleaning previous... Oct 18 18:50:24 volumiobookwormdev systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... Oct 18 18:50:24 volumiobookwormdev dnsmasq[2311]: exiting on receipt of SIGTERM Oct 18 18:50:24 volumiobookwormdev systemd[1]: dnsmasq.service: Deactivated successfully. Oct 18 18:50:24 volumiobookwormdev systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. Oct 18 18:50:24 volumiobookwormdev systemd[1]: Stopping hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... Oct 18 18:50:25 volumiobookwormdev volumio[1105]: info: Discovery: A device disappeared from network Oct 18 18:50:25 volumiobookwormdev volumio[1105]: info: Discovery: Device volumiobookwormdev disappeared from network Oct 18 18:50:25 volumiobookwormdev volumio[1105]: info: Discovery: A device disappeared from network Oct 18 18:50:25 volumiobookwormdev dhcpcd[656]: wlan0: carrier lost Oct 18 18:50:25 volumiobookwormdev avahi-daemon[523]: Withdrawing address record for 169.254.186.45 on wlan0. Oct 18 18:50:25 volumiobookwormdev dhcpcd[656]: wlan0: deleting route to 169.254.0.0/16 Oct 18 18:50:25 volumiobookwormdev dhcpcd[656]: wlan0: deleting default route Oct 18 18:50:25 volumiobookwormdev systemd[1]: hostapd.service: Deactivated successfully. Oct 18 18:50:25 volumiobookwormdev systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. Oct 18 18:50:25 volumiobookwormdev systemd[1]: Stopped target ip-changed@wlan0.target - IP Address changed on wlan0. Oct 18 18:50:25 volumiobookwormdev systemd[1]: Stopping ip-changed@wlan0.target - IP Address changed on wlan0... Oct 18 18:50:25 volumiobookwormdev systemd[1]: welcome.service: Deactivated successfully. Oct 18 18:50:25 volumiobookwormdev systemd[1]: Stopped welcome.service - Show a welcome message on console. Oct 18 18:50:25 volumiobookwormdev systemd[1]: Stopping welcome.service - Show a welcome message on console... Oct 18 18:50:25 volumiobookwormdev sudo[2538]: root : PWD=/ ; USER=root ; COMMAND=/usr/sbin/ip addr flush dev wlan0 Oct 18 18:50:25 volumiobookwormdev sudo[2538]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 18 18:50:25 volumiobookwormdev avahi-daemon[523]: Withdrawing address record for 192.168.211.1 on wlan0. Oct 18 18:50:25 volumiobookwormdev systemd[1]: Starting welcome.service - Show a welcome message on console... Oct 18 18:50:25 volumiobookwormdev avahi-daemon[523]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.211.1. Oct 18 18:50:25 volumiobookwormdev avahi-daemon[523]: Interface wlan0.IPv4 no longer relevant for mDNS. Oct 18 18:50:25 volumiobookwormdev sudo[2538]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:25 volumiobookwormdev sudo[2540]: root : PWD=/ ; USER=root ; COMMAND=/usr/sbin/ifconfig wlan0 down Oct 18 18:50:25 volumiobookwormdev sudo[2540]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 18 18:50:26 volumiobookwormdev welcome[2536]: Resolved ip:[0] Oct 18 18:50:26 volumiobookwormdev sudo[2540]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:26 volumiobookwormdev systemd[1]: Finished welcome.service - Show a welcome message on console. Oct 18 18:50:26 volumiobookwormdev systemd[1]: Reached target ip-changed@wlan0.target - IP Address changed on wlan0. Oct 18 18:50:26 volumiobookwormdev systemd[1]: Stopped target ip-changed@wlan0.target - IP Address changed on wlan0. Oct 18 18:50:26 volumiobookwormdev systemd[1]: Stopping ip-changed@wlan0.target - IP Address changed on wlan0... Oct 18 18:50:26 volumiobookwormdev systemd[1]: welcome.service: Deactivated successfully. Oct 18 18:50:26 volumiobookwormdev systemd[1]: Stopped welcome.service - Show a welcome message on console. Oct 18 18:50:26 volumiobookwormdev systemd[1]: Stopping welcome.service - Show a welcome message on console... Oct 18 18:50:26 volumiobookwormdev systemd[1]: Starting welcome.service - Show a welcome message on console... Oct 18 18:50:26 volumiobookwormdev volumio[1105]: error: Upnp client error: Error: connect ECONNREFUSED 127.0.0.1:6600 Oct 18 18:50:26 volumiobookwormdev welcome[2549]: Resolved ip:[0] Oct 18 18:50:26 volumiobookwormdev systemd[1]: Finished welcome.service - Show a welcome message on console. Oct 18 18:50:26 volumiobookwormdev systemd[1]: Reached target ip-changed@wlan0.target - IP Address changed on wlan0. Oct 18 18:50:26 volumiobookwormdev wireless.js[2491]: Stopped aP Oct 18 18:50:26 volumiobookwormdev sudo[2558]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Oct 18 18:50:26 volumiobookwormdev sudo[2558]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:26 volumiobookwormdev sudo[2558]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:26 volumiobookwormdev kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled Oct 18 18:50:26 volumiobookwormdev sudo[2560]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iw reg get Oct 18 18:50:26 volumiobookwormdev sudo[2560]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:26 volumiobookwormdev sudo[2560]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:26 volumiobookwormdev sudo[2568]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Oct 18 18:50:26 volumiobookwormdev sudo[2568]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:26 volumiobookwormdev sudo[2568]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:26 volumiobookwormdev sudo[2570]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iw wlan0 scan Oct 18 18:50:26 volumiobookwormdev sudo[2570]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:27 volumiobookwormdev ntpd[912]: IO: Deleting interface #3 wlan0, 192.168.211.1#123, interface stats: received=0, sent=0, dropped=0, active_time=92 secs Oct 18 18:50:27 volumiobookwormdev ntpd[912]: IO: Deleting interface #4 wlan0, 169.254.186.45#123, interface stats: received=0, sent=0, dropped=0, active_time=80 secs Oct 18 18:50:28 volumiobookwormdev sudo[2570]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:28 volumiobookwormdev wireless.js[2491]: SETTING APPROPRIATE REG DOMAIN: DE Oct 18 18:50:28 volumiobookwormdev sudo[2576]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Oct 18 18:50:28 volumiobookwormdev sudo[2576]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:28 volumiobookwormdev sudo[2576]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:28 volumiobookwormdev sudo[2578]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iw reg set DE Oct 18 18:50:28 volumiobookwormdev sudo[2578]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:28 volumiobookwormdev sudo[2578]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:28 volumiobookwormdev wireless.js[2491]: SUCCESSFULLY SET NEW REGDOMAIN: DE Oct 18 18:50:28 volumiobookwormdev wireless.js[2491]: Start wireless flow Oct 18 18:50:28 volumiobookwormdev wireless.js[2491]: Stopped hotspot (if there).. Oct 18 18:50:28 volumiobookwormdev sudo[2584]: root : PWD=/ ; USER=root ; COMMAND=/usr/sbin/ip addr flush dev wlan0 Oct 18 18:50:28 volumiobookwormdev sudo[2584]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 18 18:50:28 volumiobookwormdev sudo[2584]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:28 volumiobookwormdev sudo[2586]: root : PWD=/ ; USER=root ; COMMAND=/usr/sbin/ifconfig wlan0 down Oct 18 18:50:28 volumiobookwormdev sudo[2586]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 18 18:50:29 volumiobookwormdev volumio[1105]: info: Discovery: Started advertising with name: VolumioBookwormDev Oct 18 18:50:29 volumiobookwormdev sudo[2586]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:29 volumiobookwormdev wireless.js[2491]: DHCP IP Oct 18 18:50:29 volumiobookwormdev wireless.js[2491]: Start ap Oct 18 18:50:29 volumiobookwormdev wpa_supplicant[2589]: Successfully initialized wpa_supplicant Oct 18 18:50:29 volumiobookwormdev sudo[2590]: root : PWD=/ ; USER=root ; COMMAND=/sbin/dhcpcd Oct 18 18:50:29 volumiobookwormdev sudo[2590]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 18 18:50:29 volumiobookwormdev kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled Oct 18 18:50:29 volumiobookwormdev dhcpcd[656]: control_free: No such file or directory Oct 18 18:50:29 volumiobookwormdev dhcpcd[656]: ps_ctl_dispatch: cannot handle another client Oct 18 18:50:29 volumiobookwormdev sudo[2590]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:29 volumiobookwormdev wpa_supplicant[2589]: nl80211: kernel reports: Registration to specific type not supported Oct 18 18:50:30 volumiobookwormdev volumio[1105]: info: Discovery: adding 77f74707-ccbd-4be6-b6a3-6b3ef1cb79f9 Oct 18 18:50:30 volumiobookwormdev volumio[1105]: info: Discovery: Found device VolumioBookwormDev Oct 18 18:50:30 volumiobookwormdev volumio[1105]: info: CoreCommandRouter::volumioGetState Oct 18 18:50:30 volumiobookwormdev volumio[1105]: info: CorePlayQueue::getTrack 0 Oct 18 18:50:30 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:30 volumiobookwormdev sudo[2599]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:30 volumiobookwormdev sudo[2599]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:30 volumiobookwormdev sudo[2599]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:31 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:31 volumiobookwormdev sudo[2603]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:31 volumiobookwormdev sudo[2603]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:31 volumiobookwormdev sudo[2603]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:32 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:32 volumiobookwormdev sudo[2607]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:32 volumiobookwormdev sudo[2607]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:32 volumiobookwormdev sudo[2607]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:33 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:33 volumiobookwormdev sudo[2611]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:33 volumiobookwormdev sudo[2611]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:33 volumiobookwormdev sudo[2611]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:33 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd022 fail, reason -52 Oct 18 18:50:33 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd026 fail, reason -52 Oct 18 18:50:33 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd02a fail, reason -52 Oct 18 18:50:34 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd02e fail, reason -52 Oct 18 18:50:34 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:34 volumiobookwormdev sudo[2615]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:34 volumiobookwormdev sudo[2615]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:34 volumiobookwormdev sudo[2615]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:35 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:35 volumiobookwormdev sudo[2619]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:35 volumiobookwormdev sudo[2619]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:35 volumiobookwormdev sudo[2619]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:35 volumiobookwormdev wpa_supplicant[2595]: wlan0: Trying to associate with SSID 'gnet02' Oct 18 18:50:35 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd090 fail, reason -52 Oct 18 18:50:35 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd095 fail, reason -52 Oct 18 18:50:35 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd099 fail, reason -52 Oct 18 18:50:35 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd09d fail, reason -52 Oct 18 18:50:35 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd0a1 fail, reason -52 Oct 18 18:50:35 volumiobookwormdev kernel: brcmfmac: brcmf_set_channel: set chanspec 0xd0a5 fail, reason -52 Oct 18 18:50:36 volumiobookwormdev wpa_supplicant[2595]: wlan0: Associated with 34:81:c4:be:94:53 Oct 18 18:50:36 volumiobookwormdev wpa_supplicant[2595]: wlan0: CTRL-EVENT-SUBNET-STATUS-UPDATE status=0 Oct 18 18:50:36 volumiobookwormdev wpa_supplicant[2595]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=COUNTRY_IE type=COUNTRY alpha2=DE Oct 18 18:50:36 volumiobookwormdev wpa_supplicant[2595]: wlan0: WPA: Key negotiation completed with 34:81:c4:be:94:53 [PTK=CCMP GTK=CCMP] Oct 18 18:50:36 volumiobookwormdev wpa_supplicant[2595]: wlan0: CTRL-EVENT-CONNECTED - Connection to 34:81:c4:be:94:53 completed [id=0 id_str=] Oct 18 18:50:36 volumiobookwormdev dhcpcd[656]: wlan0: carrier acquired Oct 18 18:50:36 volumiobookwormdev dhcpcd[656]: wlan0: connected to Access Point: gnet02 Oct 18 18:50:36 volumiobookwormdev dhcpcd[656]: wlan0: IAID 32:5d:aa:df Oct 18 18:50:36 volumiobookwormdev wpa_supplicant[2595]: RRM: Ignoring radio measurement request: Not RRM network Oct 18 18:50:36 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:36 volumiobookwormdev sudo[2624]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:36 volumiobookwormdev sudo[2624]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:36 volumiobookwormdev sudo[2624]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:36 volumiobookwormdev dhcpcd[656]: wlan0: soliciting an IPv6 router Oct 18 18:50:36 volumiobookwormdev dhcpcd[656]: wlan0: soliciting a DHCP lease Oct 18 18:50:36 volumiobookwormdev dhcpcd[656]: wlan0: offered 192.168.2.222 from 192.168.2.2 Oct 18 18:50:36 volumiobookwormdev dhcpcd[656]: wlan0: probing address 192.168.2.222/24 Oct 18 18:50:37 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:37 volumiobookwormdev sudo[2630]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:37 volumiobookwormdev sudo[2630]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:37 volumiobookwormdev sudo[2630]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:38 volumiobookwormdev wpa_supplicant[2595]: RRM: Ignoring radio measurement request: Not RRM network Oct 18 18:50:38 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:38 volumiobookwormdev sudo[2634]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:38 volumiobookwormdev sudo[2634]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:38 volumiobookwormdev sudo[2634]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:39 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:39 volumiobookwormdev sudo[2638]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:39 volumiobookwormdev sudo[2638]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:39 volumiobookwormdev sudo[2638]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:40 volumiobookwormdev wpa_supplicant[2595]: RRM: Ignoring radio measurement request: Not RRM network Oct 18 18:50:40 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:40 volumiobookwormdev sudo[2642]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:40 volumiobookwormdev sudo[2642]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:40 volumiobookwormdev sudo[2642]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:41 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:41 volumiobookwormdev sudo[2646]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:41 volumiobookwormdev sudo[2646]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:41 volumiobookwormdev sudo[2646]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:42 volumiobookwormdev dhcpcd[656]: wlan0: leased 192.168.2.222 for 864000 seconds Oct 18 18:50:42 volumiobookwormdev avahi-daemon[523]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.2.222. Oct 18 18:50:42 volumiobookwormdev dhcpcd[656]: wlan0: adding route to 192.168.2.0/24 Oct 18 18:50:42 volumiobookwormdev avahi-daemon[523]: New relevant interface wlan0.IPv4 for mDNS. Oct 18 18:50:42 volumiobookwormdev avahi-daemon[523]: Registering new address record for 192.168.2.222 on wlan0.IPv4. Oct 18 18:50:42 volumiobookwormdev dhcpcd[656]: wlan0: adding default route via 192.168.2.2 Oct 18 18:50:42 volumiobookwormdev systemd[1]: Stopped target ip-changed@wlan0.target - IP Address changed on wlan0. Oct 18 18:50:42 volumiobookwormdev systemd[1]: Stopping ip-changed@wlan0.target - IP Address changed on wlan0... Oct 18 18:50:42 volumiobookwormdev systemd[1]: welcome.service: Deactivated successfully. Oct 18 18:50:42 volumiobookwormdev systemd[1]: Stopped welcome.service - Show a welcome message on console. Oct 18 18:50:42 volumiobookwormdev systemd[1]: Stopping welcome.service - Show a welcome message on console... Oct 18 18:50:42 volumiobookwormdev systemd[1]: Starting welcome.service - Show a welcome message on console... Oct 18 18:50:42 volumiobookwormdev welcome[2657]: Resolved ip:[1] 192.168.2.222 Oct 18 18:50:42 volumiobookwormdev systemd[1]: Finished welcome.service - Show a welcome message on console. Oct 18 18:50:42 volumiobookwormdev systemd[1]: Reached target ip-changed@wlan0.target - IP Address changed on wlan0. Oct 18 18:50:42 volumiobookwormdev volumio[1105]: compat.c: read() failed: Resource temporarily unavailable Oct 18 18:50:42 volumiobookwormdev volumio[1105]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 18 18:50:42 volumiobookwormdev volumio[1105]: Error: dns service error: unknown Oct 18 18:50:42 volumiobookwormdev volumio[1105]: at MDNSService.self.watcher.callback (/volumio/node_modules/mdns/lib/mdns_service.js:18:40) { Oct 18 18:50:42 volumiobookwormdev volumio[1105]: errorCode: -65537 Oct 18 18:50:42 volumiobookwormdev volumio[1105]: } Oct 18 18:50:42 volumiobookwormdev volumio[1105]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 18 18:50:42 volumiobookwormdev wireless.js[2491]: trying... Oct 18 18:50:42 volumiobookwormdev sudo[2695]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Oct 18 18:50:42 volumiobookwormdev sudo[2695]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 18 18:50:42 volumiobookwormdev sudo[2695]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:42 volumiobookwormdev wireless.js[2491]: Connected to: ----gnet02 Oct 18 18:50:42 volumiobookwormdev wireless.js[2491]: ---- Oct 18 18:50:42 volumiobookwormdev sudo[2698]: root : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 18 18:50:42 volumiobookwormdev sudo[2698]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 18 18:50:42 volumiobookwormdev sudo[2698]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:42 volumiobookwormdev wireless.js[2491]: ... joined AP, wlan0 IPv4 is 192.168.2.222, ipV6 is undefined Oct 18 18:50:42 volumiobookwormdev wireless.js[2491]: It's done! AP Oct 18 18:50:42 volumiobookwormdev systemd[1]: Started wireless.service - Wireless Services. Oct 18 18:50:42 volumiobookwormdev sudo[2489]: pam_unix(sudo:session): session closed for user root Oct 18 18:50:42 volumiobookwormdev kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled Oct 18 18:50:42 volumiobookwormdev sudo[2708]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2024-10-18 18:49' Oct 18 18:50:42 volumiobookwormdev sudo[2708]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) PRETTY_NAME="Raspbian GNU/Linux 12 (bookworm)" NAME="Raspbian GNU/Linux" VERSION_ID="12" VERSION="12 (bookworm)" VERSION_CODENAME=bookworm ID=raspbian ID_LIKE=debian HOME_URL="http://www.raspbian.org/" SUPPORT_URL="http://www.raspbian.org/RaspbianForums" BUG_REPORT_URL="http://www.raspbian.org/RaspbianBugs" VOLUMIO_BUILD_VERSION="ae305eee684bf0e0a80d42f4e60069ac98b8a4ff" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="bb2ce46c7850778ccf32d9d94e4a7df6f5b2d2a2" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sun Oct 13 04:23:58 PM CEST 2024" VOLUMIO_VERSION="0.011" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="898600e292c69f9e12b00973367b41ce"