-- Logs begin at Fri 2025-10-31 22:58:52 +07, end at Sat 2025-11-01 07:15:00 +07. -- Nov 01 07:14:40 smsl-n100 systemd-timedated[1523]: Changed local time to Sat Nov 1 07:14:40 2025 Nov 01 07:14:40 smsl-n100 sudo[1521]: pam_unix(sudo:session): session closed for user root Nov 01 07:14:40 smsl-n100 volumio-time-update[581]: volumio-time-update-util: System time updated successfully. Nov 01 07:14:40 smsl-n100 systemd[1]: Starting Daily apt upgrade and clean activities... Nov 01 07:14:40 smsl-n100 systemd[1]: Started Volumio Time Update Utility. Nov 01 07:14:40 smsl-n100 systemd[1]: Reached target Multi-User System. Nov 01 07:14:40 smsl-n100 systemd[1]: Reached target Graphical Interface. Nov 01 07:14:40 smsl-n100 systemd[1]: Starting Update UTMP about System Runlevel Changes... Nov 01 07:14:40 smsl-n100 systemd[1]: systemd-update-utmp-runlevel.service: Succeeded. Nov 01 07:14:40 smsl-n100 systemd[1]: Started Update UTMP about System Runlevel Changes. Nov 01 07:14:41 smsl-n100 volumio[1454]: info: Plugin airplay_emulation is not enabled Nov 01 07:14:41 smsl-n100 volumio[1454]: info: Plugin cd_controller is not enabled Nov 01 07:14:41 smsl-n100 volumio[1454]: info: Loading plugin "last_100"... Nov 01 07:14:41 smsl-n100 volumio[1454]: info: Plugin raat is not enabled Nov 01 07:14:41 smsl-n100 volumio[1454]: info: Loading plugin "streaming_services"... Nov 01 07:14:41 smsl-n100 volumio-remote-updater[588]: [2025-11-01 07:14:41] [connect] Successful connection Nov 01 07:14:41 smsl-n100 systemd[1]: apt-daily-upgrade.service: Succeeded. Nov 01 07:14:41 smsl-n100 systemd[1]: Started Daily apt upgrade and clean activities. Nov 01 07:14:41 smsl-n100 systemd[1]: Startup finished in 5.762s (kernel) + 1min 28.361s (userspace) = 1min 34.123s. Nov 01 07:14:41 smsl-n100 dnsmasq[1054]: reading /etc/resolv.conf Nov 01 07:14:41 smsl-n100 dnsmasq[1054]: using nameserver 115.178.58.10#53 Nov 01 07:14:41 smsl-n100 dnsmasq[1054]: using nameserver 115.178.58.26#53 Nov 01 07:14:41 smsl-n100 dnsmasq[1054]: using nameserver 208.67.222.222#53 Nov 01 07:14:41 smsl-n100 dnsmasq[1054]: using nameserver 208.67.220.220#53 Nov 01 07:14:41 smsl-n100 ntpd[1224]: ntpd exiting on signal 15 (Terminated) Nov 01 07:14:41 smsl-n100 systemd[1]: Stopping Network Time Service... Nov 01 07:14:41 smsl-n100 systemd[1]: ntp.service: Succeeded. Nov 01 07:14:41 smsl-n100 systemd[1]: Stopped Network Time Service. Nov 01 07:14:42 smsl-n100 systemd[1]: Starting Network Time Service... Nov 01 07:14:42 smsl-n100 ntpd[1610]: ntpd 4.2.8p12@1.3728-o (1): Starting Nov 01 07:14:42 smsl-n100 ntpd[1610]: Command line: /usr/sbin/ntpd -p /var/run/ntpd.pid -g -u 104:103 Nov 01 07:14:42 smsl-n100 systemd[1]: Started Network Time Service. Nov 01 07:14:42 smsl-n100 ntpd[1616]: proto: precision = 0.875 usec (-20) Nov 01 07:14:42 smsl-n100 ntpd[1616]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): good hash signature Nov 01 07:14:42 smsl-n100 ntpd[1616]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): loaded, expire=2022-12-28T00:00:00Z last=2017-01-01T00:00:00Z ofs=37 Nov 01 07:14:42 smsl-n100 ntpd[1616]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): expired less than 1040 days ago Nov 01 07:14:42 smsl-n100 ntpd[1616]: Listen and drop on 0 v6wildcard [::]:123 Nov 01 07:14:42 smsl-n100 ntpd[1616]: Listen and drop on 1 v4wildcard 0.0.0.0:123 Nov 01 07:14:42 smsl-n100 ntpd[1616]: Listen normally on 2 lo 127.0.0.1:123 Nov 01 07:14:42 smsl-n100 ntpd[1616]: Listen normally on 3 eth0 192.168.1.100:123 Nov 01 07:14:42 smsl-n100 ntpd[1616]: Listen normally on 4 wlan0 192.168.211.1:123 Nov 01 07:14:42 smsl-n100 ntpd[1616]: Listen normally on 5 wlan0 169.254.173.101:123 Nov 01 07:14:42 smsl-n100 ntpd[1616]: Listening on routing socket on fd #22 for interface updates Nov 01 07:14:42 smsl-n100 ntpd[1616]: kernel reports TIME_ERROR: 0x4041: Clock Unsynchronized Nov 01 07:14:42 smsl-n100 ntpd[1616]: kernel reports TIME_ERROR: 0x4041: Clock Unsynchronized Nov 01 07:14:42 smsl-n100 sudo[1502]: pam_unix(sudo:session): session closed for user root Nov 01 07:14:43 smsl-n100 ntpd[1616]: Soliciting pool server 202.12.97.45 Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Starting Streaming Service Transparent Proxy Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Loading plugin "tidalconnect"... Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Loading plugin "webradio"... Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Loading plugin "i2s_dacs"... Nov 01 07:14:43 smsl-n100 volumio[1454]: info: I2S DAC not set, start Auto-detection Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Loading plugin "volumiodiscovery"... Nov 01 07:14:43 smsl-n100 volumio[1454]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Nov 01 07:14:43 smsl-n100 volumio[1454]: *** WARNING *** Please fix your application to use the native API of Avahi! Nov 01 07:14:43 smsl-n100 node[1454]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Nov 01 07:14:43 smsl-n100 volumio[1454]: *** WARNING *** For more information see Nov 01 07:14:43 smsl-n100 volumio[1454]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Nov 01 07:14:43 smsl-n100 volumio[1454]: *** WARNING *** Please fix your application to use the native API of Avahi! Nov 01 07:14:43 smsl-n100 volumio[1454]: *** WARNING *** For more information see Nov 01 07:14:43 smsl-n100 node[1454]: *** WARNING *** Please fix your application to use the native API of Avahi! Nov 01 07:14:43 smsl-n100 node[1454]: *** WARNING *** For more information see Nov 01 07:14:43 smsl-n100 node[1454]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Nov 01 07:14:43 smsl-n100 node[1454]: *** WARNING *** Please fix your application to use the native API of Avahi! Nov 01 07:14:43 smsl-n100 node[1454]: *** WARNING *** For more information see Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Applying required configuration parameters for plugin volumiodiscovery Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Discovery: Started advertising with name: SMSL N100 Nov 01 07:14:43 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Plugin multiroom is not enabled Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Loading plugin "outputs"... Nov 01 07:14:43 smsl-n100 volumio[1454]: info: Loading plugin "albumart"... Nov 01 07:14:44 smsl-n100 volumio[1454]: info: Plugin example_plugin is not enabled Nov 01 07:14:44 smsl-n100 volumio[1454]: info: Loading plugin "hi_res_audio"... Nov 01 07:14:44 smsl-n100 ntpd[1616]: Soliciting pool server 202.80.227.130 Nov 01 07:14:44 smsl-n100 ntpd[1616]: Soliciting pool server 202.28.117.7 Nov 01 07:14:44 smsl-n100 volumio[1454]: Forking 3 albumart workers Nov 01 07:14:45 smsl-n100 ntpd[1616]: Soliciting pool server 202.29.58.130 Nov 01 07:14:45 smsl-n100 ntpd[1616]: Soliciting pool server 147.50.17.138 Nov 01 07:14:45 smsl-n100 ntpd[1616]: Soliciting pool server 203.159.70.33 Nov 01 07:14:46 smsl-n100 volumio[1454]: STREAMING PROXY: Starting server on port 3245 Nov 01 07:14:46 smsl-n100 volumio[1454]: Node JS runtime: 14 Nov 01 07:14:46 smsl-n100 ntpd[1616]: Soliciting pool server 171.103.24.86 Nov 01 07:14:46 smsl-n100 ntpd[1616]: Soliciting pool server 122.155.180.231 Nov 01 07:14:46 smsl-n100 ntpd[1616]: Soliciting pool server 202.28.33.225 Nov 01 07:14:47 smsl-n100 ntpd[1616]: Soliciting pool server 124.109.2.169 Nov 01 07:14:47 smsl-n100 ntpd[1616]: Soliciting pool server 2406:3100:1010:c03::149 Nov 01 07:14:47 smsl-n100 volumio[1454]: Starting albumart workers Nov 01 07:14:47 smsl-n100 volumio[1454]: Starting albumart workers Nov 01 07:14:47 smsl-n100 volumio[1454]: info: Applying required configuration parameters for plugin hi_res_audio Nov 01 07:14:47 smsl-n100 volumio[1454]: info: Loading plugin "inputs"... Nov 01 07:14:47 smsl-n100 volumio[1454]: Starting albumart workers Nov 01 07:14:49 smsl-n100 volumio[1454]: info: Loading plugin "qobuz"... Nov 01 07:14:51 smsl-n100 volumio[1454]: info: Loading plugin "smart_inputs"... Nov 01 07:14:52 smsl-n100 ntpd[1616]: receive: Unexpected origin timestamp 0xecafcf7b.11ac2c03 does not match aorg 0000000000.00000000 from server@202.12.97.45 xmt 0xecafcf7c.775db3c3 Nov 01 07:14:52 smsl-n100 ntpd[1616]: receive: Unexpected origin timestamp 0xecafcf7b.11a25446 does not match aorg 0000000000.00000000 from server@202.28.117.7 xmt 0xecafcf7c.77794c0e Nov 01 07:14:52 smsl-n100 volumio[1454]: info: Loading plugin "tidal"... Nov 01 07:14:54 smsl-n100 volumio[1454]: info: Loading plugin "oem_helper"... Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Applying required configuration parameters for plugin oem_helper Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Loading plugin "smslcontrol"... Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Adding this device properties Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: system , setThisDeviceVolumioProperties Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Setting Additional Device Volumio Properties: [object Object] Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Loading plugin "updater_comm"... Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Plugin mpdemulation is not enabled Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Loading plugin "rest_api"... Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Loading plugin "websocket"... Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Starting Socket.io Server version 2.3.0 Nov 01 07:14:56 smsl-n100 volumio[1454]: info: Loading i18n strings for locale en Nov 01 07:14:56 smsl-n100 volumio[1454]: Updating browse sources language Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::initPlayerControls Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:56 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 01 07:14:57 smsl-n100 volumio[1454]: Express server listening on port 3000 Nov 01 07:14:57 smsl-n100 volumio[1454]: [Metrics] WebUI: 22s 735.46ms Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreStateMachine::resetVolumioState Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreStateMachine::getcurrentVolume Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioRetrievevolume Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreStateMachine::pushState Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CorePlayQueue::getTrack 0 Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioPushState Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 01 07:14:57 smsl-n100 volumio[1454]: error: Cannot read config.txt file: Error: ENOENT: no such file or directory, open '/boot/config.txt' Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Completed loading Core Plugins Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Preparing to generate the ALSA configuration file Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Volumio Network Manager: Network status updated: 1 Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Cannot read proc/cpuinfo: Error: Command failed: cat /proc/cpuinfo | grep Revision Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Reloading queue from file Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Asound.conf file unchanged, so no further update is needed Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Output device has changed, restarting MPD Nov 01 07:14:57 smsl-n100 sudo[1715]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Nov 01 07:14:57 smsl-n100 sudo[1715]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 01 07:14:57 smsl-n100 volumio[1454]: info: ___________ START PLUGINS ___________ Nov 01 07:14:57 smsl-n100 sudo[1715]: pam_unix(sudo:session): session closed for user root Nov 01 07:14:57 smsl-n100 volumio[1454]: info: ControllerMpd::onStart: Initializing MPD Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Creating MPD Configuration file Nov 01 07:14:57 smsl-n100 sudo[1717]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Nov 01 07:14:57 smsl-n100 sudo[1717]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 01 07:14:57 smsl-n100 systemd[1]: Stopping Music Player Daemon... Nov 01 07:14:57 smsl-n100 sudo[1721]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Nov 01 07:14:57 smsl-n100 sudo[1721]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 01 07:14:57 smsl-n100 systemd[1]: mpd.service: Succeeded. Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Adding METAVOLUMIO REST API Endpoints Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Adding metavolumio REST Endpoint for plugin: miscellanea/metavolumio Nov 01 07:14:57 smsl-n100 sudo[1721]: pam_unix(sudo:session): session closed for user root Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Adding getSimilarArtists REST Endpoint for plugin: miscellanea/metavolumio Nov 01 07:14:57 smsl-n100 systemd[1]: Stopped Music Player Daemon. Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Adding getSimilarAlbums REST Endpoint for plugin: miscellanea/metavolumio Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Adding getSimilarTracks REST Endpoint for plugin: miscellanea/metavolumio Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Nov 01 07:14:57 smsl-n100 volumio[1454]: info: [1761956097774] CoreMusicLibrary::Adding element Last_100 Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Streaming services startup Nov 01 07:14:57 smsl-n100 systemd[1]: Starting Music Player Daemon... Nov 01 07:14:57 smsl-n100 volumio[1454]: info: Starting Streaming Daemon Nov 01 07:14:57 smsl-n100 sudo[1724]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Nov 01 07:14:57 smsl-n100 sudo[1724]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 01 07:14:57 smsl-n100 systemd[1]: mpd.service: Control process exited, code=killed, status=15/TERM Nov 01 07:14:57 smsl-n100 systemd[1]: mpd.service: Succeeded. Nov 01 07:14:57 smsl-n100 systemd[1]: Stopped Music Player Daemon. Nov 01 07:14:57 smsl-n100 systemd[1]: Starting Music Player Daemon... Nov 01 07:14:57 smsl-n100 sudo[1728]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Nov 01 07:14:57 smsl-n100 sudo[1728]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 01 07:14:57 smsl-n100 sudo[1728]: pam_unix(sudo:session): session closed for user root Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Nov 01 07:14:57 smsl-n100 volumio[1454]: info: [1761956097986] CoreMusicLibrary::Adding element Webradio Nov 01 07:14:57 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Nov 01 07:14:58 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Initializing BBC Radios Nov 01 07:14:58 smsl-n100 sudo[1736]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Nov 01 07:14:58 smsl-n100 sudo[1736]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 01 07:14:58 smsl-n100 volumio-remote-updater[588]: [2025-11-01 07:14:58] [connect] Successful connection Nov 01 07:14:58 smsl-n100 sudo[1736]: pam_unix(sudo:session): session closed for user root Nov 01 07:14:58 smsl-n100 sudo[1730]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Nov 01 07:14:58 smsl-n100 sudo[1730]: pam_unix(sudo:session): session opened for user root by (uid=0) Nov 01 07:14:58 smsl-n100 sudo[1730]: /bin/chown: cannot access '/var/log/mpd.log': No such file or directory Nov 01 07:14:58 smsl-n100 sudo[1730]: pam_unix(sudo:session): session closed for user root Nov 01 07:14:58 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Nov 01 07:14:58 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 01 07:14:58 smsl-n100 volumio[1454]: error: Hi Res Audio Failed Login: Missing Login Data Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Adding HIGHRESAUDIO REST API Endpoints Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Adding getStreamUrlhi_res_audio REST Endpoint for plugin: music_service/hi_res_audio Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Initializing Serial Communication on port /dev/ttyS1 Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Touch Event Listener Process Starting Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Adding inputs REST Endpoints Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Adding scanAudioInputs REST Endpoint for plugin: music_service/smart_inputs Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Scanning Audio Inputs Nov 01 07:14:58 smsl-n100 sudo[1752]: pam_unix(sudo:auth): conversation failed Nov 01 07:14:58 smsl-n100 sudo[1752]: pam_unix(sudo:auth): auth could not identify password for [volumio] Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Checking against Known Cards name Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Adding Server instance for streaming Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Refreshing TIDAL token Nov 01 07:14:58 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Nov 01 07:14:58 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Initializing GPIOs Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Starting Button Listener Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Turning off Green LED Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Tuning on Blue LED Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Signaling System Ready Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Volumio Calling Home Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Stopping AccessToken refresher cron for QOBUZ Nov 01 07:14:58 smsl-n100 volumio[1454]: info: AccessToken refresher cron started for QOBUZ Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Adding QOBUZ REST API Endpoints Nov 01 07:14:58 smsl-n100 volumio[1454]: info: Adding getStreamUrlqobuz REST Endpoint for plugin: music_service/qobuz Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Setting Device type: NanoPi NEO 3 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreStateMachine::setRepeat null single undefined Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreStateMachine::pushState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CorePlayQueue::getTrack 0 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioPushState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreStateMachine::setRandom null Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreStateMachine::pushState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CorePlayQueue::getTrack 0 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioPushState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Serial port opened successfully Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Sending serial start messages Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Reporting MCU Network Status: 1 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Touch Event Listener Process Closed Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Cannot start Volumio Streaming Daemon Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Nov 01 07:14:59 smsl-n100 volumio[1454]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Nov 01 07:14:59 smsl-n100 volumio[1454]: info: MPD Permissions set Nov 01 07:14:59 smsl-n100 volumio[1454]: info: MPD Permissions set Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setDeviceVolumeOverride Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Setting Device Volume Override Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioUpdateVolumeSettings Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Updating Volume Controller Parameters: Device: 1 Name: SPDIF Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Disabling external Volume Control Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreStateMachine::pushState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CorePlayQueue::getTrack 0 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioPushState Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: 100, message: undefined Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: MAXVOL, message: Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: 100, message: undefined Nov 01 07:14:59 smsl-n100 volumio[1454]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreStateMachine::pushState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CorePlayQueue::getTrack 0 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioPushState Nov 01 07:14:59 smsl-n100 volumio-remote-updater[588]: [2025-11-01 07:14:59] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1761956098 101 Nov 01 07:14:59 smsl-n100 volumio[1454]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Engine version: 4 Transport: websocket Total Clients: 1 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreStateMachine::pushState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CorePlayQueue::getTrack 0 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioPushState Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: 100, message: undefined Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: MAXVOL, message: Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: 100, message: undefined Nov 01 07:14:59 smsl-n100 volumio[1454]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreStateMachine::pushState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CorePlayQueue::getTrack 0 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioPushState Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: 100, message: undefined Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: MAXVOL, message: Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: 100, message: undefined Nov 01 07:14:59 smsl-n100 volumio[1454]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff Nov 01 07:14:59 smsl-n100 volumio[1454]: error: Serial API: Failed to decode command: 1, message: undefined Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Discovery: adding 9ad21108-7f0a-4583-96a0-57828b2d0c5e Nov 01 07:14:59 smsl-n100 volumio[1454]: info: Discovery: Found device SMSL N100 Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CoreCommandRouter::volumioGetState Nov 01 07:14:59 smsl-n100 volumio[1454]: info: CorePlayQueue::getTrack 0 Nov 01 07:14:59 smsl-n100 volumio[1454]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 01 07:14:59 smsl-n100 volumio[1454]: Error: The value NaN is not a number Nov 01 07:14:59 smsl-n100 volumio[1454]: at Config.forceToType (/volumio/node_modules/v-conf/index.js:322:20) Nov 01 07:14:59 smsl-n100 volumio[1454]: at Config.set (/volumio/node_modules/v-conf/index.js:153:25) Nov 01 07:14:59 smsl-n100 volumio[1454]: at ControllerVolumioDiscovery.updateMultiroomDevice (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:323:25) Nov 01 07:14:59 smsl-n100 volumio[1454]: at ControllerVolumioDiscovery.connectToRemoteVolumio (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:273:10) Nov 01 07:14:59 smsl-n100 volumio[1454]: at Browser. (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:192:12) Nov 01 07:14:59 smsl-n100 volumio[1454]: at Browser.emit (events.js:400:28) Nov 01 07:14:59 smsl-n100 volumio[1454]: at on_resolver_done (/volumio/node_modules/mdns/lib/browser.js:31:14) Nov 01 07:14:59 smsl-n100 volumio[1454]: at next (/volumio/node_modules/mdns/lib/browser.js:106:7) Nov 01 07:14:59 smsl-n100 volumio[1454]: at Array.makeAddressesUnique (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:177:5) Nov 01 07:14:59 smsl-n100 volumio[1454]: at next (/volumio/node_modules/mdns/lib/browser.js:109:21) Nov 01 07:14:59 smsl-n100 volumio[1454]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 01 07:15:00 smsl-n100 sudo[1794]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-11-01 07:14 Nov 01 07:15:00 smsl-n100 sudo[1794]: 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="cc0042a1eab1cb7982711a1347e242f8947b54b6" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="723ba1d50268911818ebdca474fb7656df6050cb" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="smsl" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri 14 Feb 2025 02:46:15 PM CET" VOLUMIO_VERSION="3.789" VOLUMIO_HARDWARE="nanopineo3" VOLUMIO_DEVICENAME="Nanopi Neo3" VOLUMIO_VENDOR_MODEL="SMSL S100" VOLUMIO_VENDOR="SMSL" VOLUMIO_MODEL="S100" VOLUMIO_HASH="215d731aee688e00fb3cc923952be9a7"