Mar 04 10:35:12 volumio go-librespot[1677]: time="2026-03-04T10:35:12-03:00" level=trace msg="sent dealer ping" Mar 04 10:35:13 volumio go-librespot[1677]: time="2026-03-04T10:35:13-03:00" level=trace msg="received dealer pong" Mar 04 10:35:39 volumio kernel: smsc95xx 1-1.1:1.0 eth0: Link is Up - 100Mbps/Full - flow control off Mar 04 10:35:39 volumio dhcpcd[820]: eth0: carrier acquired Mar 04 10:35:39 volumio dhcpcd[820]: eth0: IAID eb:6f:6d:0b Mar 04 10:35:39 volumio dhcpcd[820]: eth0: adding address fe80::f646:ca25:19fa:8daf Mar 04 10:35:39 volumio dhcpcd[820]: ipv6_addaddr1: Permission denied Mar 04 10:35:39 volumio dhcpcd[820]: eth0: soliciting an IPv6 router Mar 04 10:35:39 volumio dhcpcd[820]: eth0: soliciting a DHCP lease Mar 04 10:35:39 volumio ifplugd(eth0)[910]: Link beat detected. Mar 04 10:35:39 volumio ifplugd(eth0)[910]: Executing '/etc/ifplugd/ifplugd.action eth0 up'. Mar 04 10:35:40 volumio ifplugd(eth0)[910]: client: sending commands to dhcpcd process Mar 04 10:35:40 volumio dhcpcd[820]: control_free: No such file or directory Mar 04 10:35:40 volumio dhcpcd[820]: ps_ctl_dispatch: cannot handle another client Mar 04 10:35:40 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:40 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:40 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:40 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:40 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:40 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:40 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:40 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Mar 04 10:35:40 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Mar 04 10:35:40 volumio ifplugd(eth0)[910]: Program executed successfully. Mar 04 10:35:40 volumio wireless.js[722]: WIRELESS.JS - INFO: === SNM TRANSITION === Mar 04 10:35:40 volumio wireless.js[722]: WIRELESS.JS - INFO: Previous ethernet state: disconnected Mar 04 10:35:40 volumio wireless.js[722]: WIRELESS.JS - INFO: New ethernet state: connected Mar 04 10:35:40 volumio wireless.js[722]: WIRELESS.JS - INFO: Single Network Mode: enabled Mar 04 10:35:40 volumio wireless.js[722]: WIRELESS.JS - INFO: First start: no Mar 04 10:35:40 volumio wireless.js[722]: WIRELESS.JS - INFO: Action: Switch to ethernet (WiFi scan mode) Mar 04 10:35:40 volumio wireless.js[722]: WIRELESS.JS - INFO: === END TRANSITION === Mar 04 10:35:40 volumio wireless.js[722]: WIRELESS.JS - INFO: SNM: Ethernet connected, switching to ethernet (WiFi scan mode) Mar 04 10:35:41 volumio sudo[14065]: root : PWD=/ ; USER=root ; COMMAND=/sbin/dhcpcd -k wlan0 Mar 04 10:35:41 volumio sudo[14065]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Mar 04 10:35:41 volumio dhcpcd[14066]: dhcpcd not running Mar 04 10:35:41 volumio sudo[14065]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:41 volumio wireless.js[722]: dhcpcd not running Mar 04 10:35:41 volumio wireless.js[722]: WIRELESS.JS - INFO: Wireless.js initializing wireless flow Mar 04 10:35:41 volumio wpa_supplicant[1135]: p2p-dev-wlan0: CTRL-EVENT-DSCP-POLICY clear_all Mar 04 10:35:41 volumio wpa_supplicant[1135]: p2p-dev-wlan0: CTRL-EVENT-DSCP-POLICY clear_all Mar 04 10:35:41 volumio wpa_supplicant[1135]: nl80211: deinit ifname=p2p-dev-wlan0 disabled_11b_rates=0 Mar 04 10:35:41 volumio sudo[14075]: root : PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0 Mar 04 10:35:41 volumio sudo[14075]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Mar 04 10:35:41 volumio avahi-daemon[1309]: Withdrawing address record for 192.168.1.130 on wlan0. Mar 04 10:35:41 volumio dhcpcd[820]: wlan0: pid 14076 deleted IP address 192.168.1.130/24 Mar 04 10:35:41 volumio dhcpcd[820]: wlan0: deleting route to 192.168.1.0/24 Mar 04 10:35:41 volumio avahi-daemon[1309]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.1.130. Mar 04 10:35:41 volumio avahi-daemon[1309]: Interface wlan0.IPv4 no longer relevant for mDNS. Mar 04 10:35:41 volumio dhcpcd[820]: wlan0: deleting default route via 192.168.1.1 Mar 04 10:35:41 volumio sudo[14075]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:41 volumio volumio[1182]: info: Discovery: A device disappeared from network Mar 04 10:35:41 volumio volumio[1182]: info: Discovery: Device volumio disappeared from network Mar 04 10:35:41 volumio wpa_supplicant[1135]: p2p-dev-wlan0: CTRL-EVENT-TERMINATING Mar 04 10:35:41 volumio wpa_supplicant[1135]: wlan0: CTRL-EVENT-DISCONNECTED bssid=f8:5b:3b:9d:d1:64 reason=3 locally_generated=1 Mar 04 10:35:41 volumio sudo[14079]: root : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 down Mar 04 10:35:41 volumio sudo[14079]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Mar 04 10:35:41 volumio systemd[1]: Stopped target ip-changed@wlan0.target - IP Address changed on wlan0. Mar 04 10:35:41 volumio systemd[1]: Stopping ip-changed@wlan0.target - IP Address changed on wlan0... Mar 04 10:35:41 volumio systemd[1]: welcome.service: Deactivated successfully. Mar 04 10:35:41 volumio systemd[1]: Stopped welcome.service - Show a welcome message on console. Mar 04 10:35:41 volumio systemd[1]: Stopping welcome.service - Show a welcome message on console... Mar 04 10:35:41 volumio dhcpcd[820]: wlan0: soliciting a DHCP lease Mar 04 10:35:41 volumio dhcpcd[820]: wlan0: carrier lost - roaming Mar 04 10:35:41 volumio systemd[1]: Starting welcome.service - Show a welcome message on console... Mar 04 10:35:41 volumio wpa_supplicant[1135]: wlan0: CTRL-EVENT-DSCP-POLICY clear_all Mar 04 10:35:41 volumio welcome[14087]: Resolved ip:[0] Mar 04 10:35:41 volumio sudo[14079]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:41 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:41 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:41 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:41 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:41 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:41 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:41 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:41 volumio wireless.js[722]: WIRELESS.JS - INFO: Cleaning previous... Mar 04 10:35:41 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Mar 04 10:35:41 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Mar 04 10:35:42 volumio dhcpcd[820]: wlan0: carrier lost Mar 04 10:35:42 volumio volumio5-onboarding[1587]: time=2026-03-04T10:35:42.014-03:00 level=INFO msg="enabling BLE discovery" Mar 04 10:35:42 volumio systemd[1]: Finished welcome.service - Show a welcome message on console. Mar 04 10:35:42 volumio systemd[1]: Reached target ip-changed@wlan0.target - IP Address changed on wlan0. Mar 04 10:35:42 volumio sudo[14115]: root : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Mar 04 10:35:42 volumio sudo[14115]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Mar 04 10:35:42 volumio kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled Mar 04 10:35:42 volumio dhcpcd[820]: eth0: offered 192.168.1.120 from 192.168.1.1 Mar 04 10:35:42 volumio sudo[14115]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:42 volumio dhcpcd[820]: eth0: probing address 192.168.1.120/24 Mar 04 10:35:42 volumio wpa_supplicant[1135]: wlan0: CTRL-EVENT-DSCP-POLICY clear_all Mar 04 10:35:42 volumio wpa_supplicant[1135]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0 Mar 04 10:35:42 volumio wireless.js[722]: WIRELESS.JS - INFO: InterfaceValidator: READY - wlan0 is ready for operations Mar 04 10:35:42 volumio wireless.js[722]: WIRELESS.JS - INFO: InterfaceValidator: wlan0 became ready after 2ms Mar 04 10:35:42 volumio wireless.js[722]: WIRELESS.JS - INFO: ensureInterfaceReady: Interface ready (MAC: b8:27:eb:3a:38:5e) Mar 04 10:35:42 volumio sudo[14131]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iw reg get Mar 04 10:35:42 volumio sudo[14131]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:35:42 volumio sudo[14131]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:42 volumio wpa_supplicant[1135]: wlan0: CTRL-EVENT-TERMINATING Mar 04 10:35:42 volumio sudo[14141]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iw wlan0 scan Mar 04 10:35:42 volumio sudo[14141]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:35:42 volumio sudo[14141]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:42 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:42 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:42 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:42 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:42 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:42 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:42 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:42 volumio wireless.js[722]: command failed: Network is down (-100) Mar 04 10:35:42 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Mar 04 10:35:42 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Mar 04 10:35:42 volumio wireless.js[722]: WIRELESS.JS - INFO: Single Network Mode: Ethernet active, maintaining WiFi scan capability Mar 04 10:35:42 volumio wireless.js[722]: WIRELESS.JS - INFO: SNM: Maintaining wlan0 UP without IP (scan mode) Mar 04 10:35:42 volumio wireless.js[722]: WIRELESS.JS - INFO: SNM: Users can configure WiFi via WebUI while ethernet is active Mar 04 10:35:42 volumio go-librespot[1677]: time="2026-03-04T10:35:42-03:00" level=trace msg="sent dealer ping" Mar 04 10:35:42 volumio sudo[14152]: root : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up Mar 04 10:35:42 volumio sudo[14152]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Mar 04 10:35:42 volumio sudo[14152]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:42 volumio kernel: brcmfmac: brcmf_cfg80211_set_power_mgmt: power save disabled Mar 04 10:35:43 volumio sudo[14155]: root : PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0 Mar 04 10:35:43 volumio sudo[14155]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Mar 04 10:35:43 volumio sudo[14155]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:43 volumio wpa_supplicant[14158]: Successfully initialized wpa_supplicant Mar 04 10:35:43 volumio wpa_supplicant[14162]: wlan0: CTRL-EVENT-DSCP-POLICY clear_all Mar 04 10:35:43 volumio wireless.js[722]: WIRELESS.JS - INFO: SNM: Transition to scan mode completed in 2492ms Mar 04 10:35:43 volumio wireless.js[722]: WIRELESS.JS - INFO: SNM: wlan0 is UP without IP, scan capable Mar 04 10:35:43 volumio wireless.js[722]: WIRELESS.JS - INFO: Notified systemd about wireless ready Mar 04 10:35:43 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:43 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:43 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:43 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:43 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:43 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:43 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:43 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Mar 04 10:35:43 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Mar 04 10:35:44 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:44 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:44 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:44 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:44 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:44 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:44 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:44 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Mar 04 10:35:44 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Mar 04 10:35:45 volumio ntpd[902]: IO: Deleting interface #3 wlan0, 192.168.1.130#123, interface stats: received=279, sent=291, dropped=0, active_time=2771 secs Mar 04 10:35:45 volumio ntpd[902]: PROTO: 162.159.200.123 unlink local addr 192.168.1.130 -> Mar 04 10:35:45 volumio ntpd[902]: PROTO: 64.176.3.116 unlink local addr 192.168.1.130 -> Mar 04 10:35:45 volumio ntpd[902]: PROTO: 200.89.75.197 unlink local addr 192.168.1.130 -> Mar 04 10:35:45 volumio ntpd[902]: PROTO: 64.176.13.132 unlink local addr 192.168.1.130 -> Mar 04 10:35:45 volumio ntpd[902]: PROTO: 64.176.4.213 unlink local addr 192.168.1.130 -> Mar 04 10:35:45 volumio ntpd[902]: PROTO: 186.64.123.80 unlink local addr 192.168.1.130 -> Mar 04 10:35:45 volumio ntpd[902]: PROTO: 200.89.75.198 unlink local addr 192.168.1.130 -> Mar 04 10:35:45 volumio volumio[1182]: info: Volumio Network Manager: Network status updated: 0 Mar 04 10:35:47 volumio dhcpcd[820]: eth0: leased 192.168.1.120 for 28800 seconds Mar 04 10:35:47 volumio avahi-daemon[1309]: Joining mDNS multicast group on interface eth0.IPv4 with address 192.168.1.120. Mar 04 10:35:47 volumio dhcpcd[820]: eth0: adding route to 192.168.1.0/24 Mar 04 10:35:47 volumio dhcpcd[820]: eth0: adding default route via 192.168.1.1 Mar 04 10:35:47 volumio avahi-daemon[1309]: New relevant interface eth0.IPv4 for mDNS. Mar 04 10:35:47 volumio avahi-daemon[1309]: Registering new address record for 192.168.1.120 on eth0.IPv4. Mar 04 10:35:47 volumio systemd[1]: welcome.service: Deactivated successfully. Mar 04 10:35:47 volumio systemd[1]: Stopped welcome.service - Show a welcome message on console. Mar 04 10:35:47 volumio systemd[1]: Stopping welcome.service - Show a welcome message on console... Mar 04 10:35:47 volumio systemd[1]: Starting welcome.service - Show a welcome message on console... Mar 04 10:35:47 volumio welcome[14217]: Resolved ip:[1] 192.168.1.120 Mar 04 10:35:47 volumio systemd[1]: Finished welcome.service - Show a welcome message on console. Mar 04 10:35:47 volumio systemd[1]: Reached target ip-changed@eth0.target - IP Address changed on eth0. Mar 04 10:35:47 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:47 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:47 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:47 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:47 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:47 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:47 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:47 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Mar 04 10:35:47 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Mar 04 10:35:47 volumio volumio5-onboarding[1587]: time=2026-03-04T10:35:47.596-03:00 level=INFO msg="disabling BLE discovery" Mar 04 10:35:47 volumio volumio5-onboarding[1587]: time=2026-03-04T10:35:47.619-03:00 level=INFO msg="connection closed, stopping read loop" component=conn/multi net=ble addr=B8:27:EB:C5:C7:A1%00 Mar 04 10:35:48 volumio volumio[1182]: info: Discovery: adding e05ef719-fa54-43bb-9172-711494bb74c8 Mar 04 10:35:48 volumio volumio[1182]: info: Discovery: Found device volumio Mar 04 10:35:48 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:48 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:48 volumio ntpd[902]: IO: Listen normally on 4 eth0 192.168.1.120:123 Mar 04 10:35:48 volumio ntpd[902]: IO: new interface(s) found: waking up resolver Mar 04 10:35:49 volumio volumio5-onboarding[1587]: time=2026-03-04T10:35:49.499-03:00 level=INFO msg="established new WebSocket connection" component=conn/ws remoteAddr=192.168.1.87:38856 Mar 04 10:35:49 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:49 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:49 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:49 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:49 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:49 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:49 volumio volumio[1182]: verbose: New Socket.io Connection to 192.168.1.120:3000 from 192.168.1.87 UA: Dart/3.10 (dart:io) Engine version: 3 Transport: websocket Total Clients: 6 Mar 04 10:35:49 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Mar 04 10:35:49 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Mar 04 10:35:55 volumio nmbd[1046]: [2026/03/04 10:35:55.453848, 0] ../../source3/libsmb/nmblib.c:923(send_udp) Mar 04 10:35:55 volumio nmbd[1046]: Packet send failed to 192.168.1.94(137) ERRNO=Network is unreachable Mar 04 10:35:55 volumio nmbd[1046]: [2026/03/04 10:35:55.464555, 0] ../../source3/nmbd/nmbd_packets.c:1027(reply_netbios_packet) Mar 04 10:35:55 volumio nmbd[1046]: reply_netbios_packet: send_packet to IP 192.168.1.94 port 137 failed Mar 04 10:35:55 volumio volumio[1182]: info: Volumio Network Manager: Network status updated: 1 Mar 04 10:35:56 volumio sudo[14259]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Mar 04 10:35:56 volumio sudo[14259]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:35:56 volumio sudo[14259]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:56 volumio sudo[14261]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Mar 04 10:35:56 volumio sudo[14261]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:35:56 volumio sudo[14261]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:56 volumio volumio[1182]: verbose: New Socket.io Connection to 192.168.1.120 from 192.168.1.94 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/145.0.0.0 Safari/537.36 Edg/145.0.0.0 Engine version: 3 Transport: polling Total Clients: 6 Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::volumioGetVisibleSources Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:56 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Mar 04 10:35:56 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:56 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:56 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:56 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:56 volumio volumio[1182]: info: Listing playlists Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Mar 04 10:35:56 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Mar 04 10:35:57 volumio sudo[14267]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Mar 04 10:35:57 volumio sudo[14267]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:35:57 volumio sudo[14267]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:57 volumio sudo[14269]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Mar 04 10:35:57 volumio sudo[14269]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:35:57 volumio sudo[14269]: pam_unix(sudo:session): session closed for user root Mar 04 10:35:57 volumio volumio[1182]: verbose: New Socket.io Connection to 192.168.1.120 from 192.168.1.94 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/145.0.0.0 Safari/537.36 Edg/145.0.0.0 Engine version: 3 Transport: polling Total Clients: 6 Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::volumioGetVisibleSources Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:58 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Mar 04 10:35:58 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:58 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:58 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:58 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:58 volumio volumio[1182]: info: Listing playlists Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Mar 04 10:35:58 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:58 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:59 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Mar 04 10:35:59 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Mar 04 10:35:59 volumio volumio[1182]: info: Received Get System Info Mar 04 10:35:59 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:35:59 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:35:59 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:35:59 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:35:59 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:35:59 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:36:01 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Mar 04 10:36:01 volumio volumio[1182]: info: Received Get System Info Mar 04 10:36:01 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:36:01 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:36:01 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:36:01 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:36:01 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:36:01 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:36:05 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Mar 04 10:36:05 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Mar 04 10:36:07 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Mar 04 10:36:11 volumio volumio[1182]: info: Ign:9 http://archive.raspberrypi.com/debian bookworm/main armhf chromium-common armhf 1:145.0.7632.116-1~deb12u1+rpt1 Mar 04 10:36:11 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:11.343-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:11 volumio volumio[1182]: info: Get:27 http://archive.raspberrypi.com/debian bookworm/main armhf chromium armhf 1:145.0.7632.116-1~deb12u1+rpt1 [97.4 MB] Mar 04 10:36:11 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:11.773-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:12 volumio go-librespot[1677]: time="2026-03-04T10:36:12-03:00" level=error msg="did not receive last pong from dealer, 60s passed" Mar 04 10:36:16 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Mar 04 10:36:16 volumio volumio[1182]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Mar 04 10:36:16 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Mar 04 10:36:16 volumio volumio[1182]: info: Received Get System Version Mar 04 10:36:16 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Mar 04 10:36:16 volumio volumio[1182]: info: Received Get System Info Mar 04 10:36:16 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Mar 04 10:36:16 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Mar 04 10:36:16 volumio volumio[1182]: info: Discovery: Getting this device information Mar 04 10:36:16 volumio volumio[1182]: info: CoreCommandRouter::volumioGetState Mar 04 10:36:16 volumio volumio[1182]: info: CorePlayQueue::getTrack 9 Mar 04 10:36:16 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Mar 04 10:36:18 volumio go-librespot[1677]: time="2026-03-04T10:36:18-03:00" level=error msg="failed receiving dealer message" error="failed to get reader: use of closed network connection" Mar 04 10:36:19 volumio go-librespot[1677]: time="2026-03-04T10:36:19-03:00" level=debug msg="dealer connection opened" Mar 04 10:36:19 volumio go-librespot[1677]: time="2026-03-04T10:36:19-03:00" level=debug msg="re-established dealer connection" Mar 04 10:36:19 volumio go-librespot[1677]: time="2026-03-04T10:36:19-03:00" level=debug msg="received connection id: NjlhNTRiYjEtNmQz...QTRENzA2MjVCQw==" Mar 04 10:36:20 volumio go-librespot[1677]: time="2026-03-04T10:36:20-03:00" level=debug msg="put connect state because NEW_DEVICE" Mar 04 10:36:23 volumio volumio[1182]: info: Enabling plugin touch_display Mar 04 10:36:23 volumio volumio[1182]: info: Loading plugin "touch_display"... Mar 04 10:36:27 volumio volumio[1182]: info: PLUGIN START: touch_display Mar 04 10:36:27 volumio volumio[1182]: info: Loading i18n strings for locale es Mar 04 10:36:27 volumio volumio[1182]: error: touch_display: Fetching language file: Error: i18n file complementing the system language not found. Mar 04 10:36:27 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Mar 04 10:36:27 volumio sudo[14374]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/mkdir -p /data/volumiokioskextensions/IframeKeyboardBridge Mar 04 10:36:27 volumio sudo[14374]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:27 volumio sudo[14374]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:27 volumio sudo[14376]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop getty@tty1.service Mar 04 10:36:27 volumio sudo[14376]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:27 volumio volumio[1182]: info: touch_display: No backlight interface detected. Mar 04 10:36:27 volumio sudo[14379]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl disable getty@tty1.service Mar 04 10:36:27 volumio sudo[14379]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:27 volumio sudo[14381]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl daemon-reload Mar 04 10:36:27 volumio sudo[14381]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:27 volumio systemd[1]: Stopping getty@tty1.service - Getty on tty1... Mar 04 10:36:27 volumio systemd[1]: getty@tty1.service: Deactivated successfully. Mar 04 10:36:27 volumio systemd[1]: Stopped getty@tty1.service - Getty on tty1. Mar 04 10:36:27 volumio volumio[1182]: info: Get:28 http://archive.raspberrypi.com/debian bookworm/main armhf rpi-chromium-mods armhf 20250506 [5078 B] Mar 04 10:36:27 volumio systemd[1]: session-1.scope: Deactivated successfully. Mar 04 10:36:27 volumio systemd[1]: Reloading. Mar 04 10:36:27 volumio systemd-logind[716]: Session 1 logged out. Waiting for processes to exit. Mar 04 10:36:28 volumio volumio[1182]: info: Get:29 http://archive.raspberrypi.com/debian bookworm/main armhf chromium-browser all 1:145.0.7632.116-1~deb12u1+rpt1 [111 kB] Mar 04 10:36:28 volumio volumio[1182]: info: Get:30 http://archive.raspberrypi.com/debian bookworm/main armhf chromium-l10n all 1:145.0.7632.116-1~deb12u1+rpt1 [19.8 MB] Mar 04 10:36:28 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:28.004-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:28 volumio volumio[1182]: info: Get:31 http://archive.raspberrypi.com/debian bookworm/main armhf chromium-sandbox armhf 1:145.0.7632.116-1~deb12u1+rpt1 [119 kB] Mar 04 10:36:28 volumio volumio[1182]: info: Get:32 http://archive.raspberrypi.com/debian bookworm/main armhf libwidevinecdm0 armhf 4.10.2662.3+1 [7466 kB] Mar 04 10:36:28 volumio sudo[14387]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/cp -r /data/plugins/user_interface/touch_display/iframe_keyboard_bridge/content.js /data/plugins/user_interface/touch_display/iframe_keyboard_bridge/manifest.json /data/volumiokioskextensions/IframeKeyboardBridge/ Mar 04 10:36:28 volumio sudo[14387]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:28 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:28.076-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:28 volumio sudo[14387]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:28 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:28.094-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:28 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:28.108-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:28 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:28.116-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:28 volumio volumio[1182]: Upnp client error: Error: This socket has been ended by the other party Mar 04 10:36:28 volumio volumio[1182]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 7 Mar 04 10:36:28 volumio volumio[1182]: info: touch_display: IframeKeyboardBridge extension installed successfully Mar 04 10:36:28 volumio volumio[1182]: info: CoreCommandRouter::getUIConfigOnPlugin Mar 04 10:36:28 volumio volumio[1182]: info: touch_display: No Raspberry Pi Foundation touch screen detected. Mar 04 10:36:28 volumio sudo[14409]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod a+rw /etc/X11/xorg.conf.d/99-vc4.conf Mar 04 10:36:28 volumio sudo[14409]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:28 volumio sudo[14409]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:28 volumio volumio[1182]: info: touch_display: About to detect HDMI ports... Mar 04 10:36:28 volumio volumio[1182]: info: touch_display: File permissions for /etc/X11/xorg.conf.d/99-vc4.conf set. Mar 04 10:36:28 volumio volumio[1182]: info: touch_display: X server not ready, cannot detect HDMI ports yet. Mar 04 10:36:28 volumio volumio[1182]: info: Get:9 http://archive.raspberrypi.com/debian bookworm/main armhf chromium-common armhf 1:145.0.7632.116-1~deb12u1+rpt1 [28.8 MB] Mar 04 10:36:28 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:28.896-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:30 volumio systemd[1]: /lib/systemd/system/go-librespot-daemon.service:9: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Mar 04 10:36:30 volumio systemd[1]: /lib/systemd/system/go-librespot-daemon.service:10: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Mar 04 10:36:30 volumio sudo[14381]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:30 volumio volumio[1182]: info: touch_display: systemctl daemon-reload succeeded. Mar 04 10:36:30 volumio sudo[14414]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumio-kiosk.service Mar 04 10:36:30 volumio sudo[14414]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:30 volumio systemd[1]: Reloading. Mar 04 10:36:31 volumio systemd[1]: /lib/systemd/system/go-librespot-daemon.service:9: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Mar 04 10:36:31 volumio systemd[1]: /lib/systemd/system/go-librespot-daemon.service:10: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Mar 04 10:36:32 volumio sudo[14379]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:32 volumio volumio[1182]: info: touch_display: systemctl disable getty@tty1.service succeeded. Mar 04 10:36:32 volumio sudo[14376]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:32 volumio volumio[1182]: info: touch_display: systemctl stop getty@tty1.service succeeded. Mar 04 10:36:32 volumio sudo[14414]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:32 volumio volumio[1182]: error: touch_display: Failed to start volumio-kiosk.service: Error: Command failed: /usr/bin/sudo /bin/systemctl start volumio-kiosk.service Mar 04 10:36:32 volumio volumio[1182]: Failed to start volumio-kiosk.service: Unit volumio-kiosk.service not found. Mar 04 10:36:32 volumio volumio[1182]: info: Error: Error Mar 04 10:36:32 volumio systemd-logind[716]: Removed session 1. Mar 04 10:36:33 volumio volumio[1182]: info: Fetched 143 MB in 3min 50s (623 kB/s) Mar 04 10:36:33 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:33.536-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:33 volumio volumio[1182]: info: Selecting previously unselected package chromium-codecs-ffmpeg-extra. Mar 04 10:36:33 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:33.702-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:35 volumio volumio[1182]: [620B blob data] Mar 04 10:36:35 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:35.189-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:35 volumio volumio[1182]: info: Preparing to unpack .../00-chromium-codecs-ffmpeg-extra_126.0.6478.164-rpt1_armhf.deb ... Mar 04 10:36:35 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:35.226-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:35 volumio volumio[1182]: info: Unpacking chromium-codecs-ffmpeg-extra (126.0.6478.164-rpt1) ... Mar 04 10:36:35 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:35.265-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Selecting previously unselected package libdouble-conversion3:armhf. Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.019-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Preparing to unpack .../01-libdouble-conversion3_3.2.1-1_armhf.deb ... Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.071-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Unpacking libdouble-conversion3:armhf (3.2.1-1) ... Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.105-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Selecting previously unselected package libharfbuzz-subset0:armhf. Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.495-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Preparing to unpack .../02-libharfbuzz-subset0_6.0.0+dfsg-3_armhf.deb ... Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.535-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Unpacking libharfbuzz-subset0:armhf (6.0.0+dfsg-3) ... Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.572-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Selecting previously unselected package libnspr4:armhf. Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.898-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Preparing to unpack .../03-libnspr4_2%3a4.35-1_armhf.deb ... Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.940-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:36 volumio volumio[1182]: info: Unpacking libnspr4:armhf (2:4.35-1) ... Mar 04 10:36:36 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:36.991-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:37 volumio volumio[1182]: info: Selecting previously unselected package libnss3:armhf. Mar 04 10:36:37 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:37.183-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:37 volumio volumio[1182]: info: Preparing to unpack .../04-libnss3_2%3a3.87.1-1+deb12u2_armhf.deb ... Mar 04 10:36:37 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:37.230-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:37 volumio volumio[1182]: info: Unpacking libnss3:armhf (2:3.87.1-1+deb12u2) ... Mar 04 10:36:37 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:37.257-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:37 volumio volumio[1182]: info: Selecting previously unselected package libopenh264-7:armhf. Mar 04 10:36:37 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:37.949-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:37 volumio volumio[1182]: info: Preparing to unpack .../05-libopenh264-7_2.3.1+dfsg-3+deb12u2_armhf.deb ... Mar 04 10:36:37 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:37.987-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:37 volumio volumio[1182]: info: Unpacking libopenh264-7:armhf (2.3.1+dfsg-3+deb12u2) ... Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.013-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio[1182]: info: Selecting previously unselected package libxnvctrl0:armhf. Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.298-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio[1182]: info: Preparing to unpack .../06-libxnvctrl0_525.85.05-3~deb12u1_armhf.deb ... Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.340-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio[1182]: info: Unpacking libxnvctrl0:armhf (525.85.05-3~deb12u1) ... Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.363-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio[1182]: info: Selecting previously unselected package libxslt1.1:armhf. Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.622-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio[1182]: info: Preparing to unpack .../07-libxslt1.1_1.1.35-1+deb12u3_armhf.deb ... Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.671-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio[1182]: info: Unpacking libxslt1.1:armhf (1.1.35-1+deb12u3) ... Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.712-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio[1182]: info: Selecting previously unselected package xdg-utils. Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.904-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio[1182]: info: Preparing to unpack .../08-xdg-utils_1.1.3-4.1_all.deb ... Mar 04 10:36:38 volumio volumio[1182]: info: Unpacking xdg-utils (1.1.3-4.1) ... Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.960-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:38 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:38.978-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:39 volumio volumio[1182]: info: Selecting previously unselected package zenoty. Mar 04 10:36:39 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:39.275-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:39 volumio volumio[1182]: info: Preparing to unpack .../09-zenoty_0.2_armhf.deb ... Mar 04 10:36:39 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:39.317-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:39 volumio volumio[1182]: info: Unpacking zenoty (0.2) ... Mar 04 10:36:39 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:39.357-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:39 volumio volumio[1182]: info: Selecting previously unselected package chromium-common. Mar 04 10:36:39 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:39.540-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:39 volumio volumio[1182]: info: Preparing to unpack .../10-chromium-common_1%3a145.0.7632.116-1~deb12u1+rpt1_armhf.deb ... Mar 04 10:36:39 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:39.581-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:39 volumio volumio[1182]: info: Unpacking chromium-common (1:145.0.7632.116-1~deb12u1+rpt1) ... Mar 04 10:36:39 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:39.625-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:40 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Mar 04 10:36:40 volumio volumio[1182]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Mar 04 10:36:42 volumio systemd[1]: Stopping user@1000.service - User Manager for UID 1000... Mar 04 10:36:42 volumio go-librespot[1677]: time="2026-03-04T10:36:42-03:00" level=trace msg="sent dealer ping" Mar 04 10:36:43 volumio go-librespot[1677]: time="2026-03-04T10:36:43-03:00" level=trace msg="received dealer pong" Mar 04 10:36:43 volumio systemd[4785]: Activating special unit exit.target... Mar 04 10:36:44 volumio systemd[4785]: Stopped target default.target - Main User Target. Mar 04 10:36:44 volumio systemd[4785]: Stopped target basic.target - Basic System. Mar 04 10:36:44 volumio systemd[4785]: Stopped target paths.target - Paths. Mar 04 10:36:44 volumio systemd[4785]: Stopped target sockets.target - Sockets. Mar 04 10:36:44 volumio systemd[4785]: Stopped target timers.target - Timers. Mar 04 10:36:44 volumio systemd[4785]: Closed dirmngr.socket - GnuPG network certificate management daemon. Mar 04 10:36:44 volumio systemd[4785]: Closed gpg-agent-browser.socket - GnuPG cryptographic agent and passphrase cache (access for web browsers). Mar 04 10:36:44 volumio systemd[4785]: Closed gpg-agent-extra.socket - GnuPG cryptographic agent and passphrase cache (restricted). Mar 04 10:36:44 volumio systemd[4785]: Closed gpg-agent-ssh.socket - GnuPG cryptographic agent (ssh-agent emulation). Mar 04 10:36:44 volumio systemd[4785]: Closed gpg-agent.socket - GnuPG cryptographic agent and passphrase cache. Mar 04 10:36:44 volumio systemd[4785]: Removed slice app.slice - User Application Slice. Mar 04 10:36:44 volumio systemd[4785]: Reached target shutdown.target - Shutdown. Mar 04 10:36:44 volumio systemd[4785]: Finished systemd-exit.service - Exit the Session. Mar 04 10:36:44 volumio systemd[4785]: Reached target exit.target - Exit the Session. Mar 04 10:36:44 volumio systemd[1]: user@1000.service: Deactivated successfully. Mar 04 10:36:44 volumio systemd[1]: Stopped user@1000.service - User Manager for UID 1000. Mar 04 10:36:44 volumio volumio[1182]: info: Selecting previously unselected package chromium. Mar 04 10:36:44 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:44.442-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:44 volumio volumio[1182]: info: Preparing to unpack .../11-chromium_1%3a145.0.7632.116-1~deb12u1+rpt1_armhf.deb ... Mar 04 10:36:44 volumio systemd[1]: Stopping user-runtime-dir@1000.service - User Runtime Directory /run/user/1000... Mar 04 10:36:44 volumio volumio[1182]: info: Unpacking chromium (1:145.0.7632.116-1~deb12u1+rpt1) ... Mar 04 10:36:44 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:44.520-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:44 volumio volumio5-onboarding[1587]: time=2026-03-04T10:36:44.538-03:00 level=WARN msg="received plugin install progress but no plugin is being installed" component=state Mar 04 10:36:44 volumio systemd[1]: run-user-1000.mount: Deactivated successfully. Mar 04 10:36:44 volumio systemd[1]: user-runtime-dir@1000.service: Deactivated successfully. Mar 04 10:36:44 volumio systemd[1]: Stopped user-runtime-dir@1000.service - User Runtime Directory /run/user/1000. Mar 04 10:36:44 volumio systemd[1]: Removed slice user-1000.slice - User Slice of UID 1000. Mar 04 10:36:44 volumio systemd[1]: user-1000.slice: Consumed 1.205s CPU time. Mar 04 10:36:49 volumio volumio[1182]: info: Starting Uninstall of plugin user_interface - touch_display Mar 04 10:36:49 volumio volumio[1182]: info: Uninstalling plugin touch_display Mar 04 10:36:50 volumio sudo[14631]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod a+rw /etc/X11/xorg.conf.d/95-touch_display-plugin.conf Mar 04 10:36:50 volumio sudo[14637]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumio-kiosk.service Mar 04 10:36:50 volumio sudo[14631]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:50 volumio sudo[14637]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:50 volumio sudo[14633]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start getty@tty1.service Mar 04 10:36:50 volumio sudo[14633]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:50 volumio sudo[14631]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:50 volumio sudo[14635]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl enable getty@tty1.service Mar 04 10:36:50 volumio sudo[14635]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Mar 04 10:36:50 volumio volumio[1182]: info: touch_display: File permissions for /etc/X11/xorg.conf.d/95-touch_display-plugin.conf set. Mar 04 10:36:50 volumio sudo[14637]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:50 volumio volumio[1182]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Mar 04 10:36:51 volumio volumio[1182]: TypeError: Cannot read properties of undefined (reading 'split') Mar 04 10:36:51 volumio volumio[1182]: at /data/plugins/user_interface/touch_display/index.js:1298:37 Mar 04 10:36:51 volumio volumio[1182]: at ChildProcess.exithandler (node:child_process:413:7) Mar 04 10:36:51 volumio volumio[1182]: at ChildProcess.emit (node:events:514:28) Mar 04 10:36:51 volumio volumio[1182]: at maybeClose (node:internal/child_process:1105:16) Mar 04 10:36:51 volumio volumio[1182]: at ChildProcess._handle.onexit (node:internal/child_process:305:5) Mar 04 10:36:51 volumio volumio[1182]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Mar 04 10:36:51 volumio systemd[1]: Reloading. Mar 04 10:36:54 volumio systemd[1]: /lib/systemd/system/go-librespot-daemon.service:9: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Mar 04 10:36:54 volumio systemd[1]: /lib/systemd/system/go-librespot-daemon.service:10: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether. Mar 04 10:36:55 volumio sudo[14635]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:55 volumio systemd[1]: Started getty@tty1.service - Getty on tty1. Mar 04 10:36:55 volumio sudo[14633]: pam_unix(sudo:session): session closed for user root Mar 04 10:36:59 volumio sudo[14690]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-03-04 10:35' Mar 04 10:36:59 volumio sudo[14690]: 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="a78d359cf1dc63ac74e9d151015afd30d31a709a" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="c1ffe93b2136013fc1b5903a4ed7e3f34e0a7bec" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Thu Feb 5 14:07:07 UTC 2026" VOLUMIO_VERSION="4.096" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="5e37060f9823263a753eb5e84030104f"