Dec 08 20:11:00 volumio sudo[1109]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Dec 08 20:11:00 volumio sudo[1109]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:00 volumio sudo[1109]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:00 volumio ntpd[690]: DNS: dns_probe: 0.debian.pool.ntp.org, cast_flags:8, flags:101 Dec 08 20:11:00 volumio ntpd[690]: DNS: dns_check: processing 0.debian.pool.ntp.org, 8, 101 Dec 08 20:11:00 volumio ntpd[690]: DNS: Pool taking: 160.187.147.197 Dec 08 20:11:00 volumio ntpd[690]: DNS: Pool skipping: 103.221.223.143 Dec 08 20:11:00 volumio ntpd[690]: DNS: Pool skipping: 45.252.250.189 Dec 08 20:11:00 volumio ntpd[690]: DNS: Pool taking: 103.121.88.11 Dec 08 20:11:00 volumio ntpd[690]: DNS: dns_take_status: 0.debian.pool.ntp.org=>good, 8 Dec 08 20:11:01 volumio sudo[1114]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Dec 08 20:11:01 volumio sudo[1114]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:01 volumio sudo[1114]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:01 volumio dhcpcd[615]: wlan0: leased 192.168.31.140 for 43200 seconds Dec 08 20:11:01 volumio avahi-daemon[491]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.31.140. Dec 08 20:11:01 volumio avahi-daemon[491]: New relevant interface wlan0.IPv4 for mDNS. Dec 08 20:11:01 volumio avahi-daemon[491]: Registering new address record for 192.168.31.140 on wlan0.IPv4. Dec 08 20:11:01 volumio dhcpcd[615]: wlan0: adding route to 192.168.31.0/24 Dec 08 20:11:01 volumio dhcpcd[615]: wlan0: adding default route via 192.168.31.1 Dec 08 20:11:01 volumio systemd[1]: welcome.service: Deactivated successfully. Dec 08 20:11:01 volumio systemd[1]: Stopped welcome.service - Show a welcome message on console. Dec 08 20:11:01 volumio systemd[1]: Stopping welcome.service - Show a welcome message on console... Dec 08 20:11:01 volumio systemd[1]: Starting welcome.service - Show a welcome message on console... Dec 08 20:11:01 volumio welcome[1129]: Resolved ip:[2] 192.168.31.68 192.168.31.140 Dec 08 20:11:01 volumio systemd[1]: Finished welcome.service - Show a welcome message on console. Dec 08 20:11:01 volumio systemd[1]: Reached target ip-changed@wlan0.target - IP Address changed on wlan0. Dec 08 20:11:02 volumio sudo[1142]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r Dec 08 20:11:02 volumio sudo[1142]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:02 volumio sudo[1142]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:02 volumio sudo[1145]: root : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:11:02 volumio sudo[1145]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Dec 08 20:11:02 volumio sudo[1145]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:02 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Dec 08 20:11:02 volumio systemd[1]: shairport-sync.service: Deactivated successfully. Dec 08 20:11:02 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Dec 08 20:11:02 volumio systemd[1]: shairport-sync.service: Consumed 1.816s CPU time. Dec 08 20:11:02 volumio systemd[1]: Stopping avahi-daemon.service - Avahi mDNS/DNS-SD Stack... Dec 08 20:11:02 volumio avahi-daemon[491]: Got SIGTERM, quitting. Dec 08 20:11:02 volumio avahi-daemon[491]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.31.140. Dec 08 20:11:02 volumio avahi-daemon[491]: Leaving mDNS multicast group on interface eth0.IPv4 with address 192.168.31.68. Dec 08 20:11:02 volumio avahi-daemon[491]: Leaving mDNS multicast group on interface lo.IPv4 with address 127.0.0.1. Dec 08 20:11:02 volumio dbus-daemon[493]: [system] Activating via systemd: service name='org.freedesktop.Avahi' unit='dbus-org.freedesktop.Avahi.service' requested by ':1.10' (uid=0 pid=971 comm="/usr/sbin/smbd --foreground --no-process-group") Dec 08 20:11:02 volumio avahi-daemon[491]: avahi-daemon 0.8 exiting. Dec 08 20:11:02 volumio systemd[1]: avahi-daemon.service: Deactivated successfully. Dec 08 20:11:02 volumio systemd[1]: Stopped avahi-daemon.service - Avahi mDNS/DNS-SD Stack. Dec 08 20:11:02 volumio systemd[1]: Starting avahi-daemon.service - Avahi mDNS/DNS-SD Stack... Dec 08 20:11:02 volumio avahi-daemon[1150]: Process 491 died: No such process; trying to remove PID file. (/run/avahi-daemon//pid) Dec 08 20:11:02 volumio avahi-daemon[1150]: Found user 'avahi' (UID 103) and group 'avahi' (GID 109). Dec 08 20:11:02 volumio avahi-daemon[1150]: Successfully dropped root privileges. Dec 08 20:11:02 volumio avahi-daemon[1150]: avahi-daemon 0.8 starting up. Dec 08 20:11:02 volumio dbus-daemon[493]: [system] Successfully activated service 'org.freedesktop.Avahi' Dec 08 20:11:02 volumio systemd[1]: Started avahi-daemon.service - Avahi mDNS/DNS-SD Stack. Dec 08 20:11:02 volumio avahi-daemon[1150]: Successfully called chroot(). Dec 08 20:11:02 volumio avahi-daemon[1150]: Successfully dropped remaining capabilities. Dec 08 20:11:02 volumio avahi-daemon[1150]: No service file found in /etc/avahi/services. Dec 08 20:11:02 volumio avahi-daemon[1150]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.31.140. Dec 08 20:11:02 volumio avahi-daemon[1150]: New relevant interface wlan0.IPv4 for mDNS. Dec 08 20:11:02 volumio avahi-daemon[1150]: Joining mDNS multicast group on interface eth0.IPv4 with address 192.168.31.68. Dec 08 20:11:02 volumio avahi-daemon[1150]: New relevant interface eth0.IPv4 for mDNS. Dec 08 20:11:02 volumio avahi-daemon[1150]: Joining mDNS multicast group on interface lo.IPv4 with address 127.0.0.1. Dec 08 20:11:02 volumio avahi-daemon[1150]: New relevant interface lo.IPv4 for mDNS. Dec 08 20:11:02 volumio avahi-daemon[1150]: Network interface enumeration completed. Dec 08 20:11:02 volumio avahi-daemon[1150]: Registering new address record for 192.168.31.140 on wlan0.IPv4. Dec 08 20:11:02 volumio avahi-daemon[1150]: Registering new address record for 192.168.31.68 on eth0.IPv4. Dec 08 20:11:02 volumio avahi-daemon[1150]: Registering new address record for 127.0.0.1 on lo.IPv4. Dec 08 20:11:02 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Dec 08 20:11:03 volumio iwconfig[1156]: Error for wireless request "Set Power Management" (8B2C) : Dec 08 20:11:03 volumio iwconfig[1156]: SET failed on device wlan0 ; Operation not supported. Dec 08 20:11:03 volumio systemd[1]: Started wireless.service - Wireless Services. Dec 08 20:11:03 volumio systemd[1]: Started volumio.service - Volumio Backend Module. Dec 08 20:11:03 volumio systemd[1]: Starting plymouth-quit.service - Terminate Plymouth Boot Screen... Dec 08 20:11:03 volumio systemd[1]: Started volumio_cpu_tweak.service - Volumio Cpu Tweaker. Dec 08 20:11:03 volumio systemd[1]: Received SIGRTMIN+21 from PID 181 (plymouthd). Dec 08 20:11:03 volumio systemd[1]: Received SIGRTMIN+21 from PID 181 (plymouthd). Dec 08 20:11:03 volumio systemd[1]: Finished plymouth-quit-wait.service - Hold until boot process finishes up. Dec 08 20:11:03 volumio systemd[1]: Finished plymouth-quit.service - Terminate Plymouth Boot Screen. Dec 08 20:11:03 volumio systemd[1]: Started getty@tty1.service - Getty on tty1. Dec 08 20:11:03 volumio systemd[1]: Started serial-getty@ttyAMA0.service - Serial Getty on ttyAMA0. Dec 08 20:11:03 volumio systemd[1]: Reached target getty.target - Login Prompts. Dec 08 20:11:03 volumio systemd[1]: Reached target multi-user.target - Multi-User System. Dec 08 20:11:03 volumio systemd[1]: Reached target graphical.target - Graphical Interface. Dec 08 20:11:03 volumio systemd[1]: Starting systemd-update-utmp-runlevel.service - Record Runlevel Change in UTMP... Dec 08 20:11:03 volumio volumio-cpu-tweak[1172]: Setting RT Priority for mpd Dec 08 20:11:03 volumio volumio-cpu-tweak[1190]: pid 35's current scheduling policy: SCHED_OTHER Dec 08 20:11:03 volumio volumio-cpu-tweak[1190]: pid 35's current scheduling priority: 0 Dec 08 20:11:03 volumio volumio-cpu-tweak[1172]: Setting MPD Affinity Dec 08 20:11:03 volumio volumio-cpu-tweak[1191]: pid 3's current affinity mask: f Dec 08 20:11:03 volumio systemd[1]: systemd-update-utmp-runlevel.service: Deactivated successfully. Dec 08 20:11:03 volumio systemd[1]: Finished systemd-update-utmp-runlevel.service - Record Runlevel Change in UTMP. Dec 08 20:11:03 volumio volumio-cpu-tweak[1172]: /bin/volumio_cpu_tweak: line 27: warning: command substitution: ignored null byte in input Dec 08 20:11:03 volumio volumio-cpu-tweak[1172]: VOLUMIO CPU TWEAK: Setting CPU Governor: performance Dec 08 20:11:03 volumio systemd[1]: Startup finished in 16.063s (kernel) + 25.204s (userspace) = 41.267s. Dec 08 20:11:03 volumio ntpd[690]: IO: Listen normally on 4 wlan0 192.168.31.140:123 Dec 08 20:11:03 volumio ntpd[690]: IO: new interface(s) found: waking up resolver Dec 08 20:11:03 volumio ntpd[690]: DNS: dns_probe: 3.debian.pool.ntp.org, cast_flags:8, flags:101 Dec 08 20:11:03 volumio ntpd[690]: DNS: dns_check: processing 3.debian.pool.ntp.org, 8, 101 Dec 08 20:11:03 volumio ntpd[690]: DNS: Pool skipping: 103.221.223.185 Dec 08 20:11:03 volumio ntpd[690]: DNS: Pool skipping: 103.184.124.254 Dec 08 20:11:03 volumio ntpd[690]: DNS: Pool skipping: 103.70.115.65 Dec 08 20:11:03 volumio ntpd[690]: DNS: Pool skipping: 103.121.88.12 Dec 08 20:11:03 volumio ntpd[690]: DNS: dns_take_status: 3.debian.pool.ntp.org=>good, 8 Dec 08 20:11:03 volumio systemd[1]: volumio_cpu_tweak.service: Deactivated successfully. Dec 08 20:11:03 volumio avahi-daemon[1150]: Server startup complete. Host name is volumio.local. Local service cookie is 730853760. Dec 08 20:11:04 volumio ntpd[690]: DNS: dns_probe: 2.debian.pool.ntp.org, cast_flags:8, flags:101 Dec 08 20:11:04 volumio ntpd[690]: DNS: dns_check: processing 2.debian.pool.ntp.org, 8, 101 Dec 08 20:11:04 volumio ntpd[690]: DNS: Pool skipping: 103.221.223.185 Dec 08 20:11:04 volumio ntpd[690]: DNS: Pool skipping: 160.25.232.6 Dec 08 20:11:04 volumio ntpd[690]: DNS: Pool skipping: 103.129.126.242 Dec 08 20:11:04 volumio ntpd[690]: DNS: Pool skipping: 103.129.126.10 Dec 08 20:11:04 volumio ntpd[690]: DNS: Pool skipping: 2404:fbc0:0:21ef::a Dec 08 20:11:04 volumio ntpd[690]: DNS: Pool skipping: 2400:6ea0:0:509c::a Dec 08 20:11:04 volumio ntpd[690]: DNS: Pool skipping: 2401:5b60:0:2::21 Dec 08 20:11:04 volumio ntpd[690]: DNS: Pool skipping: 2400:e920:0:5::14 Dec 08 20:11:04 volumio ntpd[690]: DNS: dns_take_status: 2.debian.pool.ntp.org=>good, 8 Dec 08 20:11:28 volumio ntpd[690]: CLOCK: time stepped by 24.590875 Dec 08 20:11:28 volumio ntpd[690]: INIT: MRU 13107 entries, 13 hash bits, 32768 bytes Dec 08 20:11:29 volumio ntpd[690]: DNS: dns_probe: 1.debian.pool.ntp.org, cast_flags:8, flags:101 Dec 08 20:11:29 volumio ntpd[690]: DNS: dns_check: processing 1.debian.pool.ntp.org, 8, 101 Dec 08 20:11:29 volumio ntpd[690]: DNS: Pool skipping: 103.121.88.12 Dec 08 20:11:29 volumio ntpd[690]: DNS: Pool skipping: 103.70.115.65 Dec 08 20:11:29 volumio ntpd[690]: DNS: Pool skipping: 45.252.250.189 Dec 08 20:11:29 volumio ntpd[690]: DNS: Pool skipping: 103.221.223.143 Dec 08 20:11:29 volumio ntpd[690]: DNS: dns_take_status: 1.debian.pool.ntp.org=>good, 8 Dec 08 20:11:30 volumio ntpd[690]: DNS: dns_probe: 0.debian.pool.ntp.org, cast_flags:8, flags:101 Dec 08 20:11:30 volumio ntpd[690]: DNS: dns_check: processing 0.debian.pool.ntp.org, 8, 101 Dec 08 20:11:30 volumio ntpd[690]: DNS: Pool skipping: 103.121.88.11 Dec 08 20:11:30 volumio ntpd[690]: DNS: Pool skipping: 45.252.250.189 Dec 08 20:11:30 volumio ntpd[690]: DNS: Pool skipping: 103.221.223.143 Dec 08 20:11:30 volumio ntpd[690]: DNS: Pool skipping: 160.187.147.197 Dec 08 20:11:30 volumio ntpd[690]: DNS: dns_take_status: 0.debian.pool.ntp.org=>good, 8 Dec 08 20:11:32 volumio volumio[1157]: info: ------------------------------------------- Dec 08 20:11:32 volumio volumio[1157]: info: ----- Volumio3 ---- Dec 08 20:11:32 volumio volumio[1157]: info: ------------------------------------------- Dec 08 20:11:32 volumio volumio[1157]: info: ----- System startup ---- Dec 08 20:11:32 volumio volumio[1157]: info: ------------------------------------------- Dec 08 20:11:32 volumio volumio-remote-updater[512]: [2025-12-08 20:11:32] [connect] Successful connection Dec 08 20:11:33 volumio volumio[1157]: info: MYVOLUMIO Environment detected Dec 08 20:11:33 volumio volumio[1157]: info: Plugin folders cleanup Dec 08 20:11:33 volumio volumio[1157]: info: Scanning into folder /volumio/app/plugins/ Dec 08 20:11:33 volumio volumio[1157]: info: Scanning category audio_interface Dec 08 20:11:33 volumio volumio[1157]: info: Scanning category miscellanea Dec 08 20:11:34 volumio volumio[1157]: info: Scanning category music_service Dec 08 20:11:34 volumio volumio[1157]: info: Scanning category plugins.json Dec 08 20:11:34 volumio volumio[1157]: info: Scanning category system_controller Dec 08 20:11:34 volumio volumio[1157]: info: Scanning category user_interface Dec 08 20:11:34 volumio volumio[1157]: info: Scanning into folder /data/plugins/ Dec 08 20:11:34 volumio volumio[1157]: info: Scanning category system_hardware Dec 08 20:11:34 volumio volumio[1157]: info: Plugin folders cleanup completed Dec 08 20:11:34 volumio volumio[1157]: info: ------------------------------------------- Dec 08 20:11:34 volumio volumio[1157]: info: ----- Core plugins startup ---- Dec 08 20:11:34 volumio volumio[1157]: info: ------------------------------------------- Dec 08 20:11:34 volumio volumio[1157]: info: Loading plugins from folder /volumio/app/plugins/ Dec 08 20:11:34 volumio volumio[1157]: info: Adding plugin upnp to MyMusic Plugins Dec 08 20:11:34 volumio volumio[1157]: info: Adding plugin airplay_emulation to MyMusic Plugins Dec 08 20:11:34 volumio volumio[1157]: info: Adding plugin upnp_browser to MyMusic Plugins Dec 08 20:11:34 volumio volumio[1157]: info: Loading plugins from folder /data/plugins/ Dec 08 20:11:34 volumio volumio[1157]: info: Loading plugin "system"... Dec 08 20:11:34 volumio volumio[1157]: info: Loading plugin "appearance"... Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "network"... Dec 08 20:11:36 volumio volumio[1157]: info: Refreshing Cached IP Addresses Dec 08 20:11:36 volumio sudo[1213]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 08 20:11:36 volumio sudo[1213]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:36 volumio sudo[1213]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "services"... Dec 08 20:11:36 volumio sudo[1216]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:11:36 volumio sudo[1216]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "alsa_controller"... Dec 08 20:11:36 volumio sudo[1216]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:36 volumio sudo[1221]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Dec 08 20:11:36 volumio sudo[1221]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:36 volumio systemd[1]: systemd-fsckd.service: Deactivated successfully. Dec 08 20:11:36 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "wizard"... Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "networkfs"... Dec 08 20:11:36 volumio volumio[1157]: info: Starting Udev Watcher for removable devices Dec 08 20:11:36 volumio volumio[1157]: info: Ignoring mount for partition: boot Dec 08 20:11:36 volumio volumio[1157]: info: Ignoring mount for partition: volumio Dec 08 20:11:36 volumio volumio[1157]: info: Ignoring mount for partition: volumio_data Dec 08 20:11:36 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "volumio_command_line_client"... Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "upnp"... Dec 08 20:11:36 volumio volumio[1157]: info: [1765199496947] Starting Upmpd Daemon Dec 08 20:11:36 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "my_music"... Dec 08 20:11:36 volumio volumio[1157]: info: Loading plugin "mpd"... Dec 08 20:11:37 volumio volumio[1157]: info: Loading plugin "upnp_browser"... Dec 08 20:11:39 volumio volumio[1157]: info: Loading plugin "alarm-clock"... Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "airplay_emulation"... Dec 08 20:11:40 volumio volumio[1157]: info: Starting Shairport Sync Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "last_100"... Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "webradio"... Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "i2s_dacs"... Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "volumiodiscovery"... Dec 08 20:11:40 volumio volumio[1157]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Dec 08 20:11:40 volumio volumio[1157]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 08 20:11:40 volumio volumio[1157]: *** WARNING *** For more information see Dec 08 20:11:40 volumio volumio[1157]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Dec 08 20:11:40 volumio volumio[1157]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 08 20:11:40 volumio volumio[1157]: *** WARNING *** For more information see Dec 08 20:11:40 volumio node[1157]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Dec 08 20:11:40 volumio node[1157]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 08 20:11:40 volumio node[1157]: *** WARNING *** For more information see Dec 08 20:11:40 volumio node[1157]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Dec 08 20:11:40 volumio node[1157]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 08 20:11:40 volumio node[1157]: *** WARNING *** For more information see Dec 08 20:11:40 volumio volumio[1157]: info: Applying required configuration parameters for plugin volumiodiscovery Dec 08 20:11:40 volumio volumio[1157]: info: Discovery: Started advertising with name: Volumio Dec 08 20:11:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "outputs"... Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "albumart"... Dec 08 20:11:40 volumio volumio[1157]: info: Plugin example_plugin is not enabled Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "inputs"... Dec 08 20:11:40 volumio volumio[1157]: info: Loading plugin "updater_comm"... Dec 08 20:11:41 volumio volumio[1157]: info: Plugin mpdemulation is not enabled Dec 08 20:11:41 volumio volumio[1157]: info: Loading plugin "rest_api"... Dec 08 20:11:41 volumio volumio[1157]: info: Loading plugin "websocket"... Dec 08 20:11:41 volumio volumio[1157]: info: Starting Socket.io Server version 1.7.4 Dec 08 20:11:41 volumio volumio[1157]: info: Loading plugin "mpd_oled"... Dec 08 20:11:41 volumio sudo[1221]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:41 volumio volumio[1157]: info: Applying required configuration parameters for plugin mpd_oled Dec 08 20:11:41 volumio volumio[1157]: info: [MPD_OLED Plugin] Reading configuration file at: /data/configuration/system_hardware/mpd_oled/config.json Dec 08 20:11:41 volumio volumio[1157]: info: Loading i18n strings for locale en Dec 08 20:11:41 volumio volumio[1250]: Forking 3 albumart workers Dec 08 20:11:42 volumio volumio[1157]: Updating browse sources language Dec 08 20:11:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::initPlayerControls Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 08 20:11:43 volumio volumio[1157]: Express server listening on port 3000 Dec 08 20:11:43 volumio volumio[1157]: [Metrics] WebUI: 12s 312.29ms Dec 08 20:11:43 volumio volumio[1157]: info: CoreStateMachine::resetVolumioState Dec 08 20:11:43 volumio volumio[1157]: info: CoreStateMachine::getcurrentVolume Dec 08 20:11:43 volumio volumio[1157]: info: CoreCommandRouter::volumioRetrievevolume Dec 08 20:11:43 volumio volumio[1157]: info: Volumio Network Manager: Network status updated: 3 Dec 08 20:11:44 volumio dhcpcd[615]: eth0: carrier lost Dec 08 20:11:44 volumio dhcpcd[530]: eth0: carrier lost Dec 08 20:11:44 volumio kernel: smsc95xx 1-1.1:1.0 eth0: Link is Down Dec 08 20:11:44 volumio avahi-daemon[1150]: Withdrawing address record for 192.168.31.68 on eth0. Dec 08 20:11:44 volumio avahi-daemon[1150]: Leaving mDNS multicast group on interface eth0.IPv4 with address 192.168.31.68. Dec 08 20:11:44 volumio avahi-daemon[1150]: Interface eth0.IPv4 no longer relevant for mDNS. Dec 08 20:11:44 volumio dhcpcd[530]: eth0: deleting route to 192.168.31.0/24 Dec 08 20:11:44 volumio dhcpcd[530]: eth0: deleting default route via 192.168.31.1 Dec 08 20:11:45 volumio dhcpcd[615]: eth0: deleting route to 192.168.31.0/24 Dec 08 20:11:45 volumio dhcpcd[615]: eth0: deleting default route via 192.168.31.1 Dec 08 20:11:45 volumio systemd[1]: Stopped target ip-changed@eth0.target - IP Address changed on eth0. Dec 08 20:11:45 volumio systemd[1]: Stopping ip-changed@eth0.target - IP Address changed on eth0... Dec 08 20:11:45 volumio systemd[1]: welcome.service: Deactivated successfully. Dec 08 20:11:45 volumio systemd[1]: Stopped welcome.service - Show a welcome message on console. Dec 08 20:11:45 volumio systemd[1]: Stopping welcome.service - Show a welcome message on console... Dec 08 20:11:45 volumio systemd[1]: Starting welcome.service - Show a welcome message on console... Dec 08 20:11:45 volumio welcome[1352]: Resolved ip:[1] 192.168.31.140 Dec 08 20:11:45 volumio systemd[1]: Finished welcome.service - Show a welcome message on console. Dec 08 20:11:45 volumio systemd[1]: Reached target ip-changed@eth0.target - IP Address changed on eth0. Dec 08 20:11:45 volumio ifplugd(eth0)[717]: Link beat lost. Dec 08 20:11:45 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:45 volumio volumio[1157]: info: Reloading queue from file Dec 08 20:11:45 volumio volumio[1157]: info: VolumeController:: Volume=39 Mute =false Dec 08 20:11:45 volumio volumio[1157]: info: CoreStateMachine::pushState Dec 08 20:11:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:11:45 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 08 20:11:45 volumio volumio[1157]: info: CoreCommandRouter::volumioPushState Dec 08 20:11:45 volumio volumio[1157]: info: CoreStateMachine::updateTrackBlock Dec 08 20:11:45 volumio volumio[1157]: info: CorePlayQueue::getTrackBlock Dec 08 20:11:45 volumio volumio[1157]: info: CoreCommandRouter::volumioRetrievevolume Dec 08 20:11:45 volumio volumio[1157]: info: CoreStateMachine::setRepeat null single undefined Dec 08 20:11:45 volumio volumio[1157]: info: CoreStateMachine::pushState Dec 08 20:11:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:11:45 volumio volumio[1157]: info: CoreCommandRouter::volumioPushState Dec 08 20:11:45 volumio volumio[1157]: info: CoreStateMachine::setRandom null Dec 08 20:11:45 volumio volumio[1157]: info: CoreStateMachine::pushState Dec 08 20:11:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:11:45 volumio volumio[1157]: info: CoreCommandRouter::volumioPushState Dec 08 20:11:45 volumio volumio[1157]: info: Setting Device type: Raspberry PI Dec 08 20:11:45 volumio volumio[1157]: info: USB Boot Capable - Checking Install to Disk functions for: bootusb Dec 08 20:11:45 volumio volumio[1157]: info: USB Boot Capable - System SBC Revision found in cpuinfo: a22042 Dec 08 20:11:45 volumio volumio[1157]: info: USB Boot Capable - Found matching device in SBC capable list: Raspberry PI Dec 08 20:11:45 volumio volumio[1157]: info: Discovery: A device disappeared from network Dec 08 20:11:45 volumio volumio[1157]: info: Discovery: Browse raised the following error TypeError: Cannot read properties of undefined (reading 'toLowerCase') Dec 08 20:11:45 volumio volumio[1157]: info: VolumeController:: Volume=39 Mute =false Dec 08 20:11:45 volumio volumio[1157]: info: CoreStateMachine::pushState Dec 08 20:11:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:11:45 volumio volumio[1157]: info: CoreCommandRouter::volumioPushState Dec 08 20:11:45 volumio volumio[1157]: info: Discovery: adding 23e69d45-149d-48ff-8752-6784492cfc05 Dec 08 20:11:45 volumio volumio[1157]: info: Discovery: Found device Volumio Dec 08 20:11:45 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:11:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:11:45 volumio volumio[1157]: info: Completed loading Core Plugins Dec 08 20:11:45 volumio volumio[1157]: info: Preparing to generate the ALSA configuration file Dec 08 20:11:46 volumio volumio[1157]: info: The plugin mpd_oled has an ALSA contribution file volumioalsa.postalsa.5.conf Dec 08 20:11:46 volumio volumio[1157]: info: Reading ALSA contributions from plugins. Dec 08 20:11:46 volumio volumio[1157]: info: Discovery: this is already registered, 23e69d45-149d-48ff-8752-6784492cfc05 Dec 08 20:11:46 volumio volumio[1157]: info: Discovery: Found device Volumio Dec 08 20:11:46 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:11:46 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:11:46 volumio volumio[1157]: info: Asound.conf file unchanged, so no further update is needed Dec 08 20:11:46 volumio volumio[1157]: info: Output device has changed, restarting MPD Dec 08 20:11:46 volumio volumio[1157]: info: Output device has changed, restarting Shairport Sync Dec 08 20:11:46 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:46 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:46 volumio volumio[1157]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Dec 08 20:11:46 volumio sudo[1376]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Dec 08 20:11:46 volumio volumio[1157]: info: ___________ START PLUGINS ___________ Dec 08 20:11:46 volumio sudo[1376]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:46 volumio volumio[1157]: info: ControllerMpd::onStart: Initializing MPD Dec 08 20:11:46 volumio volumio[1157]: info: Creating MPD Configuration file Dec 08 20:11:46 volumio sudo[1377]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Dec 08 20:11:46 volumio sudo[1377]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:46 volumio sudo[1376]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:46 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 08 20:11:46 volumio volumio[1157]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Dec 08 20:11:46 volumio volumio[1157]: info: [1765199506581] CoreMusicLibrary::Adding element Media Servers Dec 08 20:11:46 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 08 20:11:46 volumio sudo[1385]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Dec 08 20:11:46 volumio sudo[1385]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:46 volumio sudo[1385]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:46 volumio sudo[1387]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Dec 08 20:11:46 volumio sudo[1387]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:46 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Dec 08 20:11:46 volumio systemd[1]: Starting mpd.service - Music Player Daemon... Dec 08 20:11:46 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:46 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:46 volumio ntpd[690]: IO: Deleting interface #3 eth0, 192.168.31.68#123, interface stats: received=42, sent=44, dropped=1, active_time=25 secs Dec 08 20:11:46 volumio ntpd[690]: PROTO: 103.121.88.11 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 160.187.147.197 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 45.252.250.189 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 103.221.223.143 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 160.25.232.6 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 103.129.126.242 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 103.129.126.10 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 103.221.223.185 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 103.121.88.12 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 103.70.115.65 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio ntpd[690]: PROTO: 103.184.124.254 unlink local addr 192.168.31.68 -> Dec 08 20:11:46 volumio systemd[1]: systemd-timedated.service: Deactivated successfully. Dec 08 20:11:46 volumio systemd[1]: mpd.service: Deactivated successfully. Dec 08 20:11:46 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. Dec 08 20:11:47 volumio systemd[1]: mpd.socket: Deactivated successfully. Dec 08 20:11:47 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Dec 08 20:11:47 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Dec 08 20:11:47 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Dec 08 20:11:47 volumio systemd[1]: Starting mpd.service - Music Player Daemon... Dec 08 20:11:47 volumio volumio[1157]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:47 volumio volumio[1157]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Dec 08 20:11:47 volumio volumio[1157]: info: [1765199507297] CoreMusicLibrary::Adding element Last_100 Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Dec 08 20:11:47 volumio volumio[1157]: info: [1765199507313] CoreMusicLibrary::Adding element Webradio Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 08 20:11:47 volumio volumio[1157]: info: Initializing BBC Radios Dec 08 20:11:47 volumio sudo[1412]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Dec 08 20:11:47 volumio sudo[1412]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Dec 08 20:11:47 volumio sudo[1420]: /bin/chown: cannot access '/var/log/mpd.log': No such file or directory Dec 08 20:11:47 volumio sudo[1412]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , updateALSAConfigFile Dec 08 20:11:47 volumio volumio-remote-updater[512]: [2025-12-08 20:11:47] [connect] Successful connection Dec 08 20:11:47 volumio volumio[1157]: info: Volumio Calling Home Dec 08 20:11:47 volumio sudo[1439]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start mpd_oled_plugin.service Dec 08 20:11:47 volumio sudo[1437]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod +x /tmp/mpd_oled_plugin.sh Dec 08 20:11:47 volumio sudo[1439]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:47 volumio sudo[1437]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:48 volumio sudo[1437]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:48 volumio volumio[1157]: info: Preparing to generate the ALSA configuration file Dec 08 20:11:49 volumio volumio[1261]: Starting albumart workers Dec 08 20:11:50 volumio volumio[1262]: Starting albumart workers Dec 08 20:11:50 volumio volumio[1260]: Starting albumart workers Dec 08 20:11:52 volumio volumio[1157]: info: Volumio Network Manager: Network status updated: 2 Dec 08 20:11:52 volumio sudo[1446]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 08 20:11:52 volumio volumio[1157]: info: The plugin mpd_oled has an ALSA contribution file volumioalsa.postalsa.5.conf Dec 08 20:11:52 volumio volumio[1157]: info: Reading ALSA contributions from plugins. Dec 08 20:11:52 volumio sudo[1446]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:53 volumio sudo[1448]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:11:53 volumio sudo[1446]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:53 volumio volumio[1157]: info: [MPD_OLED Plugin] Set execute permissions on /tmp/mpd_oled_plugin.sh Dec 08 20:11:53 volumio sudo[1448]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:53 volumio volumio[1157]: info: MPD Permissions set Dec 08 20:11:53 volumio volumio[1157]: info: MPD Permissions set Dec 08 20:11:53 volumio sudo[1448]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:53 volumio volumio[1157]: info: [MPD_OLED Plugin] tmp script created /tmp/mpd_oled_plugin.sh Dec 08 20:11:53 volumio volumio[1157]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 1 Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:53 volumio volumio[1157]: info: Discovery: Browse raised the following error Error: dns service error: unknown Dec 08 20:11:54 volumio volumio[1157]: info: Volumio called home Dec 08 20:11:55 volumio volumio[1157]: info: Starting Shairport Sync Dec 08 20:11:55 volumio ifplugd(eth0)[717]: Executing '/etc/ifplugd/ifplugd.action eth0 down'. Dec 08 20:11:55 volumio volumio[1157]: info: Starting Shairport Sync Dec 08 20:11:55 volumio sudo[1486]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Dec 08 20:11:55 volumio sudo[1486]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:55 volumio volumio[1157]: info: Starting Shairport Sync Dec 08 20:11:55 volumio sudo[1489]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Dec 08 20:11:55 volumio sudo[1489]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:55 volumio volumio[1157]: info: Asound.conf file unchanged, so no further update is needed Dec 08 20:11:55 volumio volumio[1157]: info: Output device has changed, restarting MPD Dec 08 20:11:55 volumio sudo[1498]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Dec 08 20:11:55 volumio dhcpcd[1506]: sending signal ALRM to pid 528 Dec 08 20:11:55 volumio dhcpcd[1506]: waiting for pid 528 to exit Dec 08 20:11:55 volumio ifplugd(eth0)[717]: client: sending signal ALRM to pid 528 Dec 08 20:11:55 volumio ifplugd(eth0)[717]: client: waiting for pid 528 to exit Dec 08 20:11:55 volumio dhcpcd[530]: received SIGALRM, releasing Dec 08 20:11:55 volumio dhcpcd[530]: eth0: removing interface Dec 08 20:11:55 volumio sudo[1498]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:55 volumio volumio[1157]: info: Output device has changed, restarting Shairport Sync Dec 08 20:11:55 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:55 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:55 volumio sudo[1508]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Dec 08 20:11:55 volumio sudo[1508]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:55 volumio kernel: smsc95xx 1-1.1:1.0 eth0: hardware isn't capable of remote wakeup Dec 08 20:11:55 volumio systemd[1]: Started upmpdcli.service - UPnP Renderer front-end to MPD. Dec 08 20:11:55 volumio sudo[1508]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:55 volumio sudo[1486]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:55 volumio sudo[1503]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Dec 08 20:11:55 volumio sudo[1503]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:55 volumio ifplugd(eth0)[717]: Program executed successfully. Dec 08 20:11:55 volumio sudo[1510]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Dec 08 20:11:55 volumio sudo[1510]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:55 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Dec 08 20:11:55 volumio volumio[1157]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Dec 08 20:11:55 volumio systemd[1]: shairport-sync.service: Deactivated successfully. Dec 08 20:11:55 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Dec 08 20:11:55 volumio systemd[1]: shairport-sync.service: Consumed 1.879s CPU time. Dec 08 20:11:55 volumio kernel: smsc95xx 1-1.1:1.0 eth0: hardware isn't capable of remote wakeup Dec 08 20:11:55 volumio kernel: smsc95xx 1-1.1:1.0 eth0: Link is Down Dec 08 20:11:55 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Dec 08 20:11:55 volumio sudo[1489]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:55 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Dec 08 20:11:55 volumio sudo[1498]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:55 volumio systemd[1]: shairport-sync.service: Deactivated successfully. Dec 08 20:11:56 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Dec 08 20:11:56 volumio volumio[1157]: info: MPD Permissions set Dec 08 20:11:56 volumio volumio[1157]: info: Shairport-Sync Started Dec 08 20:11:56 volumio volumio[1157]: Error adding Membership: Error: addMembership EINVAL Dec 08 20:11:56 volumio volumio[1157]: info: Shairport-Sync Started Dec 08 20:11:56 volumio volumio[1157]: info: Upmpdcli Daemon Started Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:11:56 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio sudo[1503]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio systemd[1]: mpd.service: Deactivated successfully. Dec 08 20:11:56 volumio systemd[1]: Stopped mpd.service - Music Player Daemon. Dec 08 20:11:56 volumio systemd[1]: mpd.service: Consumed 6.533s CPU time. Dec 08 20:11:56 volumio systemd[1]: mpd.socket: Deactivated successfully. Dec 08 20:11:56 volumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Dec 08 20:11:56 volumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Dec 08 20:11:56 volumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Dec 08 20:11:56 volumio systemd[1]: Starting mpd.service - Music Player Daemon... Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:11:56 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:11:56 volumio volumio[1157]: error: Upnp client error: Error: read ECONNRESET Dec 08 20:11:56 volumio sudo[1561]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Dec 08 20:11:56 volumio sudo[1561]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Dec 08 20:11:56 volumio sudo[1579]: /bin/chown: cannot access '/var/log/mpd.log': No such file or directory Dec 08 20:11:56 volumio sudo[1561]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:56 volumio volumio[1157]: info: Shairport-Sync Started Dec 08 20:11:56 volumio volumio[1157]: info: Starting Shairport Sync Dec 08 20:11:56 volumio sudo[1582]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Dec 08 20:11:56 volumio sudo[1582]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:11:57 volumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Dec 08 20:11:57 volumio systemd[1]: shairport-sync.service: Deactivated successfully. Dec 08 20:11:57 volumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Dec 08 20:11:57 volumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Dec 08 20:11:57 volumio sudo[1582]: pam_unix(sudo:session): session closed for user root Dec 08 20:11:57 volumio volumio[1157]: info: Shairport-Sync Started Dec 08 20:12:01 volumio nmbd[843]: [2025/12/08 20:12:01.561555, 0] ../../source3/libsmb/nmblib.c:923(send_udp) Dec 08 20:12:01 volumio nmbd[843]: Packet send failed to 192.168.31.255(138) ERRNO=Network is unreachable Dec 08 20:12:01 volumio mpd[1580]: 2025-12-08T20:12:01 decoder: Decoder plugin "wildmidi" is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Dec 08 20:12:01 volumio systemd[1]: Started mpd.service - Music Player Daemon. Dec 08 20:12:01 volumio sudo[1377]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:01 volumio sudo[1510]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:01 volumio sudo[1387]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:01 volumio volumio[1157]: info: Completed starting Core Plugins Dec 08 20:12:01 volumio systemd[1]: Started mpd_oled_plugin.service - MPD OLED Plugin. Dec 08 20:12:01 volumio volumio[1157]: info: ------------------------------------------- Dec 08 20:12:01 volumio volumio[1157]: info: ----- MyVolumio plugins startup ---- Dec 08 20:12:01 volumio volumio[1157]: info: ------------------------------------------- Dec 08 20:12:01 volumio volumio[1157]: info: [MyVolumio PluginManager] Fetching plans data.... Dec 08 20:12:01 volumio sudo[1439]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:01 volumio volumio[1157]: info: MPD running with PID1580 Dec 08 20:12:01 volumio volumio[1157]: ,establishing connection Dec 08 20:12:01 volumio volumio[1157]: info: [MPD_OLED Plugin] Started mpd_oled_plugin service Dec 08 20:12:02 volumio volumio[1157]: error: MPD error: The expression evaluated to a falsy value: Dec 08 20:12:02 volumio volumio[1157]: assert.ok(self.idling) Dec 08 20:12:02 volumio volumio[1157]: error: The expression evaluated to a falsy value: Dec 08 20:12:02 volumio volumio[1157]: assert.ok(self.idling) Dec 08 20:12:02 volumio volumio[1157]: error: MPD error: The expression evaluated to a falsy value: Dec 08 20:12:02 volumio volumio[1157]: assert.ok(self.idling) Dec 08 20:12:02 volumio volumio[1157]: error: The expression evaluated to a falsy value: Dec 08 20:12:02 volumio volumio[1157]: assert.ok(self.idling) Dec 08 20:12:02 volumio volumio[1157]: error: MPD error: The expression evaluated to a falsy value: Dec 08 20:12:02 volumio volumio[1157]: assert.ok(self.idling) Dec 08 20:12:02 volumio volumio[1157]: error: The expression evaluated to a falsy value: Dec 08 20:12:02 volumio volumio[1157]: assert.ok(self.idling) Dec 08 20:12:02 volumio volumio[1157]: error: updateQueue error: null Dec 08 20:12:02 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:02 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:02 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:02 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:02 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:02 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:02 volumio volumio-remote-updater[512]: [2025-12-08 20:12:02] [connect] Successful connection Dec 08 20:12:02 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:02 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:02 volumio volumio-remote-updater[512]: [2025-12-08 20:12:02] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=3&transport=websocket&t=1765199522 101 Dec 08 20:12:02 volumio volumio[1157]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Engine version: 3 Transport: websocket Total Clients: 2 Dec 08 20:12:03 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:03 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:03 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:03 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:03 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:03 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:03 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:03 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:04 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:04 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:04 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:04 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:04 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:04 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:04 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:04 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:05 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:05 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:05 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:05 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:05 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:05 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:05 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:06 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:06 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:06 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:06 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:06 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:07 volumio volumio[1157]: error: Failed LSINFO: Error: [50@0] {lsinfo} No such directory Dec 08 20:12:07 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:07 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:07 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:07 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:07 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:07 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:07 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:07 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:08 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:08 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:08 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:08 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:08 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:08 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:08 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:08 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:09 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:09 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:09 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:09 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:09 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:09 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:09 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:09 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 3 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 4 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 5 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 6 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 7 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 8 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 9 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 10 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 11 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 12 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 13 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 14 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 15 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 16 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 17 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 18 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 19 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 20 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 21 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 22 Dec 08 20:12:10 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 23 Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan premium Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan superstar Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso Dec 08 20:12:11 volumio volumio[1157]: info: Adding plugin bluetooth to MyMusic Plugins Dec 08 20:12:11 volumio volumio[1157]: info: Adding plugin multiroom to MyMusic Plugins Dec 08 20:12:11 volumio volumio[1157]: info: Adding plugin metavolumio to MyMusic Plugins Dec 08 20:12:11 volumio volumio[1157]: info: Adding plugin cd_controller to MyMusic Plugins Dec 08 20:12:11 volumio volumio[1157]: info: Adding plugin smart_inputs to MyMusic Plugins Dec 08 20:12:11 volumio volumio[1157]: info: Adding plugin tidalconnect to MyMusic Plugins Dec 08 20:12:11 volumio volumio[1157]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... Dec 08 20:12:14 volumio volumio[1157]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded Dec 08 20:12:14 volumio volumio[1157]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio Dec 08 20:12:14 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:14 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:14 volumio volumio[1157]: info: Starting MyVolumio Remote Streaming Endpoints Dec 08 20:12:14 volumio volumio[1157]: info: MyVolumio login type: Token Dec 08 20:12:14 volumio volumio[1157]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started Dec 08 20:12:14 volumio volumio[1157]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... Dec 08 20:12:19 volumio systemd[1]: Starting setdatetime-helper.timer.service - Volumio Time Sync Watchdog Service... Dec 08 20:12:20 volumio dbus-daemon[493]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service' requested by ':1.23' (uid=0 pid=1739 comm="timedatectl show --property=NTPSynchronized --valu") Dec 08 20:12:20 volumio systemd[1]: Starting systemd-timedated.service - Time & Date Service... Dec 08 20:12:20 volumio volumio[1157]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Dec 08 20:12:20 volumio volumio[1157]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Dec 08 20:12:20 volumio volumio[1157]: info: Streaming services startup Dec 08 20:12:20 volumio volumio[1157]: info: Starting Streaming Daemon Dec 08 20:12:20 volumio volumio[1157]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started Dec 08 20:12:20 volumio sudo[1743]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Dec 08 20:12:20 volumio sudo[1743]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:20 volumio dbus-daemon[493]: [system] Successfully activated service 'org.freedesktop.timedate1' Dec 08 20:12:20 volumio systemd[1]: Started systemd-timedated.service - Time & Date Service. Dec 08 20:12:20 volumio setdatetime-helper.sh[1738]: Time is not synchronized. Attempting to sync... Dec 08 20:12:20 volumio sudo[1743]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:20 volumio sudo[1754]: root : PWD=/ ; USER=root ; COMMAND=/usr/bin/date -s 'Mon, 08 Dec 2025 13:12:20 GMT#015' Dec 08 20:12:20 volumio sudo[1754]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Dec 08 20:12:20 volumio setdatetime-helper.sh[1755]: Mon Dec 8 20:12:20 +07 2025 Dec 08 20:12:20 volumio systemd-journald[307]: Time jumped backwards, rotating. Dec 08 20:12:20 volumio sudo[1754]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:20 volumio setdatetime-helper.sh[1738]: Time synchronized successfully. Dec 08 20:12:20 volumio systemd[1]: setdatetime-helper.timer.service: Deactivated successfully. Dec 08 20:12:20 volumio systemd[1]: Finished setdatetime-helper.timer.service - Volumio Time Sync Watchdog Service. Dec 08 20:12:20 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 24 Dec 08 20:12:20 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 25 Dec 08 20:12:20 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:20 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:20 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 08 20:12:20 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:20 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 08 20:12:20 volumio volumio[1157]: error: Cannot start Volumio Streaming Daemon Dec 08 20:12:20 volumio volumio[1157]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Dec 08 20:12:20 volumio volumio[1157]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Dec 08 20:12:21 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:21 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:21 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:21 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:22 volumio volumio[1157]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN Dec 08 20:12:22 volumio volumio-remote-updater[512]: Test mode disabled Dec 08 20:12:22 volumio volumio-remote-updater[512]: Alpha mode disabled Dec 08 20:12:22 volumio volumio-remote-updater[512]: Alpha legacy test mode disabled Dec 08 20:12:22 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Dec 08 20:12:22 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:22 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:23 volumio volumio[1157]: info: Update Ready: {"changeLogLink":"http://volumio.org","description":"

ANNOUNCEMENT

\n
    \n
  • Production line
  • \n
\n

FIX

\n
    \n
  • Nodejs 20.5.1 version pinning with static package fallback
  • \n
\n","title":"Update v4.073","updateavailable":true} Dec 08 20:12:23 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Dec 08 20:12:23 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:23 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:23 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:23 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:23 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:23 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:23 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:23 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:24 volumio volumio[1157]: info: MyVolumio token set successfully Dec 08 20:12:24 volumio volumio[1157]: info: MYVOLUMIO: Adding device Dec 08 20:12:24 volumio volumio[1157]: info: MYVOLUMIO: Evaluating Server Dec 08 20:12:25 volumio volumio[1157]: info: MyVolumio status changed Dec 08 20:12:25 volumio volumio[1157]: info: Streaming services startup Dec 08 20:12:25 volumio volumio[1157]: info: Starting Streaming Daemon Dec 08 20:12:25 volumio volumio[1157]: info: Removing browser output: myVolumio user plan is not superstar Dec 08 20:12:25 volumio volumio[1157]: info: Removing audio output: Dec 08 20:12:25 volumio volumio[1157]: info: Stoppping Tunnel 1 Dec 08 20:12:25 volumio sudo[1806]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Dec 08 20:12:25 volumio sudo[1806]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:25 volumio sudo[1808]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop sshtunnel.service Dec 08 20:12:25 volumio sudo[1808]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:25 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:25 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:25 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. Dec 08 20:12:25 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. Dec 08 20:12:25 volumio sudo[1806]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:25 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. Dec 08 20:12:25 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. Dec 08 20:12:25 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. Dec 08 20:12:25 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. Dec 08 20:12:25 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. Dec 08 20:12:25 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. Dec 08 20:12:25 volumio sudo[1808]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:25 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 28 Dec 08 20:12:25 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 29 Dec 08 20:12:25 volumio volumio[1157]: info: Remote SSH Stopped Dec 08 20:12:25 volumio volumio[1157]: error: Cannot start Volumio Streaming Daemon Dec 08 20:12:25 volumio volumio[1157]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Dec 08 20:12:25 volumio volumio[1157]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Dec 08 20:12:25 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 30 Dec 08 20:12:25 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 31 Dec 08 20:12:25 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 32 Dec 08 20:12:25 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 33 Dec 08 20:12:25 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 34 Dec 08 20:12:25 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 35 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 36 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 37 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 38 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 39 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 40 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 41 Dec 08 20:12:26 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:26 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 42 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 43 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 44 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 45 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 46 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 47 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 48 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 49 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 50 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 51 Dec 08 20:12:26 volumio volumio[1157]: info: Setting Geolocation for MyVolumio to as1 Dec 08 20:12:26 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:26 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:26 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 52 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 53 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 54 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 55 Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 56 Dec 08 20:12:26 volumio upmpdcli[1817]: writing RSA key Dec 08 20:12:26 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 57 Dec 08 20:12:27 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 58 Dec 08 20:12:27 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 59 Dec 08 20:12:27 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:27 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:27 volumio volumio[1157]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} Dec 08 20:12:27 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:27 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:27 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:27 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:27 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:27 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:27 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 60 Dec 08 20:12:27 volumio volumio[1157]: info: Updating MyVolumio device info Dec 08 20:12:27 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:27 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:27 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:28 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:28 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetVisibleSources Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetQueue Dec 08 20:12:28 volumio volumio[1157]: info: CoreStateMachine::getQueue Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getQueue Dec 08 20:12:28 volumio volumio[1157]: info: Listing playlists Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 08 20:12:28 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:28 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 08 20:12:28 volumio volumio[1157]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 61 Dec 08 20:12:28 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:28 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:29 volumio volumio[1157]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} Dec 08 20:12:29 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:29 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:29 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:29 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:29 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:29 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:29 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:29 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:30 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:30 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:30 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:30 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:30 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:30 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:30 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:30 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:30 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:30 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:31 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:31 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:31 volumio volumio[1157]: info: MYVOLUMIO: Adding device Dec 08 20:12:31 volumio volumio[1157]: info: MYVOLUMIO: Evaluating Server Dec 08 20:12:31 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140:3000 from 192.168.31.138 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 61 Dec 08 20:12:31 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:31 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:32 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:32 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:32 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:32 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:32 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:32 volumio volumio[1157]: info: Setting Geolocation for MyVolumio to as1 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:32 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:32 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:32 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140:3000 from 192.168.31.138 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 62 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: appearance , getAvailableLanguages Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:32 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:32 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getCurrentTimezone Dec 08 20:12:32 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Dec 08 20:12:32 volumio sudo[1915]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Dec 08 20:12:32 volumio sudo[1915]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:32 volumio sudo[1915]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:32 volumio sudo[1928]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 08 20:12:32 volumio sudo[1928]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:32 volumio sudo[1928]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:32 volumio sudo[1920]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 08 20:12:32 volumio sudo[1920]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:32 volumio sudo[1920]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:33 volumio volumio[1157]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"} Dec 08 20:12:33 volumio sudo[1938]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 08 20:12:33 volumio sudo[1938]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:33 volumio sudo[1940]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:12:33 volumio sudo[1938]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:33 volumio sudo[1940]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:33 volumio sudo[1932]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 08 20:12:33 volumio sudo[1932]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio sudo[1940]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:33 volumio sudo[1932]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: Updating MyVolumio device info Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:33 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:33 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:33 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetBrowseSources Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 08 20:12:33 volumio volumio[1157]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"} Dec 08 20:12:33 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140:3000 from 192.168.31.138 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 62 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: appearance , getAvailableLanguages Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getCurrentTimezone Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:33 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:33 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:33 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:34 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Dec 08 20:12:34 volumio sudo[1959]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Dec 08 20:12:34 volumio sudo[1959]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:34 volumio sudo[1959]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:34 volumio sudo[1961]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 08 20:12:34 volumio sudo[1961]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:34 volumio sudo[1961]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:34 volumio sudo[1975]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 08 20:12:34 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140:3000 from 192.168.31.138 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 62 Dec 08 20:12:34 volumio sudo[1976]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 08 20:12:34 volumio sudo[1970]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 08 20:12:34 volumio sudo[1975]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:34 volumio sudo[1976]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:34 volumio sudo[1970]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:34 volumio sudo[1975]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:34 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:34 volumio sudo[1976]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:34 volumio sudo[1970]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 08 20:12:34 volumio sudo[1982]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:12:34 volumio sudo[1982]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:34 volumio sudo[1982]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:34 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:34 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:34 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:34 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:34 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:34 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:35 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:35 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:35 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:35 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:35 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:35 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:35 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:35 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:36 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:36 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:36 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:36 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:36 volumio sudo[2021]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 08 20:12:36 volumio sudo[2021]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:36 volumio sudo[2023]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:12:36 volumio sudo[2023]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:36 volumio sudo[2021]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:36 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:36 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:36 volumio sudo[2023]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:36 volumio sudo[2025]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 08 20:12:36 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:36 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:36 volumio sudo[2027]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:12:36 volumio sudo[2027]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:36 volumio sudo[2027]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:36 volumio sudo[2025]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:36 volumio sudo[2025]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:36 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 62 Dec 08 20:12:36 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 63 Dec 08 20:12:37 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:37 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:37 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:37 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:37 volumio sudo[2059]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 08 20:12:37 volumio sudo[2059]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:37 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:37 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:37 volumio sudo[2059]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:37 volumio sudo[2061]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:12:37 volumio sudo[2061]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:37 volumio sudo[2061]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:37 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:37 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:37 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 64 Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 08 20:12:38 volumio sudo[2071]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 08 20:12:38 volumio sudo[2071]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:38 volumio sudo[2073]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 08 20:12:38 volumio sudo[2071]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:38 volumio sudo[2073]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:38 volumio sudo[2073]: pam_unix(sudo:session): session closed for user root Dec 08 20:12:38 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::volumioGetVisibleSources Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:38 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 08 20:12:38 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:38 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:38 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:38 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:38 volumio volumio[1157]: info: Listing playlists Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:38 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:38 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140 from 192.168.31.138 UA: Mozilla/5.0 (iPhone; CPU iPhone OS 18_6_2 like Mac OS X) AppleWebKit/605.1.15 (KHTML, like Gecko) Mobile/15E148 Engine version: 3 Transport: polling Total Clients: 65 Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:38 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:38 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:38 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetVisibleSources Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:39 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 08 20:12:39 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:39 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:39 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:39 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:39 volumio volumio[1157]: info: Listing playlists Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:39 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:39 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 08 20:12:39 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:39 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:39 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Dec 08 20:12:39 volumio volumio[1157]: error: MyVolumio Plugin failed to authenticate in a timely fashion Dec 08 20:12:39 volumio volumio[1157]: info: Completed starting MyVolumio Plugin Dec 08 20:12:39 volumio volumio[1157]: [Metrics] CommandRouter: 68s 159.69ms Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumiosetStartupVolume Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::Close All Modals sent Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::Close All Modals sent Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:39 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:39 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:39 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 08 20:12:40 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:40 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:40 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:40 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:40 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Dec 08 20:12:40 volumio volumio[1157]: info: Cannot play startup sound: Error: Command failed: /usr/bin/aplay -D volumio /volumio/app/startup.wav Dec 08 20:12:40 volumio volumio[1157]: Playing WAVE '/volumio/app/startup.wav' : Signed 16 bit Little Endian, Rate 44100 Hz, Stereo Dec 08 20:12:40 volumio volumio[1157]: aplay: xrun:1636: status error: Broken pipe Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:40 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:40 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:40 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Dec 08 20:12:41 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:41 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:41 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:41 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:41 volumio volumio[1157]: info: CoreCommandRouter::volumioGetQueue Dec 08 20:12:41 volumio volumio[1157]: info: CoreStateMachine::getQueue Dec 08 20:12:41 volumio volumio[1157]: info: CorePlayQueue::getQueue Dec 08 20:12:41 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:41 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:41 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:41 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:42 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:42 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:42 volumio volumio[1157]: verbose: New Socket.io Connection to 192.168.31.140:3000 from 192.168.31.138 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 66 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:42 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:42 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 08 20:12:42 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:42 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:42 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:42 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:42 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 08 20:12:42 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:42 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:42 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:42 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:43 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:43 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 08 20:12:43 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:43 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:43 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 08 20:12:43 volumio volumio[1157]: info: Received Get System Info Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 08 20:12:43 volumio volumio[1157]: info: Discovery: Getting this device information Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:43 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:43 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:43 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:43 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:44 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:44 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:44 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:44 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:44 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:44 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:44 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:44 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:44 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:44 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:44 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:44 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:45 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: webradio , handleBrowseUri Dec 08 20:12:45 volumio volumio[1157]: info: Preload queue cleared Dec 08 20:12:45 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:45 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:45 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:45 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:45 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:46 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:46 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:46 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:46 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:46 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: webradio , handleBrowseUri Dec 08 20:12:46 volumio volumio[1157]: info: BOOT COMPLETED Dec 08 20:12:46 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:46 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:46 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:46 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:47 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:47 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:47 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:47 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:47 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:47 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:47 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:47 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:47 volumio volumio[1157]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Dec 08 20:12:48 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:48 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:48 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:48 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:48 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:48 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:48 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:48 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:49 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:49 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:49 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:49 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:49 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:49 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:49 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:49 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:49 volumio systemd[1]: systemd-timedated.service: Deactivated successfully. Dec 08 20:12:49 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:49 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:49 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:49 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:50 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:50 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:50 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:50 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:50 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:50 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:50 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:50 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:51 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:51 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:51 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:51 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:51 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:51 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:51 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:51 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:52 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:52 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:52 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:52 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:52 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:52 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:52 volumio volumio[1157]: info: CoreCommandRouter::volumioGetState Dec 08 20:12:52 volumio volumio[1157]: info: CorePlayQueue::getTrack 0 Dec 08 20:12:52 volumio volumio[1157]: Use XMLElement.setAttribute instead Dec 08 20:12:52 volumio volumio[1157]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 08 20:12:53 volumio volumio[1157]: TypeError: children[i].attr(...).value is not a function Dec 08 20:12:53 volumio volumio[1157]: at /volumio/app/plugins/music_service/webradio/index.js:428:46 Dec 08 20:12:53 volumio volumio[1157]: at process.processTicksAndRejections (node:internal/process/task_queues:95:5) Dec 08 20:12:53 volumio volumio[1157]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 08 20:12:56 volumio sudo[2306]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2025-12-08 20:11' Dec 08 20:12:56 volumio sudo[2306]: 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="4a70cb031e64a8e498efc3e29470650871ff7d54" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="04c18c158cc4bac70764c3360b25fcce0c69266a" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sat May 31 04:09:10 UTC 2025" VOLUMIO_VERSION="4.005" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="f9bd4447a30d4b2c74b3880e7a50e48b"