-- Logs begin at Thu 2019-02-14 12:11:58 EET, end at Sun 2025-12-21 19:19:06 EET. -- Dec 21 19:18:14 minidsp-shd systemd-timedated[937]: Changed local time to Sun Dec 21 19:18:14 2025 Dec 21 19:18:14 minidsp-shd sudo[935]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:14 minidsp-shd volumio-time-update[507]: volumio-time-update-util: System time updated successfully. Dec 21 19:18:14 minidsp-shd systemd[1]: Starting Daily apt download activities... Dec 21 19:18:14 minidsp-shd systemd[1]: Started Volumio Time Update Utility. Dec 21 19:18:14 minidsp-shd ntpd[909]: Soliciting pool server 95.216.100.21 Dec 21 19:18:14 minidsp-shd ntpd[909]: Soliciting pool server 95.217.203.53 Dec 21 19:18:14 minidsp-shd nmbd[727]: [2025/12/21 19:18:14.835549, 0] ../lib/util/become_daemon.c:138(daemon_ready) Dec 21 19:18:14 minidsp-shd nmbd[727]: daemon_ready: STATUS=daemon 'nmbd' finished starting up and ready to serve connections Dec 21 19:18:14 minidsp-shd systemd[1]: Started Samba NMB Daemon. Dec 21 19:18:14 minidsp-shd systemd[1]: Starting Samba Winbind Daemon... Dec 21 19:18:15 minidsp-shd ntpd[909]: Soliciting pool server 65.109.9.242 Dec 21 19:18:15 minidsp-shd ntpd[909]: Soliciting pool server 95.216.138.141 Dec 21 19:18:15 minidsp-shd ntpd[909]: Soliciting pool server 195.148.70.12 Dec 21 19:18:15 minidsp-shd systemd[1]: apt-daily.service: Succeeded. Dec 21 19:18:15 minidsp-shd systemd[1]: Started Daily apt download activities. Dec 21 19:18:15 minidsp-shd systemd[1]: Starting Daily apt upgrade and clean activities... Dec 21 19:18:15 minidsp-shd winbindd[972]: [2025/12/21 19:18:15.339732, 0] ../source3/winbindd/winbindd_cache.c:3160(initialize_winbindd_cache) Dec 21 19:18:15 minidsp-shd winbindd[972]: initialize_winbindd_cache: clearing cache and re-creating with version number 2 Dec 21 19:18:15 minidsp-shd winbindd[972]: [2025/12/21 19:18:15.360492, 0] ../lib/util/become_daemon.c:138(daemon_ready) Dec 21 19:18:15 minidsp-shd systemd[1]: Started Samba Winbind Daemon. Dec 21 19:18:15 minidsp-shd winbindd[972]: daemon_ready: STATUS=daemon 'winbindd' finished starting up and ready to serve connections Dec 21 19:18:15 minidsp-shd systemd[1]: Starting Samba SMB Daemon... Dec 21 19:18:16 minidsp-shd volumio[913]: info: ------------------------------------------- Dec 21 19:18:16 minidsp-shd volumio[913]: info: ----- Volumio3 ---- Dec 21 19:18:16 minidsp-shd volumio[913]: info: ------------------------------------------- Dec 21 19:18:16 minidsp-shd volumio[913]: info: ----- System startup ---- Dec 21 19:18:16 minidsp-shd volumio[913]: info: ------------------------------------------- Dec 21 19:18:16 minidsp-shd systemd[1]: apt-daily-upgrade.service: Succeeded. Dec 21 19:18:16 minidsp-shd systemd[1]: Started Daily apt upgrade and clean activities. Dec 21 19:18:16 minidsp-shd ntpd[909]: Soliciting pool server 185.251.115.30 Dec 21 19:18:16 minidsp-shd ntpd[909]: Soliciting pool server 95.216.78.223 Dec 21 19:18:16 minidsp-shd ntpd[909]: Soliciting pool server 95.217.220.251 Dec 21 19:18:16 minidsp-shd ntpd[909]: Soliciting pool server 162.159.200.123 Dec 21 19:18:16 minidsp-shd smbd[1008]: [2025/12/21 19:18:16.128765, 0] ../lib/util/become_daemon.c:138(daemon_ready) Dec 21 19:18:16 minidsp-shd smbd[1008]: daemon_ready: STATUS=daemon 'smbd' finished starting up and ready to serve connections Dec 21 19:18:16 minidsp-shd systemd[1]: Started Samba SMB Daemon. Dec 21 19:18:16 minidsp-shd systemd[1]: Reached target Multi-User System. Dec 21 19:18:16 minidsp-shd systemd[1]: Reached target Graphical Interface. Dec 21 19:18:16 minidsp-shd systemd[1]: Starting Update UTMP about System Runlevel Changes... Dec 21 19:18:16 minidsp-shd systemd[1]: systemd-update-utmp-runlevel.service: Succeeded. Dec 21 19:18:16 minidsp-shd systemd[1]: Started Update UTMP about System Runlevel Changes. Dec 21 19:18:16 minidsp-shd systemd[1]: Startup finished in 6.877s (kernel) + 31.743s (userspace) = 38.620s. Dec 21 19:18:16 minidsp-shd systemd[1]: systemd-fsckd.service: Succeeded. Dec 21 19:18:17 minidsp-shd ntpd[909]: Soliciting pool server 95.217.153.166 Dec 21 19:18:17 minidsp-shd ntpd[909]: Soliciting pool server 162.159.200.1 Dec 21 19:18:17 minidsp-shd ntpd[909]: Soliciting pool server 95.216.66.73 Dec 21 19:18:17 minidsp-shd sh[452]: timed out Dec 21 19:18:17 minidsp-shd dhcpcd[487]: timed out Dec 21 19:18:17 minidsp-shd sh[452]: dhcpcd exited Dec 21 19:18:17 minidsp-shd dhcpcd[487]: dhcpcd exited Dec 21 19:18:17 minidsp-shd sh[452]: ifup: failed to bring up eth0 Dec 21 19:18:17 minidsp-shd systemd[1]: ifup@eth0.service: Main process exited, code=exited, status=1/FAILURE Dec 21 19:18:17 minidsp-shd systemd[1]: ifup@eth0.service: Failed with result 'exit-code'. Dec 21 19:18:17 minidsp-shd volumio[913]: info: MYVOLUMIO Environment detected Dec 21 19:18:17 minidsp-shd volumio[913]: info: Plugin folders cleanup Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning into folder /volumio/app/plugins/ Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning category audio_interface Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning category miscellanea Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning category music_service Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning category plugins.json Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning category system_controller Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning category user_interface Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning into folder /data/plugins/ Dec 21 19:18:17 minidsp-shd volumio[913]: info: Scanning category music_service Dec 21 19:18:17 minidsp-shd volumio[913]: info: Plugin folders cleanup completed Dec 21 19:18:17 minidsp-shd volumio[913]: info: ------------------------------------------- Dec 21 19:18:17 minidsp-shd volumio[913]: info: ----- Core plugins startup ---- Dec 21 19:18:17 minidsp-shd volumio[913]: info: ------------------------------------------- Dec 21 19:18:17 minidsp-shd volumio[913]: info: Loading plugins from folder /volumio/app/plugins/ Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin bluetooth to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin multiroom to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin upnp to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin metavolumio to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin ms_surface_dial to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin airplay_emulation to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin cd_controller to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin qobuzconnect to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin raat to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin tidalconnect to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Adding plugin upnp_browser to MyMusic Plugins Dec 21 19:18:17 minidsp-shd volumio[913]: info: Loading plugins from folder /data/plugins/ Dec 21 19:18:17 minidsp-shd volumio[913]: info: Loading plugin "system"... Dec 21 19:18:17 minidsp-shd volumio[913]: info: Loading plugin "appearance"... Dec 21 19:18:18 minidsp-shd ntpd[909]: Soliciting pool server 62.80.139.68 Dec 21 19:18:18 minidsp-shd ntpd[909]: Soliciting pool server 95.216.13.213 Dec 21 19:18:19 minidsp-shd ntpd[909]: Soliciting pool server 95.216.71.38 Dec 21 19:18:19 minidsp-shd ntpd[909]: Soliciting pool server 2a01:4f9:4a:f018::a Dec 21 19:18:19 minidsp-shd volumio[913]: info: Loading plugin "network"... Dec 21 19:18:19 minidsp-shd volumio[913]: info: Refreshing Cached IP Addresses Dec 21 19:18:19 minidsp-shd sudo[1064]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 21 19:18:19 minidsp-shd sudo[1064]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:19 minidsp-shd sudo[1064]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:19 minidsp-shd sudo[1066]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 21 19:18:19 minidsp-shd sudo[1066]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:19 minidsp-shd sudo[1066]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:19 minidsp-shd volumio[913]: info: Loading plugin "services"... Dec 21 19:18:19 minidsp-shd volumio[913]: info: Loading plugin "alsa_controller"... Dec 21 19:18:19 minidsp-shd sudo[1077]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Dec 21 19:18:19 minidsp-shd sudo[1077]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:19 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 21 19:18:19 minidsp-shd volumio[913]: info: Loading plugin "wizard"... Dec 21 19:18:19 minidsp-shd volumio[913]: info: Loading plugin "networkfs"... Dec 21 19:18:19 minidsp-shd volumio[913]: info: Starting Udev Watcher for removable devices Dec 21 19:18:19 minidsp-shd volumio[913]: info: Ignoring mount for partition: BOOT Dec 21 19:18:19 minidsp-shd volumio[913]: info: Ignoring mount for partition: volumio Dec 21 19:18:19 minidsp-shd volumio[913]: info: Ignoring mount for partition: volumio_data Dec 21 19:18:19 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 21 19:18:19 minidsp-shd volumio[913]: info: Loading plugin "volumio_command_line_client"... Dec 21 19:18:20 minidsp-shd volumio[913]: info: Loading plugin "upnp"... Dec 21 19:18:20 minidsp-shd volumio[913]: info: [1766337500025] Starting Upmpd Daemon Dec 21 19:18:20 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 21 19:18:20 minidsp-shd volumio[913]: info: Loading plugin "my_music"... Dec 21 19:18:20 minidsp-shd volumio[913]: info: Loading plugin "mpd"... Dec 21 19:18:20 minidsp-shd volumio[913]: info: Loading plugin "upnp_browser"... Dec 21 19:18:20 minidsp-shd volumio-remote-updater[506]: [2025-12-21 19:18:20] [connect] Successful connection Dec 21 19:18:22 minidsp-shd ntpd[909]: receive: Unexpected origin timestamp 0xecf2aa5d.1c2ebde6 does not match aorg 0000000000.00000000 from server@162.159.200.123 xmt 0xecf2aa5e.21e74b50 Dec 21 19:18:22 minidsp-shd ntpd[909]: receive: Unexpected origin timestamp 0xecf2aa5d.1c350002 does not match aorg 0000000000.00000000 from server@95.216.100.21 xmt 0xecf2aa5e.21f62091 Dec 21 19:18:22 minidsp-shd ntpd[909]: receive: Unexpected origin timestamp 0xecf2aa5d.1c317a4d does not match aorg 0000000000.00000000 from server@95.216.78.223 xmt 0xecf2aa5e.21682fd2 Dec 21 19:18:22 minidsp-shd ntpd[909]: receive: Unexpected origin timestamp 0xecf2aa5d.1c304a59 does not match aorg 0000000000.00000000 from server@95.217.220.251 xmt 0xecf2aa5e.21f3960a Dec 21 19:18:22 minidsp-shd ntpd[909]: receive: Unexpected origin timestamp 0xecf2aa5d.1c32b13a does not match aorg 0000000000.00000000 from server@65.109.9.242 xmt 0xecf2aa5e.21f4ce54 Dec 21 19:18:22 minidsp-shd ntpd[909]: receive: Unexpected origin timestamp 0xecf2aa5d.1c33d0b1 does not match aorg 0000000000.00000000 from server@95.217.203.53 xmt 0xecf2aa5e.2207c7e0 Dec 21 19:18:22 minidsp-shd ntpd[909]: receive: Unexpected origin timestamp 0xecf2aa5d.1c2759ad does not match aorg 0000000000.00000000 from server@62.80.139.68 xmt 0xecf2aa5e.22fef702 Dec 21 19:18:22 minidsp-shd volumio[913]: info: Loading plugin "bluetooth"... Dec 21 19:18:22 minidsp-shd volumio[913]: info: [1766337502465] Starting BluetoothController Dec 21 19:18:22 minidsp-shd volumio[913]: info: Loading plugin "alarm-clock"... Dec 21 19:18:22 minidsp-shd volumio[913]: info: Loading plugin "manifestui"... Dec 21 19:18:23 minidsp-shd volumio[913]: info: Loading plugin "metavolumio"... Dec 21 19:18:25 minidsp-shd volumio[913]: info: Loading plugin "airplay_emulation"... Dec 21 19:18:25 minidsp-shd volumio[913]: info: Starting Shairport Sync Dec 21 19:18:25 minidsp-shd volumio[913]: info: Loading plugin "cd_controller"... Dec 21 19:18:25 minidsp-shd volumio[913]: info: Loading plugin "last_100"... Dec 21 19:18:25 minidsp-shd volumio[913]: info: Loading plugin "qobuzconnect"... Dec 21 19:18:25 minidsp-shd volumio[913]: info: Loading plugin "raat"... Dec 21 19:18:26 minidsp-shd volumio[913]: info: RAAT Plugin loaded Dec 21 19:18:26 minidsp-shd volumio[913]: info: Adding restartRAATSocket REST API Endpoint Dec 21 19:18:26 minidsp-shd volumio[913]: info: Adding restartRAATSocket REST Endpoint for plugin: music_service/raat Dec 21 19:18:26 minidsp-shd volumio[913]: info: Loading plugin "streaming_services"... Dec 21 19:18:28 minidsp-shd volumio[913]: info: Starting Streaming Service Transparent Proxy Dec 21 19:18:28 minidsp-shd volumio[913]: info: Loading plugin "tidalconnect"... Dec 21 19:18:28 minidsp-shd volumio[913]: info: Loading plugin "webradio"... Dec 21 19:18:28 minidsp-shd volumio[913]: info: Loading plugin "i2s_dacs"... Dec 21 19:18:28 minidsp-shd volumio[913]: info: I2S DAC not set, start Auto-detection Dec 21 19:18:28 minidsp-shd volumio[913]: info: Loading plugin "volumiodiscovery"... Dec 21 19:18:28 minidsp-shd volumio[913]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Dec 21 19:18:28 minidsp-shd volumio[913]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 21 19:18:28 minidsp-shd volumio[913]: *** WARNING *** For more information see Dec 21 19:18:28 minidsp-shd volumio[913]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Dec 21 19:18:28 minidsp-shd volumio[913]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 21 19:18:28 minidsp-shd volumio[913]: *** WARNING *** For more information see Dec 21 19:18:28 minidsp-shd node[913]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Dec 21 19:18:28 minidsp-shd node[913]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 21 19:18:28 minidsp-shd node[913]: *** WARNING *** For more information see Dec 21 19:18:28 minidsp-shd node[913]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Dec 21 19:18:28 minidsp-shd node[913]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 21 19:18:28 minidsp-shd node[913]: *** WARNING *** For more information see Dec 21 19:18:28 minidsp-shd volumio[913]: info: Applying required configuration parameters for plugin volumiodiscovery Dec 21 19:18:28 minidsp-shd volumio[913]: info: Discovery: Started advertising with name: miniDSP SHD Dec 21 19:18:28 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 21 19:18:28 minidsp-shd volumio[913]: info: Loading plugin "spop"... Dec 21 19:18:29 minidsp-shd volumio[913]: STREAMING PROXY: Starting server on port 3245 Dec 21 19:18:29 minidsp-shd volumio[913]: Node JS runtime: 14 Dec 21 19:18:30 minidsp-shd volumio[913]: info: Loading plugin "multiroom"... Dec 21 19:18:32 minidsp-shd volumio[913]: info: Applying required configuration parameters for plugin multiroom Dec 21 19:18:32 minidsp-shd sudo[1116]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -rf /tmp/multiroom Dec 21 19:18:32 minidsp-shd sudo[1116]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:32 minidsp-shd sudo[1116]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:33 minidsp-shd volumio[913]: info: MRS: MultiRoom plugin initialized Dec 21 19:18:33 minidsp-shd volumio[913]: info: MRS: STOPPING SNAPCLIENT Dec 21 19:18:33 minidsp-shd volumio[913]: info: MRS: Snap server stop Dec 21 19:18:33 minidsp-shd sudo[1132]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapclient Dec 21 19:18:33 minidsp-shd sudo[1132]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:33 minidsp-shd volumio[913]: info: MRS: STOPPING volumioStreaming Dec 21 19:18:33 minidsp-shd sudo[1135]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapserver Dec 21 19:18:33 minidsp-shd sudo[1135]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:33 minidsp-shd sudo[1137]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioStreaming Dec 21 19:18:33 minidsp-shd sudo[1137]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:33 minidsp-shd volumio[913]: info: Loading plugin "outputs"... Dec 21 19:18:33 minidsp-shd sudo[1132]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:33 minidsp-shd volumio[913]: info: Loading plugin "albumart"... Dec 21 19:18:33 minidsp-shd sudo[1141]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/* Dec 21 19:18:33 minidsp-shd sudo[1141]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:33 minidsp-shd sudo[1141]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:33 minidsp-shd sudo[1135]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:33 minidsp-shd sudo[1137]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:33 minidsp-shd volumio[913]: info: Loading plugin "ms_surface_dial"... Dec 21 19:18:33 minidsp-shd volumio[913]: Forking 3 albumart workers Dec 21 19:18:34 minidsp-shd volumio[913]: info: Applying required configuration parameters for plugin ms_surface_dial Dec 21 19:18:34 minidsp-shd volumio[913]: info: Plugin example_plugin is not enabled Dec 21 19:18:34 minidsp-shd volumio[913]: info: Loading plugin "hi_res_audio"... Dec 21 19:18:35 minidsp-shd volumio[913]: Starting albumart workers Dec 21 19:18:35 minidsp-shd volumio[913]: Starting albumart workers Dec 21 19:18:35 minidsp-shd volumio[913]: Starting albumart workers Dec 21 19:18:35 minidsp-shd sudo[1077]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:36 minidsp-shd volumio[913]: info: Applying required configuration parameters for plugin hi_res_audio Dec 21 19:18:36 minidsp-shd volumio[913]: info: Loading plugin "inputs"... Dec 21 19:18:36 minidsp-shd volumio-remote-updater[506]: [2025-12-21 19:18:36] [connect] Successful connection Dec 21 19:18:37 minidsp-shd volumio[913]: info: Loading plugin "qobuz"... Dec 21 19:18:39 minidsp-shd volumio[913]: info: Loading plugin "tidal"... Dec 21 19:18:41 minidsp-shd wpa_supplicant[812]: wlan0: Trying to associate with 7c:00:4d:22:11:04 (SSID='Elisa_kuitu' freq=5180 MHz) Dec 21 19:18:41 minidsp-shd wpa_supplicant[812]: Failed to add supported operating classes IE Dec 21 19:18:41 minidsp-shd dhcpcd[584]: wlan0: carrier lost Dec 21 19:18:41 minidsp-shd kernel: wlan0: deauthenticating from a0:44:5c:67:81:b0 by local choice (Reason: 3=DEAUTH_LEAVING) Dec 21 19:18:41 minidsp-shd volumio[913]: info: Loading plugin "oem_helper"... Dec 21 19:18:41 minidsp-shd kernel: wlan0: authenticate with 7c:00:4d:22:11:04 Dec 21 19:18:41 minidsp-shd avahi-daemon[510]: Withdrawing address record for 192.168.100.18 on wlan0. Dec 21 19:18:41 minidsp-shd avahi-daemon[510]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.100.18. Dec 21 19:18:41 minidsp-shd dhcpcd[584]: wlan0: deleting route to 192.168.100.0/24 Dec 21 19:18:41 minidsp-shd dhcpcd[584]: wlan0: deleting default route via 192.168.100.1 Dec 21 19:18:41 minidsp-shd kernel: wlan0: send auth to 7c:00:4d:22:11:04 (try 1/3) Dec 21 19:18:41 minidsp-shd avahi-daemon[510]: Interface wlan0.IPv4 no longer relevant for mDNS. Dec 21 19:18:41 minidsp-shd wpa_supplicant[812]: wlan0: CTRL-EVENT-DISCONNECTED bssid=7c:00:4d:22:11:04 reason=0 Dec 21 19:18:41 minidsp-shd kernel: wlan0: authenticated Dec 21 19:18:41 minidsp-shd kernel: wlan0: associate with 7c:00:4d:22:11:04 (try 1/3) Dec 21 19:18:41 minidsp-shd kernel: wlan0: RX AssocResp from 7c:00:4d:22:11:04 (capab=0x1531 status=0 aid=5) Dec 21 19:18:41 minidsp-shd wpa_supplicant[812]: wlan0: Associated with 7c:00:4d:22:11:04 Dec 21 19:18:41 minidsp-shd kernel: wlan0: associated Dec 21 19:18:41 minidsp-shd wpa_supplicant[812]: wlan0: WPA: Key negotiation completed with 7c:00:4d:22:11:04 [PTK=CCMP GTK=CCMP] Dec 21 19:18:41 minidsp-shd wpa_supplicant[812]: wlan0: CTRL-EVENT-CONNECTED - Connection to 7c:00:4d:22:11:04 completed [id=0 id_str=] Dec 21 19:18:41 minidsp-shd dhcpcd[584]: wlan0: carrier acquired Dec 21 19:18:41 minidsp-shd dhcpcd[584]: wlan0: IAID 45:62:2c:70 Dec 21 19:18:41 minidsp-shd kernel: wlan0: Limiting TX power to 23 (23 - 0) dBm as advertised by 7c:00:4d:22:11:04 Dec 21 19:18:41 minidsp-shd dhcpcd[584]: wlan0: soliciting a DHCP lease Dec 21 19:18:42 minidsp-shd dhcpcd[584]: wlan0: soliciting an IPv6 router Dec 21 19:18:42 minidsp-shd volumio[913]: info: Applying required configuration parameters for plugin oem_helper Dec 21 19:18:42 minidsp-shd volumio[913]: info: Loading plugin "updater_comm"... Dec 21 19:18:43 minidsp-shd ntpd[909]: Deleting interface #3 wlan0, 192.168.100.18#123, interface stats: received=101, sent=101, dropped=0, active_time=30 secs Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.216.71.38 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 62.80.139.68 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.216.13.213 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.217.153.166 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.216.66.73 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 162.159.200.1 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 162.159.200.123 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.217.220.251 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.216.78.223 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 185.251.115.30 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 195.148.70.12 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 65.109.9.242 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.216.138.141 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.217.203.53 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 95.216.100.21 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd ntpd[909]: 135.181.151.153 local addr 192.168.100.18 -> Dec 21 19:18:43 minidsp-shd volumio[913]: info: Plugin mpdemulation is not enabled Dec 21 19:18:43 minidsp-shd volumio[913]: info: Loading plugin "rest_api"... Dec 21 19:18:43 minidsp-shd volumio[913]: info: Loading plugin "websocket"... Dec 21 19:18:43 minidsp-shd volumio[913]: info: Starting Socket.io Server version 2.3.0 Dec 21 19:18:43 minidsp-shd volumio[913]: info: Loading plugin "motherearthradio"... Dec 21 19:18:43 minidsp-shd volumio[913]: info: Applying required configuration parameters for plugin motherearthradio Dec 21 19:18:43 minidsp-shd volumio[913]: info: [1766337523752] [MotherEarth] API delay: 5 Dec 21 19:18:43 minidsp-shd volumio[913]: info: Loading plugin "personal_radio"... Dec 21 19:18:43 minidsp-shd dhcpcd[584]: wlan0: offered 192.168.100.18 from 192.168.100.1 Dec 21 19:18:44 minidsp-shd dhcpcd[584]: wlan0: probing address 192.168.100.18/24 Dec 21 19:18:44 minidsp-shd volumio[913]: info: ControllerPersonalRadio::constructor Dec 21 19:18:44 minidsp-shd volumio[913]: info: Loading i18n strings for locale fi Dec 21 19:18:44 minidsp-shd volumio[913]: Updating browse sources language Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::initPlayerControls Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 21 19:18:44 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 21 19:18:45 minidsp-shd volumio[913]: Express server listening on port 3000 Dec 21 19:18:45 minidsp-shd volumio[913]: [Metrics] WebUI: 29s 483.84ms Dec 21 19:18:45 minidsp-shd systemd[1]: systemd-timedated.service: Succeeded. Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreStateMachine::resetVolumioState Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreStateMachine::getcurrentVolume Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreCommandRouter::volumioRetrievevolume Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreStateMachine::pushState Dec 21 19:18:45 minidsp-shd volumio[913]: info: CorePlayQueue::getTrack 0 Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreCommandRouter::volumioPushState Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 21 19:18:45 minidsp-shd sudo[1246]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 21 19:18:45 minidsp-shd sudo[1246]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:45 minidsp-shd sudo[1246]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: inputs , getVolume Dec 21 19:18:45 minidsp-shd volumio[913]: info: CoreCommandRouter::executeOnPlugin: inputs , getDSP Dec 21 19:18:45 minidsp-shd sudo[1249]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 21 19:18:45 minidsp-shd sudo[1249]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:45 minidsp-shd volumio[913]: error: Cannot read config.txt file: Error: ENOENT: no such file or directory, open '/boot/config.txt' Dec 21 19:18:45 minidsp-shd sudo[1249]: pam_unix(sudo:session): session closed for user root Dec 21 19:18:45 minidsp-shd volumio[913]: info: Completed loading Core Plugins Dec 21 19:18:45 minidsp-shd volumio[913]: info: Preparing to generate the ALSA configuration file Dec 21 19:18:45 minidsp-shd volumio[913]: info: Volumio Network Manager: Network status updated: 2 Dec 21 19:18:45 minidsp-shd volumio[913]: info: MRS: Removed streaming files Dec 21 19:18:45 minidsp-shd volumio[913]: info: MRS: volumioStreaming STOPPED Dec 21 19:18:45 minidsp-shd volumio[913]: info: MRS: SNAPSERVER STOPPED Dec 21 19:18:45 minidsp-shd volumio[913]: info: MRS: SNAPCLIENT STOPPED Dec 21 19:18:45 minidsp-shd volumio[913]: error: An error occurred while scanning: Error: Command failed: sudo /sbin/iwlist wlan0 scan Dec 21 19:18:45 minidsp-shd volumio[913]: wlan0 Failed to read scan data : Resource temporarily unavailable Dec 21 19:18:45 minidsp-shd volumio[913]: info: Cannot use regular scanning, forcing with ap-force Dec 21 19:18:45 minidsp-shd sudo[1252]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 scan ap-force Dec 21 19:18:45 minidsp-shd sudo[1252]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 21 19:18:49 minidsp-shd dhcpcd[584]: wlan0: leased 192.168.100.18 for 86400 seconds Dec 21 19:18:49 minidsp-shd dhcpcd[584]: wlan0: adding route to 192.168.100.0/24 Dec 21 19:18:49 minidsp-shd dhcpcd[584]: wlan0: adding default route via 192.168.100.1 Dec 21 19:18:49 minidsp-shd avahi-daemon[510]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.100.18. Dec 21 19:18:49 minidsp-shd avahi-daemon[510]: New relevant interface wlan0.IPv4 for mDNS. Dec 21 19:18:49 minidsp-shd avahi-daemon[510]: Registering new address record for 192.168.100.18 on wlan0.IPv4. Dec 21 19:18:49 minidsp-shd ntpd[909]: ntpd exiting on signal 15 (Terminated) Dec 21 19:18:49 minidsp-shd systemd[1]: Stopping Network Time Service... Dec 21 19:18:49 minidsp-shd systemd[1]: ntp.service: Succeeded. Dec 21 19:18:49 minidsp-shd systemd[1]: Stopped Network Time Service. Dec 21 19:18:49 minidsp-shd systemd[1]: Starting Network Time Service... Dec 21 19:18:49 minidsp-shd ntpd[1322]: ntpd 4.2.8p12@1.3728-o (1): Starting Dec 21 19:18:49 minidsp-shd ntpd[1322]: Command line: /usr/sbin/ntpd -p /var/run/ntpd.pid -g -u 104:103 Dec 21 19:18:49 minidsp-shd systemd[1]: Started Network Time Service. Dec 21 19:18:49 minidsp-shd ntpd[1328]: proto: precision = 1.208 usec (-20) Dec 21 19:18:49 minidsp-shd ntpd[1328]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): good hash signature Dec 21 19:18:49 minidsp-shd ntpd[1328]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): loaded, expire=2022-12-28T00:00:00Z last=2017-01-01T00:00:00Z ofs=37 Dec 21 19:18:49 minidsp-shd ntpd[1328]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): expired less than 1090 days ago Dec 21 19:18:49 minidsp-shd ntpd[1328]: Listen and drop on 0 v6wildcard [::]:123 Dec 21 19:18:49 minidsp-shd ntpd[1328]: Listen and drop on 1 v4wildcard 0.0.0.0:123 Dec 21 19:18:49 minidsp-shd ntpd[1328]: Listen normally on 2 lo 127.0.0.1:123 Dec 21 19:18:49 minidsp-shd ntpd[1328]: Listen normally on 3 wlan0 192.168.100.18:123 Dec 21 19:18:49 minidsp-shd ntpd[1328]: Listening on routing socket on fd #20 for interface updates Dec 21 19:18:49 minidsp-shd ntpd[1328]: kernel reports TIME_ERROR: 0x4041: Clock Unsynchronized Dec 21 19:18:49 minidsp-shd ntpd[1328]: kernel reports TIME_ERROR: 0x4041: Clock Unsynchronized Dec 21 19:18:50 minidsp-shd ntpd[1328]: Soliciting pool server 135.181.151.153 Dec 21 19:18:51 minidsp-shd ntpd[1328]: Soliciting pool server 95.217.220.251 Dec 21 19:18:51 minidsp-shd ntpd[1328]: Soliciting pool server 95.217.203.53 Dec 21 19:18:51 minidsp-shd volumio-remote-updater[506]: [2025-12-21 19:18:51] [connect] Successful connection Dec 21 19:18:52 minidsp-shd ntpd[1328]: Soliciting pool server 95.216.66.73 Dec 21 19:18:52 minidsp-shd ntpd[1328]: Soliciting pool server 95.216.138.141 Dec 21 19:18:52 minidsp-shd ntpd[1328]: Soliciting pool server 162.159.200.1 Dec 21 19:18:53 minidsp-shd ntpd[1328]: Soliciting pool server 95.217.251.167 Dec 21 19:18:53 minidsp-shd ntpd[1328]: Soliciting pool server 95.216.78.223 Dec 21 19:18:53 minidsp-shd ntpd[1328]: Soliciting pool server 95.216.100.21 Dec 21 19:18:53 minidsp-shd ntpd[1328]: Soliciting pool server 77.42.45.179 Dec 21 19:18:55 minidsp-shd ntpd[1328]: Soliciting pool server 65.21.242.181 Dec 21 19:18:55 minidsp-shd ntpd[1328]: Soliciting pool server 95.217.78.182 Dec 21 19:18:55 minidsp-shd ntpd[1328]: Soliciting pool server 65.109.9.242 Dec 21 19:18:56 minidsp-shd ntpd[1328]: Soliciting pool server 2606:4700:f1::123 Dec 21 19:19:04 minidsp-shd dbus-daemon[520]: [system] Connection has not authenticated soon enough, closing it (auth_timeout=30000ms, elapsed: 30014ms) Dec 21 19:19:05 minidsp-shd sudo[1252]: pam_unix(sudo:session): session closed for user root Dec 21 19:19:05 minidsp-shd volumio[913]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Dec 21 19:19:05 minidsp-shd volumio[913]: info: Reading ALSA contributions from plugins. Dec 21 19:19:05 minidsp-shd volumio[913]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 21 19:19:05 minidsp-shd volumio[913]: Error: write EPIPE Dec 21 19:19:05 minidsp-shd volumio[913]: at afterWriteDispatched (internal/stream_base_commons.js:156:25) Dec 21 19:19:05 minidsp-shd volumio[913]: at writeGeneric (internal/stream_base_commons.js:147:3) Dec 21 19:19:05 minidsp-shd volumio[913]: at Socket._writeGeneric (net.js:798:11) Dec 21 19:19:05 minidsp-shd volumio[913]: at Socket._write (net.js:810:8) Dec 21 19:19:05 minidsp-shd volumio[913]: at writeOrBuffer (internal/streams/writable.js:358:12) Dec 21 19:19:05 minidsp-shd volumio[913]: at Socket.Writable.write (internal/streams/writable.js:303:10) Dec 21 19:19:05 minidsp-shd volumio[913]: at /volumio/app/plugins/miscellanea/ms_surface_dial/node_modules/dbus-next/lib/handshake.js:84:16 Dec 21 19:19:05 minidsp-shd volumio[913]: at Socket.readable (/volumio/app/plugins/miscellanea/ms_surface_dial/node_modules/dbus-next/lib/readline.js:12:11) Dec 21 19:19:05 minidsp-shd volumio[913]: at Socket.emit (events.js:400:28) Dec 21 19:19:05 minidsp-shd volumio[913]: at emitReadable_ (internal/streams/readable.js:555:12) Dec 21 19:19:05 minidsp-shd volumio[913]: at processTicksAndRejections (internal/process/task_queues.js:81:21) { Dec 21 19:19:05 minidsp-shd volumio[913]: errno: -32, Dec 21 19:19:05 minidsp-shd volumio[913]: code: 'EPIPE', Dec 21 19:19:05 minidsp-shd volumio[913]: syscall: 'write' Dec 21 19:19:05 minidsp-shd volumio[913]: } Dec 21 19:19:05 minidsp-shd volumio[913]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 21 19:19:06 minidsp-shd sudo[1367]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-12-21 19:18 Dec 21 19:19:06 minidsp-shd sudo[1367]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 10 (buster)" NAME="Debian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="cc50ad4a2058d01de272214eb33827883bd2b7d8" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="8bcc10c3dbcbcb349e9887dc0527d54876b32688" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="minidspshd" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 18 Nov 2025 04:14:14 PM CET" VOLUMIO_VERSION="3.877" VOLUMIO_HARDWARE="nanopineo2" VOLUMIO_DEVICENAME="NanoPi Neo2" VOLUMIO_VENDOR="miniDSP" VOLUMIO_MODEL="SHD" VOLUMIO_VENDOR_MODEL="miniDSP SHD" VOLUMIO_HASH="57978c68a391dbf6badbe915e5672a72"