May 26 12:10:00 volumio volumio[30328]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded May 26 12:10:00 volumio volumio[30328]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services May 26 12:10:00 volumio volumio[30328]: info: Streaming services startup May 26 12:10:00 volumio volumio[30328]: info: Starting Streaming Daemon May 26 12:10:00 volumio sudo[30714]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service May 26 12:10:00 volumio sudo[30714]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:00 volumio volumio[30328]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started May 26 12:10:00 volumio sudo[30714]: pam_unix(sudo:session): session closed for user root May 26 12:10:00 volumio volumio[30328]: error: Cannot start Volumio Streaming Daemon May 26 12:10:00 volumio volumio[30328]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service May 26 12:10:00 volumio volumio[30328]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:00 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:00 volumio volumio[30328]: info: Discovery: Getting this device information May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:00 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:00 volumio volumio[30328]: verbose: New Socket.io Connection to 192.168.1.199:3000 from 192.168.1.196 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 21 May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:00 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard May 26 12:10:00 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:00 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:01 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 74. May 26 12:10:01 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:01 volumio dnsmasq[30710]: exiting on receipt of SIGTERM May 26 12:10:01 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:01 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:01 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:01 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:01 volumio hostapd[30721]: rfkill: WLAN soft blocked May 26 12:10:01 volumio hostapd[30721]: Failed to set beacon parameters May 26 12:10:01 volumio hostapd[30721]: wlan0: Could not connect to kernel driver May 26 12:10:01 volumio hostapd[30721]: Interface initialization failed May 26 12:10:01 volumio hostapd[30721]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:01 volumio hostapd[30721]: wlan0: AP-DISABLED May 26 12:10:01 volumio hostapd[30721]: wlan0: Unable to setup interface. May 26 12:10:01 volumio hostapd[30721]: wlan0: interface state DISABLED->DISABLED May 26 12:10:01 volumio hostapd[30721]: wlan0: AP-DISABLED May 26 12:10:01 volumio hostapd[30721]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:01 volumio hostapd[30721]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:01 volumio hostapd[30721]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:01 volumio volumio[30328]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN May 26 12:10:01 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:01 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:01 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:01 volumio sudo[30724]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 26 12:10:01 volumio sudo[30724]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:01 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:01 volumio sudo[30726]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 26 12:10:01 volumio sudo[30726]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:01 volumio sudo[30724]: pam_unix(sudo:session): session closed for user root May 26 12:10:01 volumio sudo[30726]: pam_unix(sudo:session): session closed for user root May 26 12:10:01 volumio dnsmasq[30732]: started, version 2.90 cachesize 150 May 26 12:10:01 volumio dnsmasq[30732]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:01 volumio dnsmasq-dhcp[30732]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:01 volumio dnsmasq[30732]: reading /etc/resolv.conf May 26 12:10:01 volumio dnsmasq[30732]: using nameserver 80.58.61.250#53 May 26 12:10:01 volumio dnsmasq[30732]: using nameserver 80.58.61.254#53 May 26 12:10:01 volumio dnsmasq[30732]: using nameserver 208.67.222.222#53 May 26 12:10:01 volumio dnsmasq[30732]: using nameserver 208.67.220.220#53 May 26 12:10:01 volumio dnsmasq[30732]: read /etc/hosts - 18 names May 26 12:10:01 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:01 volumio volumio[30328]: info: MyVolumio token set successfully May 26 12:10:01 volumio volumio[30328]: info: MYVOLUMIO: Adding device May 26 12:10:01 volumio volumio[30328]: info: MYVOLUMIO: Evaluating Server May 26 12:10:01 volumio sudo[30738]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 26 12:10:01 volumio sudo[30738]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:01 volumio sudo[30738]: pam_unix(sudo:session): session closed for user root May 26 12:10:01 volumio sudo[30740]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 26 12:10:01 volumio sudo[30740]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:01 volumio sudo[30740]: pam_unix(sudo:session): session closed for user root May 26 12:10:02 volumio volumio[30328]: info: MyVolumio status changed May 26 12:10:02 volumio volumio[30328]: info: Streaming services startup May 26 12:10:02 volumio volumio[30328]: info: Starting Streaming Daemon May 26 12:10:02 volumio volumio[30328]: info: Removing browser output: myVolumio user plan is not superstar May 26 12:10:02 volumio volumio[30328]: info: Removing audio output: May 26 12:10:02 volumio volumio[30328]: info: Stoppping Tunnel 1 May 26 12:10:02 volumio sudo[30759]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service May 26 12:10:02 volumio sudo[30759]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:02 volumio sudo[30761]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop sshtunnel.service May 26 12:10:02 volumio volumio[30328]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 22 May 26 12:10:02 volumio sudo[30761]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:02 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:10:02 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:10:02 volumio sudo[30759]: pam_unix(sudo:session): session closed for user root May 26 12:10:02 volumio volumio[30328]: error: Cannot start Volumio Streaming Daemon May 26 12:10:02 volumio volumio[30328]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service May 26 12:10:02 volumio volumio[30328]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. May 26 12:10:02 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:10:02 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:10:02 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:10:02 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:10:02 volumio sudo[30761]: pam_unix(sudo:session): session closed for user root May 26 12:10:02 volumio volumio[30328]: info: Remote SSH Stopped May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled May 26 12:10:02 volumio volumio[30328]: info: Setting Geolocation for MyVolumio to eu9 May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::volumioGetVisibleSources May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:02 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 26 12:10:02 volumio volumio[30328]: info: Received Get System Info May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:02 volumio volumio[30328]: info: Discovery: Getting this device information May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:02 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:02 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:02 volumio volumio[30328]: info: Listing playlists May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings May 26 12:10:02 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings May 26 12:10:02 volumio volumio[30328]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} May 26 12:10:03 volumio volumio[30328]: info: Updating MyVolumio device info May 26 12:10:03 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:03 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:03 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:03 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 75. May 26 12:10:03 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:03 volumio dnsmasq[30732]: exiting on receipt of SIGTERM May 26 12:10:03 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:03 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:03 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:03 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:03 volumio hostapd[30780]: rfkill: WLAN soft blocked May 26 12:10:03 volumio hostapd[30780]: Failed to set beacon parameters May 26 12:10:03 volumio hostapd[30780]: wlan0: Could not connect to kernel driver May 26 12:10:03 volumio hostapd[30780]: Interface initialization failed May 26 12:10:03 volumio hostapd[30780]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:03 volumio hostapd[30780]: wlan0: AP-DISABLED May 26 12:10:03 volumio hostapd[30780]: wlan0: Unable to setup interface. May 26 12:10:03 volumio hostapd[30780]: wlan0: interface state DISABLED->DISABLED May 26 12:10:03 volumio hostapd[30780]: wlan0: AP-DISABLED May 26 12:10:03 volumio hostapd[30780]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:03 volumio hostapd[30780]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:03 volumio hostapd[30780]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:03 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:03 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:03 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:03 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:03 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus May 26 12:10:03 volumio volumio[30328]: info: Received Get System Info May 26 12:10:03 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:03 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:03 volumio volumio[30328]: info: Discovery: Getting this device information May 26 12:10:03 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:03 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:03 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:04 volumio dnsmasq[30785]: started, version 2.90 cachesize 150 May 26 12:10:04 volumio dnsmasq[30785]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:04 volumio dnsmasq-dhcp[30785]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:04 volumio dnsmasq[30785]: reading /etc/resolv.conf May 26 12:10:04 volumio dnsmasq[30785]: using nameserver 80.58.61.250#53 May 26 12:10:04 volumio dnsmasq[30785]: using nameserver 80.58.61.254#53 May 26 12:10:04 volumio dnsmasq[30785]: using nameserver 208.67.222.222#53 May 26 12:10:04 volumio dnsmasq[30785]: using nameserver 208.67.220.220#53 May 26 12:10:04 volumio dnsmasq[30785]: read /etc/hosts - 18 names May 26 12:10:04 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:04 volumio volumio[30328]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} May 26 12:10:04 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard May 26 12:10:05 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus May 26 12:10:05 volumio volumio[30328]: info: Received Get System Info May 26 12:10:05 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:05 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:05 volumio volumio[30328]: info: Discovery: Getting this device information May 26 12:10:05 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:05 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:05 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:05 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 76. May 26 12:10:05 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:05 volumio dnsmasq[30785]: exiting on receipt of SIGTERM May 26 12:10:05 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:05 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:05 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:05 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:05 volumio hostapd[30789]: rfkill: WLAN soft blocked May 26 12:10:05 volumio hostapd[30789]: Failed to set beacon parameters May 26 12:10:05 volumio hostapd[30789]: wlan0: Could not connect to kernel driver May 26 12:10:05 volumio hostapd[30789]: Interface initialization failed May 26 12:10:05 volumio hostapd[30789]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:05 volumio hostapd[30789]: wlan0: AP-DISABLED May 26 12:10:05 volumio hostapd[30789]: wlan0: Unable to setup interface. May 26 12:10:05 volumio hostapd[30789]: wlan0: interface state DISABLED->DISABLED May 26 12:10:05 volumio hostapd[30789]: wlan0: AP-DISABLED May 26 12:10:05 volumio hostapd[30789]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:05 volumio hostapd[30789]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:05 volumio hostapd[30789]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:06 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:06 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:06 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:06 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:06 volumio dnsmasq[30794]: started, version 2.90 cachesize 150 May 26 12:10:06 volumio dnsmasq[30794]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:06 volumio dnsmasq-dhcp[30794]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:06 volumio dnsmasq[30794]: reading /etc/resolv.conf May 26 12:10:06 volumio dnsmasq[30794]: using nameserver 80.58.61.250#53 May 26 12:10:06 volumio dnsmasq[30794]: using nameserver 80.58.61.254#53 May 26 12:10:06 volumio dnsmasq[30794]: using nameserver 208.67.222.222#53 May 26 12:10:06 volumio dnsmasq[30794]: using nameserver 208.67.220.220#53 May 26 12:10:06 volumio dnsmasq[30794]: read /etc/hosts - 18 names May 26 12:10:06 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:06 volumio volumio[30328]: info: MYVOLUMIO: Adding device May 26 12:10:06 volumio volumio[30328]: info: MYVOLUMIO: Evaluating Server May 26 12:10:07 volumio volumio[30328]: info: Setting Geolocation for MyVolumio to eu9 May 26 12:10:07 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:07 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:07 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:08 volumio volumio[30328]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} May 26 12:10:08 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 77. May 26 12:10:08 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:08 volumio dnsmasq[30794]: exiting on receipt of SIGTERM May 26 12:10:08 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:08 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:08 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:08 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:08 volumio hostapd[30813]: rfkill: WLAN soft blocked May 26 12:10:08 volumio hostapd[30813]: Failed to set beacon parameters May 26 12:10:08 volumio hostapd[30813]: wlan0: Could not connect to kernel driver May 26 12:10:08 volumio hostapd[30813]: Interface initialization failed May 26 12:10:08 volumio hostapd[30813]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:08 volumio hostapd[30813]: wlan0: AP-DISABLED May 26 12:10:08 volumio hostapd[30813]: wlan0: Unable to setup interface. May 26 12:10:08 volumio hostapd[30813]: wlan0: interface state DISABLED->DISABLED May 26 12:10:08 volumio hostapd[30813]: wlan0: AP-DISABLED May 26 12:10:08 volumio hostapd[30813]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:08 volumio hostapd[30813]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:08 volumio hostapd[30813]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:08 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:08 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:08 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:08 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:08 volumio volumio[30328]: info: Updating MyVolumio device info May 26 12:10:08 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:08 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:08 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:08 volumio dnsmasq[30818]: started, version 2.90 cachesize 150 May 26 12:10:08 volumio dnsmasq[30818]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:08 volumio dnsmasq-dhcp[30818]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:08 volumio dnsmasq[30818]: reading /etc/resolv.conf May 26 12:10:08 volumio dnsmasq[30818]: using nameserver 80.58.61.250#53 May 26 12:10:08 volumio dnsmasq[30818]: using nameserver 80.58.61.254#53 May 26 12:10:08 volumio dnsmasq[30818]: using nameserver 208.67.222.222#53 May 26 12:10:08 volumio dnsmasq[30818]: using nameserver 208.67.220.220#53 May 26 12:10:08 volumio dnsmasq[30818]: read /etc/hosts - 18 names May 26 12:10:08 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:08 volumio volumio[30328]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} May 26 12:10:09 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:09 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:09 volumio sudo[30822]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 26 12:10:09 volumio sudo[30822]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:09 volumio sudo[30822]: pam_unix(sudo:session): session closed for user root May 26 12:10:09 volumio sudo[30824]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 26 12:10:09 volumio sudo[30824]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:09 volumio sudo[30824]: pam_unix(sudo:session): session closed for user root May 26 12:10:09 volumio volumio[30328]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 23 May 26 12:10:09 volumio sudo[30828]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 26 12:10:09 volumio sudo[30828]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:09 volumio sudo[30828]: pam_unix(sudo:session): session closed for user root May 26 12:10:09 volumio sudo[30830]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 26 12:10:09 volumio sudo[30830]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:09 volumio sudo[30830]: pam_unix(sudo:session): session closed for user root May 26 12:10:10 volumio volumio[30328]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 24 May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::volumioGetVisibleSources May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:10 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 26 12:10:10 volumio volumio[30328]: info: Received Get System Info May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:10 volumio volumio[30328]: info: Discovery: Getting this device information May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:10 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:10 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:10 volumio volumio[30328]: info: Listing playlists May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings May 26 12:10:10 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache May 26 12:10:10 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 78. May 26 12:10:10 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:10 volumio dnsmasq[30818]: exiting on receipt of SIGTERM May 26 12:10:10 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:10 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:10 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:10 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:10 volumio hostapd[30835]: rfkill: WLAN soft blocked May 26 12:10:10 volumio hostapd[30835]: Failed to set beacon parameters May 26 12:10:10 volumio hostapd[30835]: wlan0: Could not connect to kernel driver May 26 12:10:10 volumio hostapd[30835]: Interface initialization failed May 26 12:10:10 volumio hostapd[30835]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:10 volumio hostapd[30835]: wlan0: AP-DISABLED May 26 12:10:10 volumio hostapd[30835]: wlan0: Unable to setup interface. May 26 12:10:10 volumio hostapd[30835]: wlan0: interface state DISABLED->DISABLED May 26 12:10:10 volumio hostapd[30835]: wlan0: AP-DISABLED May 26 12:10:10 volumio hostapd[30835]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:10 volumio hostapd[30835]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:10 volumio hostapd[30835]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:10 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:10 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:10 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:10 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:10 volumio dnsmasq[30840]: started, version 2.90 cachesize 150 May 26 12:10:10 volumio dnsmasq[30840]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:10 volumio dnsmasq-dhcp[30840]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:10 volumio dnsmasq[30840]: reading /etc/resolv.conf May 26 12:10:10 volumio dnsmasq[30840]: using nameserver 80.58.61.250#53 May 26 12:10:10 volumio dnsmasq[30840]: using nameserver 80.58.61.254#53 May 26 12:10:10 volumio dnsmasq[30840]: using nameserver 208.67.222.222#53 May 26 12:10:10 volumio dnsmasq[30840]: using nameserver 208.67.220.220#53 May 26 12:10:10 volumio dnsmasq[30840]: read /etc/hosts - 18 names May 26 12:10:10 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:11 volumio volumio[30328]: info: CoreCommandRouter::volumioGetQueue May 26 12:10:11 volumio volumio[30328]: info: CoreStateMachine::getQueue May 26 12:10:11 volumio volumio[30328]: info: CorePlayQueue::getQueue May 26 12:10:11 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard May 26 12:10:11 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus May 26 12:10:11 volumio volumio[30328]: info: Received Get System Info May 26 12:10:11 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:11 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:11 volumio volumio[30328]: info: Discovery: Getting this device information May 26 12:10:11 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:11 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:11 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:12 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:12 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus May 26 12:10:12 volumio volumio[30328]: info: Received Get System Info May 26 12:10:12 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:12 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:12 volumio volumio[30328]: info: Discovery: Getting this device information May 26 12:10:12 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:12 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:12 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:12 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 79. May 26 12:10:12 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:12 volumio dnsmasq[30840]: exiting on receipt of SIGTERM May 26 12:10:12 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:12 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:12 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:12 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:13 volumio hostapd[30858]: rfkill: WLAN soft blocked May 26 12:10:13 volumio hostapd[30858]: Failed to set beacon parameters May 26 12:10:13 volumio hostapd[30858]: wlan0: Could not connect to kernel driver May 26 12:10:13 volumio hostapd[30858]: Interface initialization failed May 26 12:10:13 volumio hostapd[30858]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:13 volumio hostapd[30858]: wlan0: AP-DISABLED May 26 12:10:13 volumio hostapd[30858]: wlan0: Unable to setup interface. May 26 12:10:13 volumio hostapd[30858]: wlan0: interface state DISABLED->DISABLED May 26 12:10:13 volumio hostapd[30858]: wlan0: AP-DISABLED May 26 12:10:13 volumio hostapd[30858]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:13 volumio hostapd[30858]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:13 volumio hostapd[30858]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:13 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:13 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:13 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:13 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:13 volumio dnsmasq[30863]: started, version 2.90 cachesize 150 May 26 12:10:13 volumio dnsmasq[30863]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:13 volumio dnsmasq-dhcp[30863]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:13 volumio dnsmasq[30863]: reading /etc/resolv.conf May 26 12:10:13 volumio dnsmasq[30863]: using nameserver 80.58.61.250#53 May 26 12:10:13 volumio dnsmasq[30863]: using nameserver 80.58.61.254#53 May 26 12:10:13 volumio dnsmasq[30863]: using nameserver 208.67.222.222#53 May 26 12:10:13 volumio dnsmasq[30863]: using nameserver 208.67.220.220#53 May 26 12:10:13 volumio dnsmasq[30863]: read /etc/hosts - 18 names May 26 12:10:13 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:14 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings May 26 12:10:14 volumio volumio[30328]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 25 May 26 12:10:14 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:14 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:15 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 80. May 26 12:10:15 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:15 volumio dnsmasq[30863]: exiting on receipt of SIGTERM May 26 12:10:15 volumio systemd[1]: Starting setdatetime-helper.timer.service - Volumio Time Sync Watchdog Service... May 26 12:10:15 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:15 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:15 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:15 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:15 volumio hostapd[30868]: rfkill: WLAN soft blocked May 26 12:10:15 volumio hostapd[30868]: Failed to set beacon parameters May 26 12:10:15 volumio hostapd[30868]: wlan0: Could not connect to kernel driver May 26 12:10:15 volumio dbus-daemon[612]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service' requested by ':1.210' (uid=0 pid=30869 comm="timedatectl show --property=NTPSynchronized --valu") May 26 12:10:15 volumio hostapd[30868]: Interface initialization failed May 26 12:10:15 volumio hostapd[30868]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:15 volumio hostapd[30868]: wlan0: AP-DISABLED May 26 12:10:15 volumio hostapd[30868]: wlan0: Unable to setup interface. May 26 12:10:15 volumio hostapd[30868]: wlan0: interface state DISABLED->DISABLED May 26 12:10:15 volumio hostapd[30868]: wlan0: AP-DISABLED May 26 12:10:15 volumio hostapd[30868]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:15 volumio hostapd[30868]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:15 volumio hostapd[30868]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:15 volumio systemd[1]: Starting systemd-timedated.service - Time & Date Service... May 26 12:10:15 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:15 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:15 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:15 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:15 volumio dnsmasq[30876]: started, version 2.90 cachesize 150 May 26 12:10:15 volumio dnsmasq[30876]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:15 volumio dnsmasq-dhcp[30876]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:15 volumio dnsmasq[30876]: reading /etc/resolv.conf May 26 12:10:15 volumio dnsmasq[30876]: using nameserver 80.58.61.250#53 May 26 12:10:15 volumio dnsmasq[30876]: using nameserver 80.58.61.254#53 May 26 12:10:15 volumio dnsmasq[30876]: using nameserver 208.67.222.222#53 May 26 12:10:15 volumio dnsmasq[30876]: using nameserver 208.67.220.220#53 May 26 12:10:15 volumio dnsmasq[30876]: read /etc/hosts - 18 names May 26 12:10:15 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:15 volumio dbus-daemon[612]: [system] Successfully activated service 'org.freedesktop.timedate1' May 26 12:10:15 volumio systemd[1]: Started systemd-timedated.service - Time & Date Service. May 26 12:10:15 volumio setdatetime-helper.sh[30867]: Time is not synchronized. Attempting to sync... May 26 12:10:15 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 26 12:10:15 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:15 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled May 26 12:10:16 volumio volumio-remote-updater[628]: No test mode May 26 12:10:16 volumio volumio-remote-updater[628]: No alpha test mode May 26 12:10:16 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled May 26 12:10:16 volumio sudo[30887]: root : PWD=/ ; USER=root ; COMMAND=/usr/bin/date -s 'Mon, 26 May 2025 10:10:16 GMT#015' May 26 12:10:16 volumio sudo[30887]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 26 12:10:16 volumio setdatetime-helper.sh[30889]: Mon May 26 12:10:16 CEST 2025 May 26 12:10:16 volumio systemd-journald[368]: Time jumped backwards, rotating. May 26 12:10:16 volumio systemd[1]: setdatetime-helper.timer.service: Deactivated successfully. May 26 12:10:16 volumio sudo[30887]: pam_unix(sudo:session): session closed for user root May 26 12:10:16 volumio setdatetime-helper.sh[30867]: Time synchronized successfully. May 26 12:10:16 volumio systemd[1]: Finished setdatetime-helper.timer.service - Volumio Time Sync Watchdog Service. May 26 12:10:16 volumio volumio[30328]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} May 26 12:10:16 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache May 26 12:10:17 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 81. May 26 12:10:17 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:17 volumio dnsmasq[30876]: exiting on receipt of SIGTERM May 26 12:10:17 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:17 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:17 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:17 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:17 volumio hostapd[30892]: rfkill: WLAN soft blocked May 26 12:10:17 volumio hostapd[30892]: Failed to set beacon parameters May 26 12:10:17 volumio hostapd[30892]: wlan0: Could not connect to kernel driver May 26 12:10:17 volumio hostapd[30892]: Interface initialization failed May 26 12:10:17 volumio hostapd[30892]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:17 volumio hostapd[30892]: wlan0: AP-DISABLED May 26 12:10:17 volumio hostapd[30892]: wlan0: Unable to setup interface. May 26 12:10:17 volumio hostapd[30892]: wlan0: interface state DISABLED->DISABLED May 26 12:10:17 volumio hostapd[30892]: wlan0: AP-DISABLED May 26 12:10:17 volumio hostapd[30892]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:17 volumio hostapd[30892]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:17 volumio hostapd[30892]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:17 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:17 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:17 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:17 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:17 volumio dnsmasq[30897]: started, version 2.90 cachesize 150 May 26 12:10:17 volumio dnsmasq[30897]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:17 volumio dnsmasq-dhcp[30897]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:17 volumio dnsmasq[30897]: reading /etc/resolv.conf May 26 12:10:17 volumio dnsmasq[30897]: using nameserver 80.58.61.250#53 May 26 12:10:17 volumio dnsmasq[30897]: using nameserver 80.58.61.254#53 May 26 12:10:17 volumio dnsmasq[30897]: using nameserver 208.67.222.222#53 May 26 12:10:17 volumio dnsmasq[30897]: using nameserver 208.67.220.220#53 May 26 12:10:17 volumio dnsmasq[30897]: read /etc/hosts - 18 names May 26 12:10:17 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:19 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:19 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:19 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam May 26 12:10:19 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam May 26 12:10:19 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject May 26 12:10:19 volumio volumio[30328]: info: CoreCommandRouter::volumioGetBrowseSources May 26 12:10:19 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 26 12:10:19 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 82. May 26 12:10:19 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:19 volumio dnsmasq[30897]: exiting on receipt of SIGTERM May 26 12:10:19 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:19 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:19 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:19 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:19 volumio hostapd[30901]: rfkill: WLAN soft blocked May 26 12:10:19 volumio hostapd[30901]: Failed to set beacon parameters May 26 12:10:19 volumio hostapd[30901]: wlan0: Could not connect to kernel driver May 26 12:10:19 volumio hostapd[30901]: Interface initialization failed May 26 12:10:19 volumio hostapd[30901]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:19 volumio hostapd[30901]: wlan0: AP-DISABLED May 26 12:10:19 volumio hostapd[30901]: wlan0: Unable to setup interface. May 26 12:10:19 volumio hostapd[30901]: wlan0: interface state DISABLED->DISABLED May 26 12:10:19 volumio hostapd[30901]: wlan0: AP-DISABLED May 26 12:10:19 volumio hostapd[30901]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:19 volumio hostapd[30901]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:19 volumio hostapd[30901]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:19 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:20 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:20 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:20 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:20 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:20 volumio dnsmasq[30906]: started, version 2.90 cachesize 150 May 26 12:10:20 volumio dnsmasq[30906]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:20 volumio dnsmasq-dhcp[30906]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:20 volumio dnsmasq[30906]: reading /etc/resolv.conf May 26 12:10:20 volumio dnsmasq[30906]: using nameserver 80.58.61.250#53 May 26 12:10:20 volumio dnsmasq[30906]: using nameserver 80.58.61.254#53 May 26 12:10:20 volumio dnsmasq[30906]: using nameserver 208.67.222.222#53 May 26 12:10:20 volumio dnsmasq[30906]: using nameserver 208.67.220.220#53 May 26 12:10:20 volumio dnsmasq[30906]: read /etc/hosts - 18 names May 26 12:10:20 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:20 volumio volumio[30328]: error: MyVolumio Plugin failed to authenticate in a timely fashion May 26 12:10:20 volumio volumio[30328]: info: Completed starting MyVolumio Plugin May 26 12:10:20 volumio volumio[30328]: [Metrics] CommandRouter: 50s 500.97ms May 26 12:10:20 volumio volumio[30328]: info: CoreCommandRouter::volumiosetStartupVolume May 26 12:10:20 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:20 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:20 volumio volumio[30328]: info: CoreCommandRouter::Close All Modals sent May 26 12:10:20 volumio volumio[30328]: info: CoreCommandRouter::Close All Modals sent May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings May 26 12:10:21 volumio volumio[30328]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates May 26 12:10:21 volumio volumio[30328]: info: Received Get System Version May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 26 12:10:21 volumio volumio[30328]: info: Received Get System Info May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:21 volumio volumio[30328]: info: Discovery: Getting this device information May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::volumioGetState May 26 12:10:21 volumio volumio[30328]: info: CorePlayQueue::getTrack 0 May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus May 26 12:10:21 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect May 26 12:10:22 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 83. May 26 12:10:22 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:22 volumio dnsmasq[30906]: exiting on receipt of SIGTERM May 26 12:10:22 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:22 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:22 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:22 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:22 volumio hostapd[30915]: rfkill: WLAN soft blocked May 26 12:10:22 volumio hostapd[30915]: Failed to set beacon parameters May 26 12:10:22 volumio hostapd[30915]: wlan0: Could not connect to kernel driver May 26 12:10:22 volumio hostapd[30915]: Interface initialization failed May 26 12:10:22 volumio hostapd[30915]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:22 volumio hostapd[30915]: wlan0: AP-DISABLED May 26 12:10:22 volumio hostapd[30915]: wlan0: Unable to setup interface. May 26 12:10:22 volumio hostapd[30915]: wlan0: interface state DISABLED->DISABLED May 26 12:10:22 volumio hostapd[30915]: wlan0: AP-DISABLED May 26 12:10:22 volumio hostapd[30915]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:22 volumio hostapd[30915]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:22 volumio hostapd[30915]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:22 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:22 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:22 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:22 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:22 volumio dnsmasq[30920]: started, version 2.90 cachesize 150 May 26 12:10:22 volumio dnsmasq[30920]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:22 volumio dnsmasq-dhcp[30920]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:22 volumio dnsmasq[30920]: reading /etc/resolv.conf May 26 12:10:22 volumio dnsmasq[30920]: using nameserver 80.58.61.250#53 May 26 12:10:22 volumio dnsmasq[30920]: using nameserver 80.58.61.254#53 May 26 12:10:22 volumio dnsmasq[30920]: using nameserver 208.67.222.222#53 May 26 12:10:22 volumio dnsmasq[30920]: using nameserver 208.67.220.220#53 May 26 12:10:22 volumio dnsmasq[30920]: read /etc/hosts - 18 names May 26 12:10:22 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:23 volumio ntpd[896]: CLOCK: time stepped by 0.902753 May 26 12:10:23 volumio ntpd[896]: INIT: MRU 13107 entries, 13 hash bits, 32768 bytes May 26 12:10:25 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 84. May 26 12:10:25 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:25 volumio dnsmasq[30920]: exiting on receipt of SIGTERM May 26 12:10:25 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:25 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:25 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:25 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:25 volumio hostapd[30938]: rfkill: WLAN soft blocked May 26 12:10:25 volumio hostapd[30938]: Failed to set beacon parameters May 26 12:10:25 volumio hostapd[30938]: wlan0: Could not connect to kernel driver May 26 12:10:25 volumio hostapd[30938]: Interface initialization failed May 26 12:10:25 volumio hostapd[30938]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:25 volumio hostapd[30938]: wlan0: AP-DISABLED May 26 12:10:25 volumio hostapd[30938]: wlan0: Unable to setup interface. May 26 12:10:25 volumio hostapd[30938]: wlan0: interface state DISABLED->DISABLED May 26 12:10:25 volumio hostapd[30938]: wlan0: AP-DISABLED May 26 12:10:25 volumio hostapd[30938]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:25 volumio hostapd[30938]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:25 volumio hostapd[30938]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:25 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:25 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:25 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:25 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:25 volumio dnsmasq[30943]: started, version 2.90 cachesize 150 May 26 12:10:25 volumio dnsmasq[30943]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:25 volumio dnsmasq-dhcp[30943]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:25 volumio dnsmasq[30943]: reading /etc/resolv.conf May 26 12:10:25 volumio dnsmasq[30943]: using nameserver 80.58.61.250#53 May 26 12:10:25 volumio dnsmasq[30943]: using nameserver 80.58.61.254#53 May 26 12:10:25 volumio dnsmasq[30943]: using nameserver 208.67.222.222#53 May 26 12:10:25 volumio dnsmasq[30943]: using nameserver 208.67.220.220#53 May 26 12:10:25 volumio dnsmasq[30943]: read /etc/hosts - 18 names May 26 12:10:25 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:27 volumio volumio[30328]: Searching plugin music_service/webradio May 26 12:10:27 volumio volumio[30328]: info: CoreCommandRouter::executeOnPlugin: webradio , search May 26 12:10:27 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 85. May 26 12:10:27 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:27 volumio dnsmasq[30943]: exiting on receipt of SIGTERM May 26 12:10:27 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:27 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:27 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:27 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:27 volumio hostapd[30947]: rfkill: WLAN soft blocked May 26 12:10:27 volumio hostapd[30947]: Failed to set beacon parameters May 26 12:10:27 volumio hostapd[30947]: wlan0: Could not connect to kernel driver May 26 12:10:27 volumio hostapd[30947]: Interface initialization failed May 26 12:10:27 volumio hostapd[30947]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:27 volumio hostapd[30947]: wlan0: AP-DISABLED May 26 12:10:27 volumio hostapd[30947]: wlan0: Unable to setup interface. May 26 12:10:27 volumio hostapd[30947]: wlan0: interface state DISABLED->DISABLED May 26 12:10:27 volumio hostapd[30947]: wlan0: AP-DISABLED May 26 12:10:27 volumio hostapd[30947]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:27 volumio hostapd[30947]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:27 volumio hostapd[30947]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:27 volumio volumio[30328]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 26 12:10:27 volumio volumio[30328]: TypeError: Cannot read properties of undefined (reading 'length') May 26 12:10:27 volumio volumio[30328]: at /volumio/node_modules/libxmljs/dist/lib/parse.js:186:126 May 26 12:10:27 volumio volumio[30328]: at Object.parseXml (/volumio/node_modules/libxmljs/dist/lib/parse.js:185:49) May 26 12:10:27 volumio volumio[30328]: at /volumio/app/plugins/music_service/webradio/index.js:949:31 May 26 12:10:27 volumio volumio[30328]: at process.processTicksAndRejections (node:internal/process/task_queues:95:5) May 26 12:10:27 volumio volumio[30328]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 26 12:10:27 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:27 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:27 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:27 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:28 volumio dnsmasq[30963]: started, version 2.90 cachesize 150 May 26 12:10:28 volumio dnsmasq[30963]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:28 volumio dnsmasq-dhcp[30963]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:28 volumio dnsmasq[30963]: reading /etc/resolv.conf May 26 12:10:28 volumio dnsmasq[30963]: using nameserver 80.58.61.250#53 May 26 12:10:28 volumio dnsmasq[30963]: using nameserver 80.58.61.254#53 May 26 12:10:28 volumio dnsmasq[30963]: using nameserver 208.67.222.222#53 May 26 12:10:28 volumio dnsmasq[30963]: using nameserver 208.67.220.220#53 May 26 12:10:28 volumio dnsmasq[30963]: read /etc/hosts - 18 names May 26 12:10:28 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:28 volumio sudo[30969]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2025-05-26 12:09' May 26 12:10:28 volumio sudo[30969]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:29 volumio sudo[30969]: pam_unix(sudo:session): session closed for user root May 26 12:10:29 volumio volumio-remote-updater[628]: [2025-05-26 10:10:29] [error] handle_read_frame error: websocketpp.transport:7 (End of File) May 26 12:10:29 volumio volumio-remote-updater[628]: [2025-05-26 10:10:29] [disconnect] Disconnect close local:[1006,End of File] remote:[1006] May 26 12:10:29 volumio systemd[1]: volumio.service: Main process exited, code=exited, status=1/FAILURE May 26 12:10:29 volumio systemd[1]: volumio.service: Failed with result 'exit-code'. May 26 12:10:29 volumio systemd[1]: volumio.service: Consumed 48.897s CPU time. May 26 12:10:29 volumio systemd[1]: Started dynamicswap.service - dynamicswap service. May 26 12:10:29 volumio systemd[1]: dynamicswap.service: Deactivated successfully. May 26 12:10:29 volumio systemd[1]: volumio.service: Scheduled restart job, restart counter is at 2. May 26 12:10:29 volumio systemd[1]: Started dynamicswap.service - dynamicswap service. May 26 12:10:29 volumio systemd[1]: Stopped volumio.service - Volumio Backend Module. May 26 12:10:29 volumio systemd[1]: volumio.service: Consumed 48.897s CPU time. May 26 12:10:29 volumio systemd[1]: Started volumio.service - Volumio Backend Module. May 26 12:10:29 volumio systemd[1]: dynamicswap.service: Deactivated successfully. May 26 12:10:29 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 86. May 26 12:10:29 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:29 volumio dnsmasq[30963]: exiting on receipt of SIGTERM May 26 12:10:29 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:29 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:29 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:29 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:30 volumio hostapd[31003]: rfkill: WLAN soft blocked May 26 12:10:30 volumio hostapd[31003]: Failed to set beacon parameters May 26 12:10:30 volumio hostapd[31003]: wlan0: Could not connect to kernel driver May 26 12:10:30 volumio hostapd[31003]: Interface initialization failed May 26 12:10:30 volumio hostapd[31003]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:30 volumio hostapd[31003]: wlan0: AP-DISABLED May 26 12:10:30 volumio hostapd[31003]: wlan0: Unable to setup interface. May 26 12:10:30 volumio hostapd[31003]: wlan0: interface state DISABLED->DISABLED May 26 12:10:30 volumio hostapd[31003]: wlan0: AP-DISABLED May 26 12:10:30 volumio hostapd[31003]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:30 volumio hostapd[31003]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:30 volumio hostapd[31003]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:30 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:30 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:30 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:30 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:30 volumio dnsmasq[31009]: started, version 2.90 cachesize 150 May 26 12:10:30 volumio dnsmasq[31009]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:30 volumio dnsmasq-dhcp[31009]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:30 volumio dnsmasq[31009]: reading /etc/resolv.conf May 26 12:10:30 volumio dnsmasq[31009]: using nameserver 80.58.61.250#53 May 26 12:10:30 volumio dnsmasq[31009]: using nameserver 80.58.61.254#53 May 26 12:10:30 volumio dnsmasq[31009]: using nameserver 208.67.222.222#53 May 26 12:10:30 volumio dnsmasq[31009]: using nameserver 208.67.220.220#53 May 26 12:10:30 volumio dnsmasq[31009]: read /etc/hosts - 18 names May 26 12:10:30 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:32 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 87. May 26 12:10:32 volumio volumio[30988]: info: ------------------------------------------- May 26 12:10:32 volumio volumio[30988]: info: ----- Volumio3 ---- May 26 12:10:32 volumio volumio[30988]: info: ------------------------------------------- May 26 12:10:32 volumio volumio[30988]: info: ----- System startup ---- May 26 12:10:32 volumio volumio[30988]: info: ------------------------------------------- May 26 12:10:32 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:32 volumio dnsmasq[31009]: exiting on receipt of SIGTERM May 26 12:10:32 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:32 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:32 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:32 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:32 volumio hostapd[31019]: rfkill: WLAN soft blocked May 26 12:10:32 volumio hostapd[31019]: Failed to set beacon parameters May 26 12:10:32 volumio hostapd[31019]: wlan0: Could not connect to kernel driver May 26 12:10:32 volumio hostapd[31019]: Interface initialization failed May 26 12:10:32 volumio hostapd[31019]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:32 volumio hostapd[31019]: wlan0: AP-DISABLED May 26 12:10:32 volumio hostapd[31019]: wlan0: Unable to setup interface. May 26 12:10:32 volumio hostapd[31019]: wlan0: interface state DISABLED->DISABLED May 26 12:10:32 volumio hostapd[31019]: wlan0: AP-DISABLED May 26 12:10:32 volumio hostapd[31019]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:32 volumio hostapd[31019]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:32 volumio hostapd[31019]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:32 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:32 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:32 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:32 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:32 volumio dnsmasq[31024]: started, version 2.90 cachesize 150 May 26 12:10:32 volumio dnsmasq[31024]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:32 volumio dnsmasq-dhcp[31024]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:32 volumio dnsmasq[31024]: reading /etc/resolv.conf May 26 12:10:32 volumio dnsmasq[31024]: using nameserver 80.58.61.250#53 May 26 12:10:32 volumio dnsmasq[31024]: using nameserver 80.58.61.254#53 May 26 12:10:32 volumio dnsmasq[31024]: using nameserver 208.67.222.222#53 May 26 12:10:32 volumio dnsmasq[31024]: using nameserver 208.67.220.220#53 May 26 12:10:32 volumio dnsmasq[31024]: read /etc/hosts - 18 names May 26 12:10:32 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:33 volumio volumio[30988]: info: MYVOLUMIO Environment detected May 26 12:10:33 volumio volumio[30988]: info: Plugin folders cleanup May 26 12:10:33 volumio volumio[30988]: info: Scanning into folder /volumio/app/plugins/ May 26 12:10:33 volumio volumio[30988]: info: Scanning category audio_interface May 26 12:10:33 volumio volumio[30988]: info: Scanning category miscellanea May 26 12:10:33 volumio volumio[30988]: info: Scanning category music_service May 26 12:10:33 volumio volumio[30988]: info: Scanning category plugins.json May 26 12:10:33 volumio volumio[30988]: info: Scanning category system_controller May 26 12:10:33 volumio volumio[30988]: info: Scanning category user_interface May 26 12:10:33 volumio volumio[30988]: info: Scanning into folder /data/plugins/ May 26 12:10:33 volumio volumio[30988]: info: Scanning category music_service May 26 12:10:33 volumio volumio[30988]: info: Plugin folders cleanup completed May 26 12:10:33 volumio volumio[30988]: info: ------------------------------------------- May 26 12:10:33 volumio volumio[30988]: info: ----- Core plugins startup ---- May 26 12:10:33 volumio volumio[30988]: info: ------------------------------------------- May 26 12:10:33 volumio volumio[30988]: info: Loading plugins from folder /volumio/app/plugins/ May 26 12:10:33 volumio volumio[30988]: info: Adding plugin upnp to MyMusic Plugins May 26 12:10:33 volumio volumio[30988]: info: Adding plugin airplay_emulation to MyMusic Plugins May 26 12:10:33 volumio volumio[30988]: info: Adding plugin upnp_browser to MyMusic Plugins May 26 12:10:33 volumio volumio[30988]: info: Loading plugins from folder /data/plugins/ May 26 12:10:33 volumio volumio[30988]: info: Loading plugin "system"... May 26 12:10:33 volumio volumio[30988]: info: Loading plugin "appearance"... May 26 12:10:34 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 88. May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "network"... May 26 12:10:34 volumio volumio[30988]: info: Refreshing Cached IP Addresses May 26 12:10:34 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:34 volumio dnsmasq[31024]: exiting on receipt of SIGTERM May 26 12:10:34 volumio sudo[31035]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 26 12:10:34 volumio sudo[31035]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:34 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:34 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:34 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:34 volumio sudo[31035]: pam_unix(sudo:session): session closed for user root May 26 12:10:34 volumio sudo[31037]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 26 12:10:34 volumio sudo[31037]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:34 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "services"... May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "alsa_controller"... May 26 12:10:34 volumio sudo[31037]: pam_unix(sudo:session): session closed for user root May 26 12:10:34 volumio hostapd[31045]: rfkill: WLAN soft blocked May 26 12:10:34 volumio hostapd[31045]: Failed to set beacon parameters May 26 12:10:34 volumio hostapd[31045]: wlan0: Could not connect to kernel driver May 26 12:10:34 volumio hostapd[31045]: Interface initialization failed May 26 12:10:34 volumio hostapd[31045]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:34 volumio hostapd[31045]: wlan0: AP-DISABLED May 26 12:10:34 volumio hostapd[31045]: wlan0: Unable to setup interface. May 26 12:10:34 volumio hostapd[31045]: wlan0: interface state DISABLED->DISABLED May 26 12:10:34 volumio hostapd[31045]: wlan0: AP-DISABLED May 26 12:10:34 volumio hostapd[31045]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:34 volumio hostapd[31045]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:34 volumio hostapd[31045]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:34 volumio sudo[31051]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan May 26 12:10:34 volumio sudo[31051]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:34 volumio sudo[31051]: pam_unix(sudo:session): session closed for user root May 26 12:10:34 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "wizard"... May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "networkfs"... May 26 12:10:34 volumio volumio-remote-updater[628]: [2025-05-26 10:10:34] [connect] Successful connection May 26 12:10:34 volumio volumio[30988]: info: Starting Udev Watcher for removable devices May 26 12:10:34 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:34 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:34 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:34 volumio volumio[30988]: info: Ignoring mount for partition: boot May 26 12:10:34 volumio volumio[30988]: info: Ignoring mount for partition: volumio May 26 12:10:34 volumio volumio[30988]: info: Ignoring mount for partition: volumio_data May 26 12:10:34 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "volumio_command_line_client"... May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "upnp"... May 26 12:10:34 volumio volumio[30988]: info: [1748254234818] Starting Upmpd Daemon May 26 12:10:34 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "my_music"... May 26 12:10:34 volumio volumio[30988]: info: Loading plugin "mpd"... May 26 12:10:34 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:34 volumio dnsmasq[31073]: started, version 2.90 cachesize 150 May 26 12:10:34 volumio dnsmasq[31073]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:34 volumio dnsmasq-dhcp[31073]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:34 volumio dnsmasq[31073]: reading /etc/resolv.conf May 26 12:10:34 volumio dnsmasq[31073]: using nameserver 80.58.61.250#53 May 26 12:10:34 volumio dnsmasq[31073]: using nameserver 80.58.61.254#53 May 26 12:10:34 volumio dnsmasq[31073]: using nameserver 208.67.222.222#53 May 26 12:10:34 volumio dnsmasq[31073]: using nameserver 208.67.220.220#53 May 26 12:10:34 volumio dnsmasq[31073]: read /etc/hosts - 18 names May 26 12:10:34 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:35 volumio volumio[30988]: info: Loading plugin "upnp_browser"... May 26 12:10:36 volumio volumio[30988]: info: Loading plugin "alarm-clock"... May 26 12:10:36 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 89. May 26 12:10:37 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:37 volumio dnsmasq[31073]: exiting on receipt of SIGTERM May 26 12:10:37 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:37 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:37 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:37 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:37 volumio hostapd[31077]: rfkill: WLAN soft blocked May 26 12:10:37 volumio volumio[30988]: info: Loading plugin "airplay_emulation"... May 26 12:10:37 volumio hostapd[31077]: Failed to set beacon parameters May 26 12:10:37 volumio hostapd[31077]: wlan0: Could not connect to kernel driver May 26 12:10:37 volumio hostapd[31077]: Interface initialization failed May 26 12:10:37 volumio hostapd[31077]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:37 volumio hostapd[31077]: wlan0: AP-DISABLED May 26 12:10:37 volumio hostapd[31077]: wlan0: Unable to setup interface. May 26 12:10:37 volumio hostapd[31077]: wlan0: interface state DISABLED->DISABLED May 26 12:10:37 volumio hostapd[31077]: wlan0: AP-DISABLED May 26 12:10:37 volumio hostapd[31077]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:37 volumio hostapd[31077]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:37 volumio hostapd[31077]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:37 volumio volumio[30988]: info: Starting Shairport Sync May 26 12:10:37 volumio volumio[30988]: info: Loading plugin "last_100"... May 26 12:10:37 volumio volumio[30988]: info: Loading plugin "webradio"... May 26 12:10:37 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:37 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:37 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:37 volumio volumio[30988]: info: Loading plugin "i2s_dacs"... May 26 12:10:37 volumio volumio[30988]: info: I2S DAC not set, start Auto-detection May 26 12:10:37 volumio volumio[30988]: info: Loading plugin "volumiodiscovery"... May 26 12:10:37 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:37 volumio volumio[30988]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. May 26 12:10:37 volumio volumio[30988]: *** WARNING *** Please fix your application to use the native API of Avahi! May 26 12:10:37 volumio volumio[30988]: *** WARNING *** For more information see May 26 12:10:37 volumio volumio[30988]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. May 26 12:10:37 volumio node[30988]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. May 26 12:10:37 volumio volumio[30988]: *** WARNING *** Please fix your application to use the native API of Avahi! May 26 12:10:37 volumio volumio[30988]: *** WARNING *** For more information see May 26 12:10:37 volumio node[30988]: *** WARNING *** Please fix your application to use the native API of Avahi! May 26 12:10:37 volumio node[30988]: *** WARNING *** For more information see May 26 12:10:37 volumio node[30988]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. May 26 12:10:37 volumio node[30988]: *** WARNING *** Please fix your application to use the native API of Avahi! May 26 12:10:37 volumio node[30988]: *** WARNING *** For more information see May 26 12:10:37 volumio volumio[30988]: info: Applying required configuration parameters for plugin volumiodiscovery May 26 12:10:37 volumio volumio[30988]: info: Discovery: Started advertising with name: Volumio May 26 12:10:37 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback May 26 12:10:37 volumio volumio[30988]: info: Loading plugin "ytcr"... May 26 12:10:37 volumio dnsmasq[31084]: started, version 2.90 cachesize 150 May 26 12:10:37 volumio dnsmasq[31084]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:37 volumio dnsmasq-dhcp[31084]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:37 volumio dnsmasq[31084]: reading /etc/resolv.conf May 26 12:10:37 volumio dnsmasq[31084]: using nameserver 80.58.61.250#53 May 26 12:10:37 volumio dnsmasq[31084]: using nameserver 80.58.61.254#53 May 26 12:10:37 volumio dnsmasq[31084]: using nameserver 208.67.222.222#53 May 26 12:10:37 volumio dnsmasq[31084]: using nameserver 208.67.220.220#53 May 26 12:10:37 volumio dnsmasq[31084]: read /etc/hosts - 18 names May 26 12:10:37 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:39 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 90. May 26 12:10:39 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:39 volumio dnsmasq[31084]: exiting on receipt of SIGTERM May 26 12:10:39 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:39 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:39 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:39 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:39 volumio hostapd[31088]: rfkill: WLAN soft blocked May 26 12:10:39 volumio hostapd[31088]: Failed to set beacon parameters May 26 12:10:39 volumio hostapd[31088]: wlan0: Could not connect to kernel driver May 26 12:10:39 volumio hostapd[31088]: Interface initialization failed May 26 12:10:39 volumio hostapd[31088]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:39 volumio hostapd[31088]: wlan0: AP-DISABLED May 26 12:10:39 volumio hostapd[31088]: wlan0: Unable to setup interface. May 26 12:10:39 volumio hostapd[31088]: wlan0: interface state DISABLED->DISABLED May 26 12:10:39 volumio hostapd[31088]: wlan0: AP-DISABLED May 26 12:10:39 volumio hostapd[31088]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:39 volumio hostapd[31088]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:39 volumio hostapd[31088]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:39 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:39 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:39 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:39 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:39 volumio dnsmasq[31093]: started, version 2.90 cachesize 150 May 26 12:10:39 volumio dnsmasq[31093]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:39 volumio dnsmasq-dhcp[31093]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:39 volumio dnsmasq[31093]: reading /etc/resolv.conf May 26 12:10:39 volumio dnsmasq[31093]: using nameserver 80.58.61.250#53 May 26 12:10:39 volumio dnsmasq[31093]: using nameserver 80.58.61.254#53 May 26 12:10:39 volumio dnsmasq[31093]: using nameserver 208.67.222.222#53 May 26 12:10:39 volumio dnsmasq[31093]: using nameserver 208.67.220.220#53 May 26 12:10:39 volumio dnsmasq[31093]: read /etc/hosts - 18 names May 26 12:10:39 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:41 volumio volumio[30988]: info: Loading plugin "ytmusic"... May 26 12:10:41 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 91. May 26 12:10:42 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:42 volumio dnsmasq[31093]: exiting on receipt of SIGTERM May 26 12:10:42 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:42 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:42 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:42 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:42 volumio hostapd[31097]: rfkill: WLAN soft blocked May 26 12:10:42 volumio hostapd[31097]: Failed to set beacon parameters May 26 12:10:42 volumio hostapd[31097]: wlan0: Could not connect to kernel driver May 26 12:10:42 volumio hostapd[31097]: Interface initialization failed May 26 12:10:42 volumio hostapd[31097]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:42 volumio hostapd[31097]: wlan0: AP-DISABLED May 26 12:10:42 volumio hostapd[31097]: wlan0: Unable to setup interface. May 26 12:10:42 volumio hostapd[31097]: wlan0: interface state DISABLED->DISABLED May 26 12:10:42 volumio hostapd[31097]: wlan0: AP-DISABLED May 26 12:10:42 volumio hostapd[31097]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:42 volumio hostapd[31097]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:42 volumio hostapd[31097]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:42 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:42 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:42 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:42 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:42 volumio dnsmasq[31102]: started, version 2.90 cachesize 150 May 26 12:10:42 volumio dnsmasq[31102]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:42 volumio dnsmasq-dhcp[31102]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:42 volumio dnsmasq[31102]: reading /etc/resolv.conf May 26 12:10:42 volumio dnsmasq[31102]: using nameserver 80.58.61.250#53 May 26 12:10:42 volumio dnsmasq[31102]: using nameserver 80.58.61.254#53 May 26 12:10:42 volumio dnsmasq[31102]: using nameserver 208.67.222.222#53 May 26 12:10:42 volumio dnsmasq[31102]: using nameserver 208.67.220.220#53 May 26 12:10:42 volumio dnsmasq[31102]: read /etc/hosts - 18 names May 26 12:10:42 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:44 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 92. May 26 12:10:44 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:44 volumio dnsmasq[31102]: exiting on receipt of SIGTERM May 26 12:10:44 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:44 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:44 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:44 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:44 volumio hostapd[31106]: rfkill: WLAN soft blocked May 26 12:10:44 volumio hostapd[31106]: Failed to set beacon parameters May 26 12:10:44 volumio hostapd[31106]: wlan0: Could not connect to kernel driver May 26 12:10:44 volumio hostapd[31106]: Interface initialization failed May 26 12:10:44 volumio hostapd[31106]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:44 volumio hostapd[31106]: wlan0: AP-DISABLED May 26 12:10:44 volumio hostapd[31106]: wlan0: Unable to setup interface. May 26 12:10:44 volumio hostapd[31106]: wlan0: interface state DISABLED->DISABLED May 26 12:10:44 volumio hostapd[31106]: wlan0: AP-DISABLED May 26 12:10:44 volumio hostapd[31106]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:44 volumio hostapd[31106]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:44 volumio hostapd[31106]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:44 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:44 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:44 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:44 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:44 volumio dnsmasq[31111]: started, version 2.90 cachesize 150 May 26 12:10:44 volumio dnsmasq[31111]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:44 volumio dnsmasq-dhcp[31111]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:44 volumio dnsmasq[31111]: reading /etc/resolv.conf May 26 12:10:44 volumio dnsmasq[31111]: using nameserver 80.58.61.250#53 May 26 12:10:44 volumio dnsmasq[31111]: using nameserver 80.58.61.254#53 May 26 12:10:44 volumio dnsmasq[31111]: using nameserver 208.67.222.222#53 May 26 12:10:44 volumio dnsmasq[31111]: using nameserver 208.67.220.220#53 May 26 12:10:44 volumio dnsmasq[31111]: read /etc/hosts - 18 names May 26 12:10:44 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:44 volumio volumio[30988]: info: Loading plugin "outputs"... May 26 12:10:44 volumio volumio[30988]: info: Loading plugin "albumart"... May 26 12:10:44 volumio volumio[30988]: info: Plugin example_plugin is not enabled May 26 12:10:44 volumio volumio[30988]: info: Loading plugin "inputs"... May 26 12:10:44 volumio volumio[30988]: info: Loading plugin "updater_comm"... May 26 12:10:44 volumio volumio[30988]: info: Plugin mpdemulation is not enabled May 26 12:10:44 volumio volumio[30988]: info: Loading plugin "rest_api"... May 26 12:10:44 volumio volumio[30988]: info: Loading plugin "websocket"... May 26 12:10:45 volumio volumio[30988]: info: Starting Socket.io Server version 1.7.4 May 26 12:10:45 volumio volumio[30988]: info: Loading plugin "motherearthradio"... May 26 12:10:45 volumio volumio[30988]: info: Applying required configuration parameters for plugin motherearthradio May 26 12:10:45 volumio volumio[30988]: info: [1748254245283] [MotherEarth] API delay: 5 May 26 12:10:45 volumio volumio[30988]: info: Loading i18n strings for locale es May 26 12:10:45 volumio volumio[30988]: Updating browse sources language May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::initPlayerControls May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 26 12:10:45 volumio volumio[30988]: Express server listening on port 3000 May 26 12:10:45 volumio volumio[30988]: [Metrics] WebUI: 13s 901.98ms May 26 12:10:45 volumio volumio[30988]: info: CoreStateMachine::resetVolumioState May 26 12:10:45 volumio volumio[30988]: info: CoreStateMachine::getcurrentVolume May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::volumioRetrievevolume May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:45 volumio volumio[31128]: Forking 3 albumart workers May 26 12:10:45 volumio volumio[30988]: info: Cannot read play queue from file May 26 12:10:45 volumio sudo[31143]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 26 12:10:45 volumio sudo[31143]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:45 volumio sudo[31145]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 26 12:10:45 volumio sudo[31145]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:45 volumio sudo[31143]: pam_unix(sudo:session): session closed for user root May 26 12:10:45 volumio sudo[31145]: pam_unix(sudo:session): session closed for user root May 26 12:10:45 volumio volumio[30988]: info: Volumio Network Manager: Network status updated: 1 May 26 12:10:45 volumio volumio[30988]: error: An error occurred while scanning: Error: Command failed: sudo /sbin/iwlist wlan0 scan May 26 12:10:45 volumio volumio[30988]: wlan0 Interface doesn't support scanning : Network is down May 26 12:10:45 volumio volumio[30988]: info: Cannot use regular scanning, forcing with ap-force May 26 12:10:45 volumio sudo[31178]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 scan ap-force May 26 12:10:45 volumio sudo[31178]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:45 volumio sudo[31178]: pam_unix(sudo:session): session closed for user root May 26 12:10:45 volumio volumio[30988]: command failed: Network is down (-100) May 26 12:10:45 volumio volumio[30988]: error: Cannot use fallback scanning method: Error: Command failed: /usr/bin/sudo /sbin/iw dev wlan0 scan ap-force May 26 12:10:45 volumio volumio[30988]: command failed: Network is down (-100) May 26 12:10:45 volumio volumio[30988]: info: VolumeController:: Volume=86 Mute =false May 26 12:10:45 volumio volumio[30988]: info: CoreStateMachine::pushState May 26 12:10:45 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::volumioPushState May 26 12:10:45 volumio volumio[30988]: info: CoreStateMachine::updateTrackBlock May 26 12:10:45 volumio volumio[30988]: info: CorePlayQueue::getTrackBlock May 26 12:10:45 volumio volumio[30988]: info: CoreCommandRouter::volumioRetrievevolume May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 1 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 2 May 26 12:10:46 volumio volumio[30988]: info: CoreStateMachine::setRepeat null single undefined May 26 12:10:46 volumio volumio[30988]: info: CoreStateMachine::pushState May 26 12:10:46 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:46 volumio volumio[30988]: info: CoreCommandRouter::volumioPushState May 26 12:10:46 volumio volumio[30988]: info: CoreStateMachine::setRandom null May 26 12:10:46 volumio volumio[30988]: info: CoreStateMachine::pushState May 26 12:10:46 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:46 volumio volumio[30988]: info: CoreCommandRouter::volumioPushState May 26 12:10:46 volumio volumio[30988]: info: Setting Device type: Raspberry PI May 26 12:10:46 volumio volumio[30988]: info: USB Boot Capable - Checking Install to Disk functions for: bootusb May 26 12:10:46 volumio volumio[30988]: info: USB Boot Capable - System SBC Revision found in cpuinfo: c03112 May 26 12:10:46 volumio volumio[30988]: info: USB Boot Capable - Found matching device in SBC capable list: Raspberry PI May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 3 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 4 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 5 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 6 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7 May 26 12:10:46 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 93. May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199:3000 from 192.168.1.196 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 8 May 26 12:10:46 volumio volumio[30988]: info: VolumeController:: Volume=86 Mute =false May 26 12:10:46 volumio volumio[30988]: info: CoreStateMachine::pushState May 26 12:10:46 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:46 volumio volumio[30988]: info: CoreCommandRouter::volumioPushState May 26 12:10:46 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:46 volumio dnsmasq[31111]: exiting on receipt of SIGTERM May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 9 May 26 12:10:46 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:46 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:46 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:46 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 10 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 11 May 26 12:10:46 volumio hostapd[31195]: rfkill: WLAN soft blocked May 26 12:10:46 volumio sudo[31194]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service May 26 12:10:46 volumio sudo[31194]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:46 volumio hostapd[31195]: Failed to set beacon parameters May 26 12:10:46 volumio hostapd[31195]: wlan0: Could not connect to kernel driver May 26 12:10:46 volumio hostapd[31195]: Interface initialization failed May 26 12:10:46 volumio hostapd[31195]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:46 volumio hostapd[31195]: wlan0: AP-DISABLED May 26 12:10:46 volumio hostapd[31195]: wlan0: Unable to setup interface. May 26 12:10:46 volumio hostapd[31195]: wlan0: interface state DISABLED->DISABLED May 26 12:10:46 volumio hostapd[31195]: wlan0: AP-DISABLED May 26 12:10:46 volumio hostapd[31195]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:46 volumio hostapd[31195]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:46 volumio hostapd[31195]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 12 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 13 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 14 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 15 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 16 May 26 12:10:46 volumio sudo[31194]: pam_unix(sudo:session): session closed for user root May 26 12:10:46 volumio systemd[1]: systemd-timedated.service: Deactivated successfully. May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 17 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 18 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 19 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 20 May 26 12:10:46 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:46 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:46 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 21 May 26 12:10:46 volumio volumio[30988]: info: Discovery: adding 396b6b9f-04e9-4145-834d-d8d1d854f7e5 May 26 12:10:46 volumio volumio[30988]: info: Discovery: Found device Volumio May 26 12:10:46 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:46 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:46 volumio volumio[30988]: info: Discovery: this is already registered, 396b6b9f-04e9-4145-834d-d8d1d854f7e5 May 26 12:10:46 volumio volumio[30988]: info: Discovery: Found device Volumio May 26 12:10:46 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:46 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 22 May 26 12:10:46 volumio volumio[30988]: info: Upmpdcli Daemon Started May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 23 May 26 12:10:46 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 24 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 25 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 26 May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 27 May 26 12:10:46 volumio volumio[30988]: info: Completed loading Core Plugins May 26 12:10:46 volumio dnsmasq[31203]: started, version 2.90 cachesize 150 May 26 12:10:46 volumio volumio[30988]: info: Preparing to generate the ALSA configuration file May 26 12:10:46 volumio dnsmasq[31203]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:46 volumio dnsmasq-dhcp[31203]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:46 volumio dnsmasq[31203]: reading /etc/resolv.conf May 26 12:10:46 volumio dnsmasq[31203]: using nameserver 80.58.61.250#53 May 26 12:10:46 volumio dnsmasq[31203]: using nameserver 80.58.61.254#53 May 26 12:10:46 volumio dnsmasq[31203]: using nameserver 208.67.222.222#53 May 26 12:10:46 volumio dnsmasq[31203]: using nameserver 208.67.220.220#53 May 26 12:10:46 volumio dnsmasq[31203]: read /etc/hosts - 18 names May 26 12:10:46 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:46 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 28 May 26 12:10:47 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 29 May 26 12:10:47 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 30 May 26 12:10:47 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 31 May 26 12:10:47 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 32 May 26 12:10:47 volumio volumio[30988]: verbose: New Socket.io Connection to 192.168.1.199 from 192.168.1.196 UA: Mozilla/5.0 (Linux; Android 15; 2201123G Build/AQ3A.241006.001; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 33 May 26 12:10:47 volumio volumio[30988]: info: Asound.conf file unchanged, so no further update is needed May 26 12:10:47 volumio volumio[30988]: info: Output device has changed, restarting MPD May 26 12:10:47 volumio volumio[30988]: info: Output device has changed, restarting Shairport Sync May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:47 volumio sudo[31207]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 26 12:10:47 volumio sudo[31207]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:47 volumio volumio-remote-updater[628]: [2025-05-26 10:10:47] [connect] Successful connection May 26 12:10:47 volumio volumio[30988]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 26 12:10:47 volumio sudo[31207]: pam_unix(sudo:session): session closed for user root May 26 12:10:47 volumio sudo[31209]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 26 12:10:47 volumio volumio[30988]: info: ___________ START PLUGINS ___________ May 26 12:10:47 volumio sudo[31209]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:47 volumio volumio[30988]: info: ControllerMpd::onStart: Initializing MPD May 26 12:10:47 volumio volumio[30988]: info: Creating MPD Configuration file May 26 12:10:47 volumio systemd[1]: Stopping mpd.service - Music Player Daemon... May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] May 26 12:10:47 volumio volumio[30988]: info: [1748254247310] CoreMusicLibrary::Adding element Media Servers May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:47 volumio sudo[31219]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 26 12:10:47 volumio sudo[31219]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:47 volumio sudo[31217]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 26 12:10:47 volumio sudo[31217]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:47 volumio sudo[31217]: pam_unix(sudo:session): session closed for user root May 26 12:10:47 volumio systemd[1]: mpd.service: Deactivated successfully. May 26 12:10:47 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. May 26 12:10:47 volumio systemd[1]: mpd.service: Consumed 3.960s CPU time. May 26 12:10:47 volumio systemd[1]: mpd.socket: Deactivated successfully. May 26 12:10:47 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. May 26 12:10:47 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:47 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. May 26 12:10:47 volumio systemd[1]: Starting mpd.service - Music Player Daemon... May 26 12:10:47 volumio volumio[30988]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:47 volumio volumio[30988]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] May 26 12:10:47 volumio volumio[30988]: info: [1748254247619] CoreMusicLibrary::Adding element Last_100 May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] May 26 12:10:47 volumio volumio[30988]: info: [1748254247636] CoreMusicLibrary::Adding element Webradio May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 26 12:10:47 volumio volumio[30988]: info: Initializing BBC Radios May 26 12:10:47 volumio volumio[31147]: Starting albumart workers May 26 12:10:47 volumio volumio[31146]: Starting albumart workers May 26 12:10:47 volumio volumio[31148]: Starting albumart workers May 26 12:10:47 volumio sudo[31225]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 26 12:10:47 volumio sudo[31225]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 26 12:10:47 volumio sudo[31225]: pam_unix(sudo:session): session closed for user root May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] May 26 12:10:47 volumio volumio[30988]: info: [1748254247886] CoreMusicLibrary::Adding element YouTube Music May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:47 volumio volumio[30988]: Cannot find translation for source YouTube Music May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] May 26 12:10:47 volumio volumio[30988]: info: [1748254247902] CoreMusicLibrary::Adding element Mother Earth Radio May 26 12:10:47 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:47 volumio volumio[30988]: Cannot find translation for source YouTube Music May 26 12:10:47 volumio volumio[30988]: Cannot find translation for source Mother Earth Radio May 26 12:10:47 volumio volumio[30988]: info: Volumio Calling Home May 26 12:10:48 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 94. May 26 12:10:49 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:49 volumio dnsmasq[31203]: exiting on receipt of SIGTERM May 26 12:10:49 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:49 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:49 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:49 volumio volumio[30988]: info: Received Get System Info May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:49 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:49 volumio volumio[30988]: info: Discovery: Getting this device information May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio hostapd[31269]: rfkill: WLAN soft blocked May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled May 26 12:10:49 volumio hostapd[31269]: Failed to set beacon parameters May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetVisibleSources May 26 12:10:49 volumio hostapd[31269]: wlan0: Could not connect to kernel driver May 26 12:10:49 volumio hostapd[31269]: Interface initialization failed May 26 12:10:49 volumio hostapd[31269]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:49 volumio hostapd[31269]: wlan0: AP-DISABLED May 26 12:10:49 volumio hostapd[31269]: wlan0: Unable to setup interface. May 26 12:10:49 volumio hostapd[31269]: wlan0: interface state DISABLED->DISABLED May 26 12:10:49 volumio hostapd[31269]: wlan0: AP-DISABLED May 26 12:10:49 volumio hostapd[31269]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:49 volumio hostapd[31269]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:49 volumio hostapd[31269]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 26 12:10:49 volumio volumio[30988]: info: Received Get System Info May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:49 volumio volumio[30988]: info: Discovery: Getting this device information May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: Listing playlists May 26 12:10:49 volumio volumio[30988]: info: Received Get System Info May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:49 volumio volumio[30988]: info: Discovery: Getting this device information May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetVisibleSources May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 26 12:10:49 volumio volumio[30988]: info: Received Get System Info May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:49 volumio volumio[30988]: info: Discovery: Getting this device information May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: Listing playlists May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetQueue May 26 12:10:49 volumio volumio[30988]: info: CoreStateMachine::getQueue May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getQueue May 26 12:10:49 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:49 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:49 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:49 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:49 volumio dnsmasq[31274]: started, version 2.90 cachesize 150 May 26 12:10:49 volumio dnsmasq[31274]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:49 volumio volumio[30988]: info: MPD Permissions set May 26 12:10:49 volumio volumio[30988]: info: MPD Permissions set May 26 12:10:49 volumio dnsmasq-dhcp[31274]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:49 volumio dnsmasq[31274]: reading /etc/resolv.conf May 26 12:10:49 volumio dnsmasq[31274]: using nameserver 80.58.61.250#53 May 26 12:10:49 volumio dnsmasq[31274]: using nameserver 80.58.61.254#53 May 26 12:10:49 volumio dnsmasq[31274]: using nameserver 208.67.222.222#53 May 26 12:10:49 volumio dnsmasq[31274]: using nameserver 208.67.220.220#53 May 26 12:10:49 volumio dnsmasq[31274]: read /etc/hosts - 18 names May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:49 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:49 volumio volumio[30988]: info: Received Get System Info May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:49 volumio volumio[30988]: info: Discovery: Getting this device information May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetVisibleSources May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 26 12:10:49 volumio volumio[30988]: info: Received Get System Info May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 26 12:10:49 volumio volumio[30988]: info: Discovery: Getting this device information May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:49 volumio volumio[30988]: info: Listing playlists May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::volumioGetQueue May 26 12:10:49 volumio volumio[30988]: info: CoreStateMachine::getQueue May 26 12:10:49 volumio volumio[30988]: info: CorePlayQueue::getQueue May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:49 volumio volumio-remote-updater[628]: [2025-05-26 10:10:49] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1748254247 101 May 26 12:10:49 volumio volumio[30988]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Engine version: 4 Transport: websocket Total Clients: 34 May 26 12:10:49 volumio volumio[30988]: info: Volumio called home May 26 12:10:49 volumio volumio[30988]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 35 May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:10:49 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 26 12:10:50 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:50 volumio volumio[30988]: info: Starting Shairport Sync May 26 12:10:50 volumio volumio[30988]: info: Starting Shairport Sync May 26 12:10:50 volumio volumio[30988]: info: Starting Shairport Sync May 26 12:10:50 volumio sudo[31288]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 26 12:10:50 volumio sudo[31288]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:50 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:50 volumio sudo[31290]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 26 12:10:50 volumio sudo[31290]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:50 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:50 volumio sudo[31292]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync May 26 12:10:50 volumio sudo[31292]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:10:50 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... May 26 12:10:50 volumio systemd[1]: shairport-sync.service: Deactivated successfully. May 26 12:10:50 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 26 12:10:50 volumio systemd[1]: shairport-sync.service: Consumed 2.027s CPU time. May 26 12:10:50 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:50 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:50 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 26 12:10:50 volumio sudo[31288]: pam_unix(sudo:session): session closed for user root May 26 12:10:50 volumio sudo[31292]: pam_unix(sudo:session): session closed for user root May 26 12:10:50 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... May 26 12:10:50 volumio systemd[1]: shairport-sync.service: Deactivated successfully. May 26 12:10:50 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 26 12:10:50 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. May 26 12:10:50 volumio sudo[31290]: pam_unix(sudo:session): session closed for user root May 26 12:10:50 volumio volumio[30988]: info: Shairport-Sync Started May 26 12:10:50 volumio volumio[30988]: Error adding Membership: Error: addMembership EINVAL May 26 12:10:50 volumio volumio[30988]: info: Shairport-Sync Started May 26 12:10:50 volumio volumio[30988]: info: Shairport-Sync Started May 26 12:10:50 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:51 volumio volumio[30988]: info: [yt-cast-receiver] DIAL server listening on port 8098 May 26 12:10:51 volumio volumio[30988]: info: CoreCommandRouter::volumioRetrievevolume May 26 12:10:51 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:51 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:51 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:51 volumio volumio[30988]: info: VolumeController:: Volume=86 Mute =false May 26 12:10:51 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:10:51 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:51 volumio volumio[30988]: info: CoreStateMachine::pushState May 26 12:10:51 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:10:51 volumio volumio[30988]: info: CoreCommandRouter::volumioPushState May 26 12:10:51 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 95. May 26 12:10:51 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:51 volumio dnsmasq[31274]: exiting on receipt of SIGTERM May 26 12:10:51 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:51 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:51 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:51 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:51 volumio mpd[31246]: 2025-05-26T12:10:51 decoder: Decoder plugin "wildmidi" is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg May 26 12:10:51 volumio systemd[1]: Started mpd.service - Music Player Daemon. May 26 12:10:51 volumio sudo[31219]: pam_unix(sudo:session): session closed for user root May 26 12:10:51 volumio sudo[31209]: pam_unix(sudo:session): session closed for user root May 26 12:10:51 volumio hostapd[31316]: rfkill: WLAN soft blocked May 26 12:10:51 volumio hostapd[31316]: Failed to set beacon parameters May 26 12:10:51 volumio hostapd[31316]: wlan0: Could not connect to kernel driver May 26 12:10:51 volumio hostapd[31316]: Interface initialization failed May 26 12:10:51 volumio hostapd[31316]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:51 volumio hostapd[31316]: wlan0: AP-DISABLED May 26 12:10:51 volumio hostapd[31316]: wlan0: Unable to setup interface. May 26 12:10:51 volumio hostapd[31316]: wlan0: interface state DISABLED->DISABLED May 26 12:10:51 volumio hostapd[31316]: wlan0: AP-DISABLED May 26 12:10:51 volumio hostapd[31316]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:51 volumio hostapd[31316]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:51 volumio hostapd[31316]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:51 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:51 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:51 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:51 volumio volumio[30988]: error: MPD error: The expression evaluated to a falsy value: May 26 12:10:51 volumio volumio[30988]: assert.ok(self.idling) May 26 12:10:51 volumio volumio[30988]: error: The expression evaluated to a falsy value: May 26 12:10:51 volumio volumio[30988]: assert.ok(self.idling) May 26 12:10:51 volumio volumio[30988]: error: updateQueue error: null May 26 12:10:51 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:51 volumio volumio[30988]: info: MPD running with PID31246 May 26 12:10:51 volumio volumio[30988]: ,establishing connection May 26 12:10:51 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:51 volumio volumio[30988]: info: Completed starting Core Plugins May 26 12:10:51 volumio volumio[30988]: info: ------------------------------------------- May 26 12:10:51 volumio volumio[30988]: info: ----- MyVolumio plugins startup ---- May 26 12:10:51 volumio volumio[30988]: info: ------------------------------------------- May 26 12:10:51 volumio volumio[30988]: info: [MyVolumio PluginManager] Fetching plans data.... May 26 12:10:51 volumio volumio[30988]: error: updateQueue error: null May 26 12:10:51 volumio dnsmasq[31327]: started, version 2.90 cachesize 150 May 26 12:10:51 volumio dnsmasq[31327]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:51 volumio dnsmasq-dhcp[31327]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:51 volumio dnsmasq[31327]: reading /etc/resolv.conf May 26 12:10:51 volumio dnsmasq[31327]: using nameserver 80.58.61.250#53 May 26 12:10:51 volumio dnsmasq[31327]: using nameserver 80.58.61.254#53 May 26 12:10:51 volumio dnsmasq[31327]: using nameserver 208.67.222.222#53 May 26 12:10:51 volumio dnsmasq[31327]: using nameserver 208.67.220.220#53 May 26 12:10:51 volumio dnsmasq[31327]: read /etc/hosts - 18 names May 26 12:10:51 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:52 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:52 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:52 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:53 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:53 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:53 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:53 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 96. May 26 12:10:54 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:54 volumio dnsmasq[31327]: exiting on receipt of SIGTERM May 26 12:10:54 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:54 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:54 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:54 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:54 volumio hostapd[31333]: rfkill: WLAN soft blocked May 26 12:10:54 volumio hostapd[31333]: Failed to set beacon parameters May 26 12:10:54 volumio hostapd[31333]: wlan0: Could not connect to kernel driver May 26 12:10:54 volumio hostapd[31333]: Interface initialization failed May 26 12:10:54 volumio hostapd[31333]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:54 volumio hostapd[31333]: wlan0: AP-DISABLED May 26 12:10:54 volumio hostapd[31333]: wlan0: Unable to setup interface. May 26 12:10:54 volumio hostapd[31333]: wlan0: interface state DISABLED->DISABLED May 26 12:10:54 volumio hostapd[31333]: wlan0: AP-DISABLED May 26 12:10:54 volumio hostapd[31333]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:54 volumio hostapd[31333]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:54 volumio hostapd[31333]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:54 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:54 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:54 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:54 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:54 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:54 volumio dnsmasq[31338]: started, version 2.90 cachesize 150 May 26 12:10:54 volumio dnsmasq[31338]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:54 volumio dnsmasq-dhcp[31338]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:54 volumio dnsmasq[31338]: reading /etc/resolv.conf May 26 12:10:54 volumio dnsmasq[31338]: using nameserver 80.58.61.250#53 May 26 12:10:54 volumio dnsmasq[31338]: using nameserver 80.58.61.254#53 May 26 12:10:54 volumio dnsmasq[31338]: using nameserver 208.67.222.222#53 May 26 12:10:54 volumio dnsmasq[31338]: using nameserver 208.67.220.220#53 May 26 12:10:54 volumio dnsmasq[31338]: read /etc/hosts - 18 names May 26 12:10:54 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:54 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:54 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:55 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:55 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:56 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:56 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 97. May 26 12:10:56 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:56 volumio dnsmasq[31338]: exiting on receipt of SIGTERM May 26 12:10:56 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:56 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:56 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:56 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:56 volumio hostapd[31356]: rfkill: WLAN soft blocked May 26 12:10:56 volumio hostapd[31356]: Failed to set beacon parameters May 26 12:10:56 volumio hostapd[31356]: wlan0: Could not connect to kernel driver May 26 12:10:56 volumio hostapd[31356]: Interface initialization failed May 26 12:10:56 volumio hostapd[31356]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:56 volumio hostapd[31356]: wlan0: AP-DISABLED May 26 12:10:56 volumio hostapd[31356]: wlan0: Unable to setup interface. May 26 12:10:56 volumio hostapd[31356]: wlan0: interface state DISABLED->DISABLED May 26 12:10:56 volumio hostapd[31356]: wlan0: AP-DISABLED May 26 12:10:56 volumio hostapd[31356]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:56 volumio hostapd[31356]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:56 volumio hostapd[31356]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:56 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:56 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:56 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:56 volumio volumio[30988]: error: Failed LSINFO: Error: [50@0] {lsinfo} No such directory May 26 12:10:56 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:56 volumio dnsmasq[31361]: started, version 2.90 cachesize 150 May 26 12:10:56 volumio dnsmasq[31361]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:56 volumio dnsmasq-dhcp[31361]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:56 volumio dnsmasq[31361]: reading /etc/resolv.conf May 26 12:10:56 volumio dnsmasq[31361]: using nameserver 80.58.61.250#53 May 26 12:10:56 volumio dnsmasq[31361]: using nameserver 80.58.61.254#53 May 26 12:10:56 volumio dnsmasq[31361]: using nameserver 208.67.222.222#53 May 26 12:10:56 volumio dnsmasq[31361]: using nameserver 208.67.220.220#53 May 26 12:10:56 volumio dnsmasq[31361]: read /etc/hosts - 18 names May 26 12:10:56 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted May 26 12:10:56 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:58 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 98. May 26 12:10:58 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:58 volumio dnsmasq[31361]: exiting on receipt of SIGTERM May 26 12:10:58 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:10:58 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:10:58 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:58 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:10:58 volumio hostapd[31365]: rfkill: WLAN soft blocked May 26 12:10:58 volumio hostapd[31365]: Failed to set beacon parameters May 26 12:10:58 volumio hostapd[31365]: wlan0: Could not connect to kernel driver May 26 12:10:58 volumio hostapd[31365]: Interface initialization failed May 26 12:10:58 volumio hostapd[31365]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:10:58 volumio hostapd[31365]: wlan0: AP-DISABLED May 26 12:10:58 volumio hostapd[31365]: wlan0: Unable to setup interface. May 26 12:10:58 volumio hostapd[31365]: wlan0: interface state DISABLED->DISABLED May 26 12:10:58 volumio hostapd[31365]: wlan0: AP-DISABLED May 26 12:10:58 volumio hostapd[31365]: wlan0: CTRL-EVENT-TERMINATING May 26 12:10:58 volumio hostapd[31365]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:10:58 volumio hostapd[31365]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:10:58 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:10:58 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:10:58 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:10:59 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:10:59 volumio dnsmasq[31370]: started, version 2.90 cachesize 150 May 26 12:10:59 volumio dnsmasq[31370]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:10:59 volumio dnsmasq-dhcp[31370]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:10:59 volumio dnsmasq[31370]: reading /etc/resolv.conf May 26 12:10:59 volumio dnsmasq[31370]: using nameserver 80.58.61.250#53 May 26 12:10:59 volumio dnsmasq[31370]: using nameserver 80.58.61.254#53 May 26 12:10:59 volumio dnsmasq[31370]: using nameserver 208.67.222.222#53 May 26 12:10:59 volumio dnsmasq[31370]: using nameserver 208.67.220.220#53 May 26 12:10:59 volumio dnsmasq[31370]: read /etc/hosts - 18 names May 26 12:10:59 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan premium May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan superstar May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso May 26 12:11:00 volumio volumio[30988]: info: Adding plugin bluetooth to MyMusic Plugins May 26 12:11:00 volumio volumio[30988]: info: Adding plugin multiroom to MyMusic Plugins May 26 12:11:00 volumio volumio[30988]: info: Adding plugin metavolumio to MyMusic Plugins May 26 12:11:00 volumio volumio[30988]: info: Adding plugin cd_controller to MyMusic Plugins May 26 12:11:00 volumio volumio[30988]: info: Adding plugin smart_inputs to MyMusic Plugins May 26 12:11:00 volumio volumio[30988]: info: Adding plugin tidalconnect to MyMusic Plugins May 26 12:11:00 volumio volumio[30988]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... May 26 12:11:01 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 99. May 26 12:11:01 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:01 volumio dnsmasq[31370]: exiting on receipt of SIGTERM May 26 12:11:01 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:11:01 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:01 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:01 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:11:01 volumio hostapd[31374]: rfkill: WLAN soft blocked May 26 12:11:01 volumio hostapd[31374]: Failed to set beacon parameters May 26 12:11:01 volumio hostapd[31374]: wlan0: Could not connect to kernel driver May 26 12:11:01 volumio volumio[30988]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded May 26 12:11:01 volumio volumio[30988]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio May 26 12:11:01 volumio hostapd[31374]: Interface initialization failed May 26 12:11:01 volumio hostapd[31374]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:11:01 volumio hostapd[31374]: wlan0: AP-DISABLED May 26 12:11:01 volumio hostapd[31374]: wlan0: Unable to setup interface. May 26 12:11:01 volumio hostapd[31374]: wlan0: interface state DISABLED->DISABLED May 26 12:11:01 volumio hostapd[31374]: wlan0: AP-DISABLED May 26 12:11:01 volumio hostapd[31374]: wlan0: CTRL-EVENT-TERMINATING May 26 12:11:01 volumio hostapd[31374]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:11:01 volumio hostapd[31374]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:11:01 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:01 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:01 volumio volumio[30988]: info: Starting MyVolumio Remote Streaming Endpoints May 26 12:11:01 volumio volumio[30988]: info: MyVolumio login type: Token May 26 12:11:01 volumio volumio[30988]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started May 26 12:11:01 volumio volumio[30988]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... May 26 12:11:01 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:11:01 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:11:01 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:01 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:01 volumio dnsmasq[31379]: started, version 2.90 cachesize 150 May 26 12:11:01 volumio dnsmasq[31379]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:11:01 volumio dnsmasq-dhcp[31379]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:11:01 volumio dnsmasq[31379]: reading /etc/resolv.conf May 26 12:11:01 volumio dnsmasq[31379]: using nameserver 80.58.61.250#53 May 26 12:11:01 volumio dnsmasq[31379]: using nameserver 80.58.61.254#53 May 26 12:11:01 volumio dnsmasq[31379]: using nameserver 208.67.222.222#53 May 26 12:11:01 volumio dnsmasq[31379]: using nameserver 208.67.220.220#53 May 26 12:11:01 volumio dnsmasq[31379]: read /etc/hosts - 18 names May 26 12:11:01 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:02 volumio volumio[30988]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded May 26 12:11:02 volumio volumio[30988]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services May 26 12:11:02 volumio volumio[30988]: info: Streaming services startup May 26 12:11:02 volumio volumio[30988]: info: Starting Streaming Daemon May 26 12:11:02 volumio sudo[31383]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service May 26 12:11:02 volumio sudo[31383]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:11:02 volumio volumio[30988]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started May 26 12:11:02 volumio sudo[31383]: pam_unix(sudo:session): session closed for user root May 26 12:11:02 volumio volumio[30988]: error: Cannot start Volumio Streaming Daemon May 26 12:11:02 volumio volumio[30988]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service May 26 12:11:02 volumio volumio[30988]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. May 26 12:11:03 volumio volumio[30988]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN May 26 12:11:03 volumio volumio[30988]: info: MyVolumio token set successfully May 26 12:11:03 volumio volumio[30988]: info: MYVOLUMIO: Adding device May 26 12:11:03 volumio volumio[30988]: info: MYVOLUMIO: Evaluating Server May 26 12:11:03 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 100. May 26 12:11:03 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:03 volumio dnsmasq[31379]: exiting on receipt of SIGTERM May 26 12:11:03 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:11:03 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:03 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:03 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:11:03 volumio hostapd[31402]: rfkill: WLAN soft blocked May 26 12:11:03 volumio hostapd[31402]: Failed to set beacon parameters May 26 12:11:03 volumio hostapd[31402]: wlan0: Could not connect to kernel driver May 26 12:11:03 volumio hostapd[31402]: Interface initialization failed May 26 12:11:03 volumio hostapd[31402]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:11:03 volumio hostapd[31402]: wlan0: AP-DISABLED May 26 12:11:03 volumio hostapd[31402]: wlan0: Unable to setup interface. May 26 12:11:03 volumio hostapd[31402]: wlan0: interface state DISABLED->DISABLED May 26 12:11:03 volumio hostapd[31402]: wlan0: AP-DISABLED May 26 12:11:03 volumio hostapd[31402]: wlan0: CTRL-EVENT-TERMINATING May 26 12:11:03 volumio hostapd[31402]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:11:03 volumio hostapd[31402]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:11:03 volumio volumio[30988]: info: MyVolumio status changed May 26 12:11:03 volumio volumio[30988]: info: Streaming services startup May 26 12:11:03 volumio volumio[30988]: info: Starting Streaming Daemon May 26 12:11:03 volumio volumio[30988]: info: Removing browser output: myVolumio user plan is not superstar May 26 12:11:03 volumio volumio[30988]: info: Removing audio output: May 26 12:11:03 volumio volumio[30988]: info: Stoppping Tunnel 1 May 26 12:11:03 volumio sudo[31409]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service May 26 12:11:03 volumio sudo[31409]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:11:03 volumio sudo[31411]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop sshtunnel.service May 26 12:11:03 volumio sudo[31411]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) May 26 12:11:03 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:11:03 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:11:03 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:04 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:11:04 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:11:04 volumio sudo[31409]: pam_unix(sudo:session): session closed for user root May 26 12:11:04 volumio volumio[30988]: error: Cannot start Volumio Streaming Daemon May 26 12:11:04 volumio volumio[30988]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service May 26 12:11:04 volumio volumio[30988]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. May 26 12:11:04 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:04 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:11:04 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:11:04 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:11:04 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. May 26 12:11:04 volumio sudo[31411]: pam_unix(sudo:session): session closed for user root May 26 12:11:04 volumio volumio[30988]: info: Remote SSH Stopped May 26 12:11:04 volumio volumio[30988]: info: Setting Geolocation for MyVolumio to eu6 May 26 12:11:04 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:04 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:04 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:04 volumio dnsmasq[31418]: started, version 2.90 cachesize 150 May 26 12:11:04 volumio dnsmasq[31418]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:11:04 volumio dnsmasq-dhcp[31418]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:11:04 volumio dnsmasq[31418]: reading /etc/resolv.conf May 26 12:11:04 volumio dnsmasq[31418]: using nameserver 80.58.61.250#53 May 26 12:11:04 volumio dnsmasq[31418]: using nameserver 80.58.61.254#53 May 26 12:11:04 volumio dnsmasq[31418]: using nameserver 208.67.222.222#53 May 26 12:11:04 volumio dnsmasq[31418]: using nameserver 208.67.220.220#53 May 26 12:11:04 volumio dnsmasq[31418]: read /etc/hosts - 18 names May 26 12:11:04 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:05 volumio volumio[30988]: info: Updating MyVolumio device info May 26 12:11:05 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:05 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:05 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:05 volumio volumio[30988]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} May 26 12:11:05 volumio volumio[30988]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} May 26 12:11:06 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 101. May 26 12:11:06 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:06 volumio dnsmasq[31418]: exiting on receipt of SIGTERM May 26 12:11:06 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:11:06 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:06 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:06 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:11:06 volumio hostapd[31436]: rfkill: WLAN soft blocked May 26 12:11:06 volumio hostapd[31436]: Failed to set beacon parameters May 26 12:11:06 volumio hostapd[31436]: wlan0: Could not connect to kernel driver May 26 12:11:06 volumio hostapd[31436]: Interface initialization failed May 26 12:11:06 volumio hostapd[31436]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:11:06 volumio hostapd[31436]: wlan0: AP-DISABLED May 26 12:11:06 volumio hostapd[31436]: wlan0: Unable to setup interface. May 26 12:11:06 volumio hostapd[31436]: wlan0: interface state DISABLED->DISABLED May 26 12:11:06 volumio hostapd[31436]: wlan0: AP-DISABLED May 26 12:11:06 volumio hostapd[31436]: wlan0: CTRL-EVENT-TERMINATING May 26 12:11:06 volumio hostapd[31436]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:11:06 volumio hostapd[31436]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:11:06 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:11:06 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:11:06 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:06 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:06 volumio dnsmasq[31441]: started, version 2.90 cachesize 150 May 26 12:11:06 volumio dnsmasq[31441]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:11:06 volumio dnsmasq-dhcp[31441]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:11:06 volumio dnsmasq[31441]: reading /etc/resolv.conf May 26 12:11:06 volumio dnsmasq[31441]: using nameserver 80.58.61.250#53 May 26 12:11:06 volumio dnsmasq[31441]: using nameserver 80.58.61.254#53 May 26 12:11:06 volumio dnsmasq[31441]: using nameserver 208.67.222.222#53 May 26 12:11:06 volumio dnsmasq[31441]: using nameserver 208.67.220.220#53 May 26 12:11:06 volumio dnsmasq[31441]: read /etc/hosts - 18 names May 26 12:11:06 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:08 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 102. May 26 12:11:08 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:08 volumio dnsmasq[31441]: exiting on receipt of SIGTERM May 26 12:11:08 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:11:08 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:08 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:08 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:11:08 volumio hostapd[31445]: rfkill: WLAN soft blocked May 26 12:11:08 volumio hostapd[31445]: Failed to set beacon parameters May 26 12:11:08 volumio hostapd[31445]: wlan0: Could not connect to kernel driver May 26 12:11:08 volumio hostapd[31445]: Interface initialization failed May 26 12:11:08 volumio hostapd[31445]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:11:08 volumio hostapd[31445]: wlan0: AP-DISABLED May 26 12:11:08 volumio hostapd[31445]: wlan0: Unable to setup interface. May 26 12:11:08 volumio hostapd[31445]: wlan0: interface state DISABLED->DISABLED May 26 12:11:08 volumio hostapd[31445]: wlan0: AP-DISABLED May 26 12:11:08 volumio hostapd[31445]: wlan0: CTRL-EVENT-TERMINATING May 26 12:11:08 volumio hostapd[31445]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:11:08 volumio hostapd[31445]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:11:08 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:11:08 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:11:08 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:08 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:08 volumio dnsmasq[31450]: started, version 2.90 cachesize 150 May 26 12:11:08 volumio dnsmasq[31450]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:11:08 volumio dnsmasq-dhcp[31450]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:11:08 volumio dnsmasq[31450]: reading /etc/resolv.conf May 26 12:11:08 volumio dnsmasq[31450]: using nameserver 80.58.61.250#53 May 26 12:11:08 volumio dnsmasq[31450]: using nameserver 80.58.61.254#53 May 26 12:11:08 volumio dnsmasq[31450]: using nameserver 208.67.222.222#53 May 26 12:11:08 volumio dnsmasq[31450]: using nameserver 208.67.220.220#53 May 26 12:11:08 volumio dnsmasq[31450]: read /etc/hosts - 18 names May 26 12:11:08 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:09 volumio volumio[30988]: info: MYVOLUMIO: Adding device May 26 12:11:09 volumio volumio[30988]: info: MYVOLUMIO: Evaluating Server May 26 12:11:09 volumio volumio[30988]: info: Setting Geolocation for MyVolumio to eu4 May 26 12:11:09 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:09 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:09 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:10 volumio volumio[30988]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} May 26 12:11:10 volumio volumio[30988]: info: Updating MyVolumio device info May 26 12:11:10 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:10 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:10 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:10 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 103. May 26 12:11:10 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:11 volumio dnsmasq[31450]: exiting on receipt of SIGTERM May 26 12:11:11 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:11:11 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:11 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:11 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:11:11 volumio hostapd[31469]: rfkill: WLAN soft blocked May 26 12:11:11 volumio hostapd[31469]: Failed to set beacon parameters May 26 12:11:11 volumio hostapd[31469]: wlan0: Could not connect to kernel driver May 26 12:11:11 volumio hostapd[31469]: Interface initialization failed May 26 12:11:11 volumio hostapd[31469]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:11:11 volumio hostapd[31469]: wlan0: AP-DISABLED May 26 12:11:11 volumio hostapd[31469]: wlan0: Unable to setup interface. May 26 12:11:11 volumio hostapd[31469]: wlan0: interface state DISABLED->DISABLED May 26 12:11:11 volumio hostapd[31469]: wlan0: AP-DISABLED May 26 12:11:11 volumio hostapd[31469]: wlan0: CTRL-EVENT-TERMINATING May 26 12:11:11 volumio hostapd[31469]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:11:11 volumio hostapd[31469]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:11:11 volumio volumio[30988]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} May 26 12:11:11 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:11:11 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:11:11 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:11 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:11 volumio dnsmasq[31474]: started, version 2.90 cachesize 150 May 26 12:11:11 volumio dnsmasq[31474]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:11:11 volumio dnsmasq-dhcp[31474]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:11:11 volumio dnsmasq[31474]: reading /etc/resolv.conf May 26 12:11:11 volumio dnsmasq[31474]: using nameserver 80.58.61.250#53 May 26 12:11:11 volumio dnsmasq[31474]: using nameserver 80.58.61.254#53 May 26 12:11:11 volumio dnsmasq[31474]: using nameserver 208.67.222.222#53 May 26 12:11:11 volumio dnsmasq[31474]: using nameserver 208.67.220.220#53 May 26 12:11:11 volumio dnsmasq[31474]: read /etc/hosts - 18 names May 26 12:11:11 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:13 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 104. May 26 12:11:13 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:13 volumio dnsmasq[31474]: exiting on receipt of SIGTERM May 26 12:11:13 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:11:13 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:13 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:13 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:11:13 volumio hostapd[31478]: rfkill: WLAN soft blocked May 26 12:11:13 volumio hostapd[31478]: Failed to set beacon parameters May 26 12:11:13 volumio hostapd[31478]: wlan0: Could not connect to kernel driver May 26 12:11:13 volumio hostapd[31478]: Interface initialization failed May 26 12:11:13 volumio hostapd[31478]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:11:13 volumio hostapd[31478]: wlan0: AP-DISABLED May 26 12:11:13 volumio hostapd[31478]: wlan0: Unable to setup interface. May 26 12:11:13 volumio hostapd[31478]: wlan0: interface state DISABLED->DISABLED May 26 12:11:13 volumio hostapd[31478]: wlan0: AP-DISABLED May 26 12:11:13 volumio hostapd[31478]: wlan0: CTRL-EVENT-TERMINATING May 26 12:11:13 volumio hostapd[31478]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:11:13 volumio hostapd[31478]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:11:13 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:11:13 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:11:13 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:13 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:13 volumio dnsmasq[31483]: started, version 2.90 cachesize 150 May 26 12:11:13 volumio dnsmasq[31483]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:11:13 volumio dnsmasq-dhcp[31483]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:11:13 volumio dnsmasq[31483]: reading /etc/resolv.conf May 26 12:11:13 volumio dnsmasq[31483]: using nameserver 80.58.61.250#53 May 26 12:11:13 volumio dnsmasq[31483]: using nameserver 80.58.61.254#53 May 26 12:11:13 volumio dnsmasq[31483]: using nameserver 208.67.222.222#53 May 26 12:11:13 volumio dnsmasq[31483]: using nameserver 208.67.220.220#53 May 26 12:11:13 volumio dnsmasq[31483]: read /etc/hosts - 18 names May 26 12:11:13 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:15 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 105. May 26 12:11:15 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:16 volumio dnsmasq[31483]: exiting on receipt of SIGTERM May 26 12:11:16 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:11:16 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:16 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:16 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:11:16 volumio hostapd[31501]: rfkill: WLAN soft blocked May 26 12:11:16 volumio hostapd[31501]: Failed to set beacon parameters May 26 12:11:16 volumio hostapd[31501]: wlan0: Could not connect to kernel driver May 26 12:11:16 volumio hostapd[31501]: Interface initialization failed May 26 12:11:16 volumio hostapd[31501]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:11:16 volumio hostapd[31501]: wlan0: AP-DISABLED May 26 12:11:16 volumio hostapd[31501]: wlan0: Unable to setup interface. May 26 12:11:16 volumio hostapd[31501]: wlan0: interface state DISABLED->DISABLED May 26 12:11:16 volumio hostapd[31501]: wlan0: AP-DISABLED May 26 12:11:16 volumio hostapd[31501]: wlan0: CTRL-EVENT-TERMINATING May 26 12:11:16 volumio hostapd[31501]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:11:16 volumio hostapd[31501]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:11:16 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:11:16 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:11:16 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:16 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:16 volumio systemd[1]: Starting setdatetime-helper.timer.service - Volumio Time Sync Watchdog Service... May 26 12:11:16 volumio dbus-daemon[612]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service' requested by ':1.218' (uid=0 pid=31505 comm="timedatectl show --property=NTPSynchronized --valu") May 26 12:11:16 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings May 26 12:11:16 volumio dnsmasq[31509]: started, version 2.90 cachesize 150 May 26 12:11:16 volumio dnsmasq[31509]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:11:16 volumio dnsmasq-dhcp[31509]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:11:16 volumio dnsmasq[31509]: reading /etc/resolv.conf May 26 12:11:16 volumio dnsmasq[31509]: using nameserver 80.58.61.250#53 May 26 12:11:16 volumio dnsmasq[31509]: using nameserver 80.58.61.254#53 May 26 12:11:16 volumio dnsmasq[31509]: using nameserver 208.67.222.222#53 May 26 12:11:16 volumio dnsmasq[31509]: using nameserver 208.67.220.220#53 May 26 12:11:16 volumio dnsmasq[31509]: read /etc/hosts - 18 names May 26 12:11:16 volumio volumio[30988]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 35 May 26 12:11:16 volumio volumio[30988]: info: CoreCommandRouter::volumioGetState May 26 12:11:16 volumio volumio[30988]: info: CorePlayQueue::getTrack 0 May 26 12:11:16 volumio systemd[1]: Starting systemd-timedated.service - Time & Date Service... May 26 12:11:16 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:16 volumio dbus-daemon[612]: [system] Successfully activated service 'org.freedesktop.timedate1' May 26 12:11:16 volumio systemd[1]: Started systemd-timedated.service - Time & Date Service. May 26 12:11:16 volumio setdatetime-helper.sh[31504]: Time is not synchronized. Attempting to sync... May 26 12:11:16 volumio sudo[31518]: root : PWD=/ ; USER=root ; COMMAND=/usr/bin/date -s 'Mon, 26 May 2025 10:11:16 GMT#015' May 26 12:11:16 volumio sudo[31518]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) May 26 12:11:16 volumio setdatetime-helper.sh[31519]: Mon May 26 12:11:16 CEST 2025 May 26 12:11:16 volumio systemd-journald[368]: Time jumped backwards, rotating. May 26 12:11:16 volumio systemd[1]: setdatetime-helper.timer.service: Deactivated successfully. May 26 12:11:16 volumio sudo[31518]: pam_unix(sudo:session): session closed for user root May 26 12:11:16 volumio setdatetime-helper.sh[31504]: Time synchronized successfully. May 26 12:11:16 volumio systemd[1]: Finished setdatetime-helper.timer.service - Volumio Time Sync Watchdog Service. May 26 12:11:16 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 26 12:11:16 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 26 12:11:16 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled May 26 12:11:17 volumio volumio-remote-updater[628]: No test mode May 26 12:11:17 volumio volumio-remote-updater[628]: No alpha test mode May 26 12:11:17 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled May 26 12:11:17 volumio volumio[30988]: Searching plugin music_service/webradio May 26 12:11:17 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: webradio , search May 26 12:11:17 volumio volumio[30988]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} May 26 12:11:17 volumio volumio[30988]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache May 26 12:11:17 volumio systemd[1]: hostapd.service: Scheduled restart job, restart counter is at 106. May 26 12:11:17 volumio volumio[30988]: Use XMLElement.setAttribute instead May 26 12:11:17 volumio volumio[30988]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 26 12:11:17 volumio volumio[30988]: TypeError: children[i].attr(...).value is not a function May 26 12:11:17 volumio volumio[30988]: at /volumio/app/plugins/music_service/webradio/index.js:956:46 May 26 12:11:17 volumio volumio[30988]: at process.processTicksAndRejections (node:internal/process/task_queues:95:5) May 26 12:11:17 volumio volumio[30988]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 26 12:11:17 volumio systemd[1]: Stopping dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:17 volumio dnsmasq[31509]: exiting on receipt of SIGTERM May 26 12:11:17 volumio systemd[1]: dnsmasq.service: Deactivated successfully. May 26 12:11:17 volumio systemd[1]: Stopped dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:17 volumio systemd[1]: Stopped hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:17 volumio systemd[1]: Starting hostapd.service - Access point and authentication server for Wi-Fi and Ethernet... May 26 12:11:17 volumio hostapd[31532]: rfkill: WLAN soft blocked May 26 12:11:17 volumio hostapd[31532]: Failed to set beacon parameters May 26 12:11:17 volumio hostapd[31532]: wlan0: Could not connect to kernel driver May 26 12:11:17 volumio hostapd[31532]: Interface initialization failed May 26 12:11:17 volumio hostapd[31532]: wlan0: interface state UNINITIALIZED->DISABLED May 26 12:11:17 volumio hostapd[31532]: wlan0: AP-DISABLED May 26 12:11:17 volumio hostapd[31532]: wlan0: Unable to setup interface. May 26 12:11:17 volumio hostapd[31532]: wlan0: interface state DISABLED->DISABLED May 26 12:11:17 volumio hostapd[31532]: wlan0: AP-DISABLED May 26 12:11:17 volumio hostapd[31532]: wlan0: CTRL-EVENT-TERMINATING May 26 12:11:17 volumio hostapd[31532]: hostapd_free_hapd_data: Interface wlan0 wasn't started May 26 12:11:17 volumio hostapd[31532]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 May 26 12:11:17 volumio systemd[1]: hostapd.service: Control process exited, code=exited, status=1/FAILURE May 26 12:11:17 volumio systemd[1]: hostapd.service: Failed with result 'exit-code'. May 26 12:11:17 volumio systemd[1]: Failed to start hostapd.service - Access point and authentication server for Wi-Fi and Ethernet. May 26 12:11:17 volumio systemd[1]: Starting dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server... May 26 12:11:17 volumio dnsmasq[31543]: started, version 2.90 cachesize 150 May 26 12:11:17 volumio dnsmasq[31543]: compile time options: IPv6 GNU-getopt DBus no-UBus i18n IDN2 DHCP DHCPv6 no-Lua TFTP conntrack ipset nftset auth cryptohash DNSSEC loop-detect inotify dumpfile May 26 12:11:17 volumio dnsmasq-dhcp[31543]: DHCP, IP range 192.168.211.100 -- 192.168.211.200, lease time 1d May 26 12:11:17 volumio dnsmasq[31543]: reading /etc/resolv.conf May 26 12:11:17 volumio dnsmasq[31543]: using nameserver 80.58.61.250#53 May 26 12:11:17 volumio dnsmasq[31543]: using nameserver 80.58.61.254#53 May 26 12:11:17 volumio dnsmasq[31543]: using nameserver 208.67.222.222#53 May 26 12:11:17 volumio dnsmasq[31543]: using nameserver 208.67.220.220#53 May 26 12:11:17 volumio dnsmasq[31543]: read /etc/hosts - 18 names May 26 12:11:17 volumio systemd[1]: Started dnsmasq.service - dnsmasq - A lightweight DHCP and caching DNS server. May 26 12:11:18 volumio sudo[31548]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2025-05-26 12:10' May 26 12:11:18 volumio sudo[31548]: 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="fd567ba9bc0dc34c0403e2d5b72a0f46467d1983" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="35e4a13c94df42ebab19fd6178d6be47190c244d" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri May 23 08:02:06 UTC 2025" VOLUMIO_VERSION="0.069" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="76fa67e30b28261e1dc7c3a89e610b9e"