Dec 26 17:34:01 volumio-dac sudo[5738]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Dec 26 17:34:01 volumio-dac sudo[5738]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Dec 26 17:34:01 volumio-dac sudo[5738]: pam_unix(sudo:session): session closed for user root
Dec 26 17:34:01 volumio-dac sudo[5740]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Dec 26 17:34:01 volumio-dac sudo[5740]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Dec 26 17:34:01 volumio-dac sudo[5740]: pam_unix(sudo:session): session closed for user root
Dec 26 17:34:01 volumio-dac volumio[1340]: verbose: New Socket.io Connection to 192.168.1.111 from 192.168.1.134 UA: Mozilla/5.0 (Linux; Android 7.0; BAH-L09 Build/HUAWEIBAH-L09; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/119.0.6045.193 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 10
Dec 26 17:34:01 volumio-dac sudo[5744]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Dec 26 17:34:01 volumio-dac sudo[5744]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Dec 26 17:34:01 volumio-dac sudo[5744]: pam_unix(sudo:session): session closed for user root
Dec 26 17:34:01 volumio-dac sudo[5746]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Dec 26 17:34:01 volumio-dac sudo[5746]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Dec 26 17:34:01 volumio-dac sudo[5746]: pam_unix(sudo:session): session closed for user root
Dec 26 17:34:01 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:01 volumio-dac volumio[1340]: verbose: New Socket.io Connection to 192.168.1.111 from 192.168.1.134 UA: Mozilla/5.0 (Linux; Android 7.0; BAH-L09 Build/HUAWEIBAH-L09; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/119.0.6045.193 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 10
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Received Get System Info
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Discovery: Getting this device information
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetVisibleSources
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Received Get System Info
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Discovery: Getting this device information
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Listing playlists
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetQueue
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreStateMachine::getQueue
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CorePlayQueue::getQueue
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Received Get System Info
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Discovery: Getting this device information
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetVisibleSources
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Received Get System Info
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Discovery: Getting this device information
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:02 volumio-dac volumio[1340]: info: Listing playlists
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetQueue
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CoreStateMachine::getQueue
Dec 26 17:34:02 volumio-dac volumio[1340]: info: CorePlayQueue::getQueue
Dec 26 17:34:04 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Dec 26 17:34:04 volumio-dac volumio[1340]: info: Received Get System Info
Dec 26 17:34:04 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Dec 26 17:34:04 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Dec 26 17:34:04 volumio-dac volumio[1340]: info: Discovery: Getting this device information
Dec 26 17:34:04 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:04 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Dec 26 17:34:11 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Dec 26 17:34:11 volumio-dac volumio[1340]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Dec 26 17:34:23 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-DISCONNECTED bssid=34:0a:33:28:c2:14 reason=0 locally_generated=1
Dec 26 17:34:23 volumio-dac dhcpcd[942]: wlan0: carrier lost
Dec 26 17:34:23 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=CORE type=WORLD
Dec 26 17:34:23 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=USER type=COUNTRY alpha2=PL
Dec 26 17:34:23 volumio-dac avahi-daemon[1357]: Withdrawing address record for 192.168.1.111 on wlan0.
Dec 26 17:34:23 volumio-dac avahi-daemon[1357]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.1.111.
Dec 26 17:34:23 volumio-dac dhcpcd[942]: wlan0: deleting route to 192.168.1.0/24
Dec 26 17:34:23 volumio-dac dhcpcd[942]: wlan0: deleting default route via 192.168.1.1
Dec 26 17:34:23 volumio-dac avahi-daemon[1357]: Interface wlan0.IPv4 no longer relevant for mDNS.
Dec 26 17:34:23 volumio-dac volumio[1340]: info: Discovery: A device disappeared from network
Dec 26 17:34:23 volumio-dac systemd[1]: Stopped target ip-changed@wlan0.target - IP Address changed on wlan0.
Dec 26 17:34:23 volumio-dac systemd[1]: Stopping ip-changed@wlan0.target - IP Address changed on wlan0...
Dec 26 17:34:23 volumio-dac systemd[1]: welcome.service: Deactivated successfully.
Dec 26 17:34:23 volumio-dac systemd[1]: Stopped welcome.service - Show a welcome message on console.
Dec 26 17:34:23 volumio-dac systemd[1]: Stopping welcome.service - Show a welcome message on console...
Dec 26 17:34:23 volumio-dac systemd[1]: Starting welcome.service - Show a welcome message on console...
Dec 26 17:34:23 volumio-dac welcome[5808]: Resolved ip:[0]
Dec 26 17:34:23 volumio-dac volumio[1340]: info: Volumio Network Manager: Network status updated: 0
Dec 26 17:34:23 volumio-dac systemd[1]: Finished welcome.service - Show a welcome message on console.
Dec 26 17:34:23 volumio-dac systemd[1]: Reached target ip-changed@wlan0.target - IP Address changed on wlan0.
Dec 26 17:34:24 volumio-dac ntpd[1026]: IO: Deleting interface #3 wlan0, 192.168.1.111#123, interface stats: received=341, sent=430, dropped=0, active_time=1575 secs
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 46.171.0.154 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 193.59.134.156 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 162.159.200.123 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 156.17.245.123 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 51.68.141.5 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 213.222.217.10 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 89.250.197.242 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 162.159.200.1 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 94.154.96.7 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 212.127.95.218 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 85.115.212.254 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 149.156.70.60 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 91.210.128.220 unlink local addr 192.168.1.111 ->
Dec 26 17:34:24 volumio-dac ntpd[1026]: PROTO: 193.25.222.136 unlink local addr 192.168.1.111 ->
Dec 26 17:34:25 volumio-dac wpa_supplicant[1229]: wlan0: Trying to associate with 84:16:f9:59:67:1d (SSID='Blaszak 2.4 GHz' freq=2462 MHz)
Dec 26 17:34:26 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-ASSOC-REJECT bssid=00:00:00:00:00:00 status_code=16
Dec 26 17:34:26 volumio-dac wpa_supplicant[1229]: BSSID 84:16:f9:59:67:1d ignore list count incremented to 2, ignoring for 10 seconds
Dec 26 17:34:26 volumio-dac wpa_supplicant[1229]: wlan0: Trying to associate with 34:0a:33:28:c2:13 (SSID='Blaszak 2.4 GHz' freq=2462 MHz)
Dec 26 17:34:26 volumio-dac wpa_supplicant[1229]: FT: Invalid key management type (2)
Dec 26 17:34:27 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-ASSOC-REJECT bssid=00:00:00:00:00:00 status_code=16
Dec 26 17:34:30 volumio-dac wpa_supplicant[1229]: wlan0: Trying to associate with 34:0a:33:28:c2:13 (SSID='Blaszak 2.4 GHz' freq=2462 MHz)
Dec 26 17:34:30 volumio-dac wpa_supplicant[1229]: FT: Invalid key management type (2)
Dec 26 17:34:31 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-ASSOC-REJECT bssid=00:00:00:00:00:00 status_code=16
Dec 26 17:34:31 volumio-dac wpa_supplicant[1229]: BSSID 34:0a:33:28:c2:13 ignore list count incremented to 2, ignoring for 10 seconds
Dec 26 17:34:31 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-SSID-TEMP-DISABLED id=0 ssid="Blaszak 2.4 GHz" auth_failures=1 duration=10 reason=CONN_FAILED
Dec 26 17:34:38 volumio-dac wpa_supplicant[1229]: wlan0: Trying to associate with 84:16:f9:59:67:1c (SSID='Blaszak 5 GHz' freq=5180 MHz)
Dec 26 17:34:38 volumio-dac wpa_supplicant[1229]: wlan0: Associated with 84:16:f9:59:67:1c
Dec 26 17:34:38 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-SUBNET-STATUS-UPDATE status=0
Dec 26 17:34:39 volumio-dac wpa_supplicant[1229]: wlan0: WPA: Key negotiation completed with 84:16:f9:59:67:1c [PTK=CCMP GTK=CCMP]
Dec 26 17:34:39 volumio-dac wpa_supplicant[1229]: wlan0: CTRL-EVENT-CONNECTED - Connection to 84:16:f9:59:67:1c completed [id=2 id_str=]
Dec 26 17:34:39 volumio-dac dhcpcd[942]: wlan0: carrier acquired
Dec 26 17:34:39 volumio-dac dhcpcd[942]: wlan0: connected to Access Point: Blaszak 5 GHz
Dec 26 17:34:39 volumio-dac dhcpcd[942]: wlan0: IAID 9e:82:4f:56
Dec 26 17:34:39 volumio-dac dhcpcd[942]: wlan0: soliciting an IPv6 router
Dec 26 17:34:40 volumio-dac dhcpcd[942]: wlan0: soliciting a DHCP lease
Dec 26 17:34:40 volumio-dac dhcpcd[942]: wlan0: offered 192.168.1.132 from 192.168.1.1
Dec 26 17:34:40 volumio-dac dhcpcd[942]: wlan0: probing address 192.168.1.132/24
Dec 26 17:34:46 volumio-dac dhcpcd[942]: wlan0: leased 192.168.1.132 for 7200 seconds
Dec 26 17:34:46 volumio-dac avahi-daemon[1357]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.1.132.
Dec 26 17:34:46 volumio-dac avahi-daemon[1357]: New relevant interface wlan0.IPv4 for mDNS.
Dec 26 17:34:46 volumio-dac avahi-daemon[1357]: Registering new address record for 192.168.1.132 on wlan0.IPv4.
Dec 26 17:34:46 volumio-dac dhcpcd[942]: wlan0: adding route to 192.168.1.0/24
Dec 26 17:34:46 volumio-dac dhcpcd[942]: wlan0: adding default route via 192.168.1.1
Dec 26 17:34:46 volumio-dac systemd[1]: Stopped target ip-changed@wlan0.target - IP Address changed on wlan0.
Dec 26 17:34:46 volumio-dac systemd[1]: Stopping ip-changed@wlan0.target - IP Address changed on wlan0...
Dec 26 17:34:46 volumio-dac systemd[1]: welcome.service: Deactivated successfully.
Dec 26 17:34:46 volumio-dac systemd[1]: Stopped welcome.service - Show a welcome message on console.
Dec 26 17:34:46 volumio-dac systemd[1]: Stopping welcome.service - Show a welcome message on console...
Dec 26 17:34:46 volumio-dac systemd[1]: Starting welcome.service - Show a welcome message on console...
Dec 26 17:34:46 volumio-dac welcome[5877]: Resolved ip:[1] 192.168.1.132
Dec 26 17:34:46 volumio-dac systemd[1]: Finished welcome.service - Show a welcome message on console.
Dec 26 17:34:46 volumio-dac systemd[1]: Reached target ip-changed@wlan0.target - IP Address changed on wlan0.
Dec 26 17:34:47 volumio-dac volumio[1340]: info: Discovery: adding 0a0c4dfe-3f35-45d1-a332-e9533b677414
Dec 26 17:34:47 volumio-dac volumio[1340]: info: Discovery: Found device Volumio DAC
Dec 26 17:34:47 volumio-dac volumio[1340]: info: CoreCommandRouter::volumioGetState
Dec 26 17:34:47 volumio-dac ntpd[1026]: IO: Listen normally on 4 wlan0 192.168.1.132:123
Dec 26 17:34:47 volumio-dac ntpd[1026]: IO: new interface(s) found: waking up resolver
Dec 26 17:34:53 volumio-dac volumio[1340]: info: Volumio Network Manager: Network status updated: 2
Dec 26 17:35:50 volumio-dac volumio[1340]: info: READ
Dec 26 17:35:50 volumio-dac volumio[1340]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Dec 26 17:35:50 volumio-dac volumio[1340]: Error
Dec 26 17:35:50 volumio-dac volumio[1340]: at /volumio/app/plugins/music_service/webradio/index.js:286:31
Dec 26 17:35:50 volumio-dac volumio[1340]: at Request.handleRequestResponse [as _callback] (/volumio/node_modules/unirest/index.js:444:15)
Dec 26 17:35:50 volumio-dac volumio[1340]: at self.callback (/volumio/node_modules/request/request.js:185:22)
Dec 26 17:35:50 volumio-dac volumio[1340]: at Request.emit (node:events:514:28)
Dec 26 17:35:50 volumio-dac volumio[1340]: at Request.onRequestError (/volumio/node_modules/request/request.js:877:8)
Dec 26 17:35:50 volumio-dac volumio[1340]: at ClientRequest.emit (node:events:514:28)
Dec 26 17:35:50 volumio-dac volumio[1340]: at Socket.socketErrorListener (node:_http_client:495:9)
Dec 26 17:35:50 volumio-dac volumio[1340]: at Socket.emit (node:events:514:28)
Dec 26 17:35:50 volumio-dac volumio[1340]: at emitErrorNT (node:internal/streams/destroy:151:8)
Dec 26 17:35:50 volumio-dac volumio[1340]: at emitErrorCloseNT (node:internal/streams/destroy:116:3)
Dec 26 17:35:50 volumio-dac volumio[1340]: at process.processTicksAndRejections (node:internal/process/task_queues:82:21)
Dec 26 17:35:50 volumio-dac volumio[1340]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Dec 26 17:35:51 volumio-dac sudo[5997]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2025-12-26 17:34'
Dec 26 17:35:51 volumio-dac sudo[5997]: 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="cfdc872d40b979cca36352a7333c940c38dc64b5"
VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd"
VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2"
VOLUMIO_BE_VERSION="6cbc2303e10f00c3a01cb7f02c6d12448bd32c62"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Fri Dec 5 20:42:14 UTC 2025"
VOLUMIO_VERSION="4.073"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="67fdc5f60f00b7a328ccd8c4ad441086"