-- Logs begin at Tue 2025-01-21 02:23:13 CST, end at Tue 2025-03-18 10:49:01 CST. --
Mar 18 10:48:00 smsl-n100 sudo[3086]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapserver
Mar 18 10:48:00 smsl-n100 sudo[3086]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:00 smsl-n100 sudo[3083]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:00 smsl-n100 volumio[2975]: info: Loading plugin "outputs"...
Mar 18 10:48:00 smsl-n100 sudo[3088]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioStreaming
Mar 18 10:48:00 smsl-n100 sudo[3088]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:00 smsl-n100 volumio[2975]: info: Loading plugin "albumart"...
Mar 18 10:48:00 smsl-n100 sudo[3091]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/*
Mar 18 10:48:00 smsl-n100 sudo[3091]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:00 smsl-n100 sudo[3086]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:00 smsl-n100 sudo[3091]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:00 smsl-n100 volumio[2975]: info: Plugin example_plugin is not enabled
Mar 18 10:48:00 smsl-n100 sudo[3088]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:00 smsl-n100 volumio[2975]: info: Loading plugin "hi_res_audio"...
Mar 18 10:48:00 smsl-n100 volumio[2975]: Forking 3 albumart workers
Mar 18 10:48:03 smsl-n100 volumio[2975]: Starting albumart workers
Mar 18 10:48:03 smsl-n100 volumio[2975]: Starting albumart workers
Mar 18 10:48:03 smsl-n100 volumio[2975]: Starting albumart workers
Mar 18 10:48:03 smsl-n100 volumio[2975]: info: Applying required configuration parameters for plugin hi_res_audio
Mar 18 10:48:03 smsl-n100 volumio[2975]: info: Loading plugin "inputs"...
Mar 18 10:48:05 smsl-n100 volumio[2975]: info: Loading plugin "qobuz"...
Mar 18 10:48:06 smsl-n100 volumio-remote-updater[574]: [2025-03-18 02:48:06] [connect] Successful connection
Mar 18 10:48:07 smsl-n100 volumio[2975]: info: Loading plugin "smart_inputs"...
Mar 18 10:48:07 smsl-n100 volumio[2975]: info: Loading plugin "tidal"...
Mar 18 10:48:09 smsl-n100 volumio[2975]: info: Loading plugin "oem_helper"...
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: Applying required configuration parameters for plugin oem_helper
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: Loading plugin "smslcontrol"...
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: Adding this device properties
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , setThisDeviceVolumioProperties
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: Setting Additional Device Volumio Properties: [object Object]
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: Loading plugin "updater_comm"...
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: Plugin mpdemulation is not enabled
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: Loading plugin "rest_api"...
Mar 18 10:48:11 smsl-n100 volumio[2975]: info: Loading plugin "websocket"...
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: Starting Socket.io Server version 2.3.0
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: Loading i18n strings for locale zh
Mar 18 10:48:12 smsl-n100 volumio[2975]: Updating browse sources language
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::initPlayerControls
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Mar 18 10:48:12 smsl-n100 volumio[2975]: Express server listening on port 3000
Mar 18 10:48:12 smsl-n100 volumio[2975]: [Metrics] WebUI: 28s 507.88ms
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreStateMachine::resetVolumioState
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreStateMachine::getcurrentVolume
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioRetrievevolume
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:12 smsl-n100 sudo[3180]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Mar 18 10:48:12 smsl-n100 sudo[3180]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:12 smsl-n100 sudo[3180]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:12 smsl-n100 sudo[3183]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Mar 18 10:48:12 smsl-n100 sudo[3183]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:12 smsl-n100 volumio[2975]: error: Cannot read config.txt file: Error: ENOENT: no such file or directory, open '/boot/config.txt'
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: Completed loading Core Plugins
Mar 18 10:48:12 smsl-n100 sudo[3183]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: Preparing to generate the ALSA configuration file
Mar 18 10:48:12 smsl-n100 volumio[2975]: info: Volumio Network Manager: Network status updated: 3
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: MRS: Removed streaming files
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: MRS: volumioStreaming STOPPED
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: MRS: SNAPSERVER STOPPED
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: MRS: SNAPCLIENT STOPPED
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Cannot read proc/cpuinfo: Error: Command failed: cat /proc/cpuinfo | grep Revision
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Reading ALSA contributions from plugins.
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 1
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 2
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 3
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 4
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 5
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 6
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 7
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 8
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 9
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 10
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 11
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 12
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 13
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 14
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 15
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 16
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 17
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 18
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 19
Mar 18 10:48:13 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 20
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:13 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: Reloading queue from file
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreStateMachine::setRepeat null single undefined
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreStateMachine::setRandom null
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: Setting Device type: NanoPi NEO 3
Mar 18 10:48:14 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.24 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 21
Mar 18 10:48:14 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: websocket Total Clients: 22
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
Mar 18 10:48:14 smsl-n100 sudo[3192]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service
Mar 18 10:48:14 smsl-n100 sudo[3192]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: Asound.conf file unchanged, so no further update is needed
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: Output device has changed, restarting MPD
Mar 18 10:48:14 smsl-n100 sudo[3192]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:14 smsl-n100 sudo[3195]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: Output device has changed, restarting Shairport Sync
Mar 18 10:48:14 smsl-n100 sudo[3195]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:14 smsl-n100 sudo[3195]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:14 smsl-n100 sudo[3197]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service
Mar 18 10:48:14 smsl-n100 sudo[3197]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:14 smsl-n100 systemd[1]: Stopping Music Player Daemon...
Mar 18 10:48:14 smsl-n100 systemd[1]: mpd.service: Succeeded.
Mar 18 10:48:14 smsl-n100 systemd[1]: Stopped Music Player Daemon.
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration
Mar 18 10:48:14 smsl-n100 systemd[1]: Starting Music Player Daemon...
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: ___________ START PLUGINS ___________
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: ControllerMpd::onStart: Initializing MPD
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: Creating MPD Configuration file
Mar 18 10:48:14 smsl-n100 sudo[3207]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf
Mar 18 10:48:14 smsl-n100 sudo[3207]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:14 smsl-n100 sudo[3203]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log
Mar 18 10:48:14 smsl-n100 sudo[3207]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:14 smsl-n100 sudo[3203]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: [1742266094898] CoreMusicLibrary::Adding element 媒体服务器
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Mar 18 10:48:14 smsl-n100 sudo[3203]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:14 smsl-n100 sudo[3210]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service
Mar 18 10:48:14 smsl-n100 sudo[3210]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:14 smsl-n100 systemd[1]: mpd.service: Main process exited, code=killed, status=15/TERM
Mar 18 10:48:14 smsl-n100 systemd[1]: mpd.service: Succeeded.
Mar 18 10:48:14 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Mar 18 10:48:15 smsl-n100 systemd[1]: Stopped Music Player Daemon.
Mar 18 10:48:15 smsl-n100 systemd[1]: Starting Music Player Daemon...
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding METAVOLUMIO REST API Endpoints
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding metavolumio REST Endpoint for plugin: miscellanea/metavolumio
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding getSimilarArtists REST Endpoint for plugin: miscellanea/metavolumio
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding getSimilarAlbums REST Endpoint for plugin: miscellanea/metavolumio
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding getSimilarTracks REST Endpoint for plugin: miscellanea/metavolumio
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:15 smsl-n100 sudo[3216]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/hciconfig hci0 name SMSL N100
Mar 18 10:48:15 smsl-n100 sudo[3216]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:15 smsl-n100 sudo[3216]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:15 smsl-n100 sudo[3214]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log
Mar 18 10:48:15 smsl-n100 sudo[3214]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:15 smsl-n100 sudo[3214]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Preparing CD Folders
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding CD REST API Endpoints
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding cdPostRip REST Endpoint for plugin: music_service/cd_controller
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Starting UDEV Watcher for CD
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Detecting CD presence with UDEV
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: networkfs , getUdevDevices
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: [1742266095364] CoreMusicLibrary::Adding element Last_100
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Starting RAAT Plugin
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , addAdditionalUISections
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Additional UI Settings Added for plugin music_service/raat
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Registering DSP Elements listener and retrieving current ones
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Additional DSP elements updated
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Updating RAAT Signal Path
Mar 18 10:48:15 smsl-n100 volumio[2975]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Streaming services startup
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Starting Streaming Daemon
Mar 18 10:48:15 smsl-n100 sudo[3227]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service
Mar 18 10:48:15 smsl-n100 sudo[3227]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:15 smsl-n100 sudo[3227]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: [1742266095628] CoreMusicLibrary::Adding element Webradio
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Mar 18 10:48:15 smsl-n100 sudo[3234]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service
Mar 18 10:48:15 smsl-n100 sudo[3234]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Initializing BBC Radios
Mar 18 10:48:15 smsl-n100 sudo[3234]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , pushMultiRoomStatus
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:15 smsl-n100 volumio[2975]: error: Hi Res Audio Failed Login: Missing Login Data
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding HIGHRESAUDIO REST API Endpoints
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Adding getStreamUrlhi_res_audio REST Endpoint for plugin: music_service/hi_res_audio
Mar 18 10:48:15 smsl-n100 volumio[2975]: info: Initializing Serial Communication on port /dev/ttyS1
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Touch Event Listener Process Starting
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Adding inputs REST Endpoints
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Adding scanAudioInputs REST Endpoint for plugin: music_service/smart_inputs
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Scanning Audio Inputs
Mar 18 10:48:16 smsl-n100 sudo[3251]: pam_unix(sudo:auth): conversation failed
Mar 18 10:48:16 smsl-n100 sudo[3251]: pam_unix(sudo:auth): auth could not identify password for [volumio]
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Checking against Known Cards name
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Adding Server instance for streaming
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Initializing GPIOs
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Starting Button Listener
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Turning off Green LED
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Tuning on Blue LED
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Signaling System Ready
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Volumio Calling Home
Mar 18 10:48:16 smsl-n100 volumio[2975]: (node:2975) [DEP0005] DeprecationWarning: Buffer() is deprecated due to security and usability issues. Please use the Buffer.alloc(), Buffer.allocUnsafe(), or Buffer.from() methods instead.
Mar 18 10:48:16 smsl-n100 volumio[2975]: (Use `node --trace-deprecation ...` to show where the warning was created)
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Stopping AccessToken refresher cron for QOBUZ
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: AccessToken refresher cron started for QOBUZ
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Stopping AccessToken refresher cron
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: AccessToken refresher cron started
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Adding TIDAL REST API Endpoints
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Adding getStreamUrltidal REST Endpoint for plugin: music_service/tidal
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Adding QOBUZ REST API Endpoints
Mar 18 10:48:16 smsl-n100 volumio[2975]: info: Adding getStreamUrlqobuz REST Endpoint for plugin: music_service/qobuz
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Discovery: adding f27ca38c-d778-4dd6-9a9e-5cb4a4817be3
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Discovery: Found device SMSL N100
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output for this device
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Adding audio output:
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Adding audio output:
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Discovery: this is already registered, f27ca38c-d778-4dd6-9a9e-5cb4a4817be3
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Discovery: Found device SMSL N100
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Serial port opened successfully
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Sending serial start messages
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Reporting MCU Network Status: 3
Mar 18 10:48:17 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.23 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 23
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Touch Event Listener Process Closed
Mar 18 10:48:17 smsl-n100 volumio[2975]: error: Cannot start Volumio Streaming Daemon
Mar 18 10:48:17 smsl-n100 volumio[2975]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service
Mar 18 10:48:17 smsl-n100 volumio[2975]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found.
Mar 18 10:48:17 smsl-n100 volumio[2975]: error: Cannot set new Bluetooth Name : Error: Command failed: /usr/bin/sudo /bin/hciconfig hci0 name 'SMSL N100'
Mar 18 10:48:17 smsl-n100 volumio[2975]: Can't get device info: No such device
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MPD Permissions set
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MPD Permissions set
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Upmpdcli Daemon Started
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setDeviceVolumeOverride
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Setting Device Volume Override
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioUpdateVolumeSettings
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Updating Volume Controller Parameters: Device: 1 Name: SPDIF Mixer: Max Vol: 100 Vol Curve; logarithmic Vol Steps: 1
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: Disabling external Volume Control
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:17 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:17 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: MAXVOL, message:
Mar 18 10:48:17 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:17 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: Volumio called home
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:18 smsl-n100 sudo[3270]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumiobt.service
Mar 18 10:48:18 smsl-n100 sudo[3270]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: MAXVOL, message:
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff
Mar 18 10:48:18 smsl-n100 sudo[3270]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: MAXVOL, message:
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 3, message: undefined
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetVisibleSources
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetQueue
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreStateMachine::getQueue
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CorePlayQueue::getQueue
Mar 18 10:48:18 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 24
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: MAXVOL, message:
Mar 18 10:48:18 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:18 smsl-n100 volumio[2975]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff
Mar 18 10:48:19 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 25
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: Volumio BT Module successfully started
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:19 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:19 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: MAXVOL, message:
Mar 18 10:48:19 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: TidalConnect service stoped!
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: Starting Shairport Sync
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: Starting Shairport Sync
Mar 18 10:48:19 smsl-n100 volumio[2975]: info: Starting Shairport Sync
Mar 18 10:48:19 smsl-n100 sudo[3307]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Mar 18 10:48:19 smsl-n100 sudo[3307]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:20 smsl-n100 sudo[3309]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Mar 18 10:48:20 smsl-n100 sudo[3309]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:20 smsl-n100 systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver...
Mar 18 10:48:20 smsl-n100 systemd[1]: shairport-sync.service: Succeeded.
Mar 18 10:48:20 smsl-n100 systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver.
Mar 18 10:48:20 smsl-n100 sudo[3313]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:20 smsl-n100 sudo[3313]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:20 smsl-n100 systemd[1]: Started Shairport Sync - AirPlay Audio Receiver.
Mar 18 10:48:20 smsl-n100 sudo[3309]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:20 smsl-n100 sudo[3307]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:20 smsl-n100 systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver...
Mar 18 10:48:20 smsl-n100 systemd[1]: shairport-sync.service: Main process exited, code=killed, status=15/TERM
Mar 18 10:48:20 smsl-n100 systemd[1]: shairport-sync.service: Succeeded.
Mar 18 10:48:20 smsl-n100 systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver.
Mar 18 10:48:20 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: running
Mar 18 10:48:20 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Mar 18 10:48:20 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Mar 18 10:48:20 smsl-n100 systemd[1]: Started Shairport Sync - AirPlay Audio Receiver.
Mar 18 10:48:20 smsl-n100 sudo[3313]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: Adding tc_getconfig REST Endpoint for plugin: music_service/tidalconnect
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: Adding tc_connect REST Endpoint for plugin: music_service/tidalconnect
Mar 18 10:48:20 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: running
Mar 18 10:48:20 smsl-n100 sudo[3324]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service
Mar 18 10:48:20 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Mar 18 10:48:20 smsl-n100 sudo[3324]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:20 smsl-n100 systemd[1]: Started Volumio Tidal Connect Service.
Mar 18 10:48:20 smsl-n100 sudo[3324]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: Shairport-Sync Started
Mar 18 10:48:20 smsl-n100 volumio[2975]: Error adding Membership: Error: addMembership EINVAL
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: Shairport-Sync Started
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: Shairport-Sync Started
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: MRS: Getting audio outputs on start
Mar 18 10:48:20 smsl-n100 volumio[2975]: info: MRS: Requesting all other devices output
Mar 18 10:48:21 smsl-n100 mpd[3225]: Mar 18 10:48 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg
Mar 18 10:48:21 smsl-n100 systemd[1]: Started Music Player Daemon.
Mar 18 10:48:21 smsl-n100 sudo[3197]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:21 smsl-n100 sudo[3210]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:21 smsl-n100 volumio-remote-updater[574]: [2025-03-18 02:48:21] [connect] Successful connection
Mar 18 10:48:21 smsl-n100 sudo[3336]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Mar 18 10:48:21 smsl-n100 sudo[3336]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:21 smsl-n100 sudo[3336]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:21 smsl-n100 sudo[3339]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Mar 18 10:48:21 smsl-n100 sudo[3339]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:21 smsl-n100 sudo[3339]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:21 smsl-n100 volumio[2975]: error: MPD error: The expression evaluated to a falsy value:
Mar 18 10:48:21 smsl-n100 volumio[2975]: assert.ok(self.idling)
Mar 18 10:48:21 smsl-n100 volumio[2975]: error: The expression evaluated to a falsy value:
Mar 18 10:48:21 smsl-n100 volumio[2975]: assert.ok(self.idling)
Mar 18 10:48:21 smsl-n100 volumio[2975]: info: Executing endpoint tc_getconfig
Mar 18 10:48:21 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onGetConfig
Mar 18 10:48:21 smsl-n100 vtcs[3326]: STARTING TidalConnect services, version: 1.4.0.34
Mar 18 10:48:21 smsl-n100 volumio-remote-updater[574]: [2025-03-18 02:48:21] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1742266101 101
Mar 18 10:48:21 smsl-n100 volumio[2975]: 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: 25
Mar 18 10:48:21 smsl-n100 volumio[2975]: info: MPD running with PID3225
Mar 18 10:48:21 smsl-n100 volumio[2975]: ,establishing connection
Mar 18 10:48:21 smsl-n100 volumio[2975]: error: updateQueue error: null
Mar 18 10:48:21 smsl-n100 volumio[2975]: error: updateQueue error: null
Mar 18 10:48:21 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 26
Mar 18 10:48:21 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to 192.168.0.24 from 192.168.0.3 UA: okhttp/4.9.2 Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:21 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:21 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:21 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Mar 18 10:48:22 smsl-n100 vtcs[3326]: STARTED TidalConnect services.
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetVisibleSources
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: Executing endpoint tc_connect
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onConnect
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: Connecting to TidalConnect
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::servicePushState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current mpd Received tidalconnect
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::servicePushState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current mpd Received tidalconnect
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: Received Get System Info
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: Listing playlists
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: VolumeController::SetAlsaVolume0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:22 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: Received Get System Info
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: Discovery: Getting this device information
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Mar 18 10:48:23 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: TidalConnect service started!
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: Completed starting Core Plugins
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: -------------------------------------------
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: ----- MyVolumio plugins startup ----
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: -------------------------------------------
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Fetching plans data....
Mar 18 10:48:23 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
Mar 18 10:48:24 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:24 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:24 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:24 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetQueue
Mar 18 10:48:24 smsl-n100 volumio[2975]: info: CoreStateMachine::getQueue
Mar 18 10:48:24 smsl-n100 volumio[2975]: info: CorePlayQueue::getQueue
Mar 18 10:48:24 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: wizard , setOnboardingWizardFalse
Mar 18 10:48:25 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:25 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:25 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:27 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:27 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:27 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:28 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:28 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:28 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:29 smsl-n100 volumio[2975]: info: CoreCommandRouter::getUIConfigOnPlugin
Mar 18 10:48:29 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus
Mar 18 10:48:29 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork
Mar 18 10:48:29 smsl-n100 sudo[3375]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0
Mar 18 10:48:29 smsl-n100 sudo[3375]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:29 smsl-n100 sudo[3375]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:29 smsl-n100 sudo[3381]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0
Mar 18 10:48:29 smsl-n100 sudo[3381]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:29 smsl-n100 sudo[3381]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:29 smsl-n100 sudo[3388]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0
Mar 18 10:48:29 smsl-n100 sudo[3388]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:29 smsl-n100 sudo[3388]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:29 smsl-n100 sudo[3395]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0
Mar 18 10:48:29 smsl-n100 sudo[3395]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:29 smsl-n100 sudo[3395]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:29 smsl-n100 sudo[3401]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Mar 18 10:48:29 smsl-n100 sudo[3401]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:29 smsl-n100 sudo[3401]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:29 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache
Mar 18 10:48:29 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks
Mar 18 10:48:29 smsl-n100 sudo[3404]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Mar 18 10:48:29 smsl-n100 sudo[3404]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:29 smsl-n100 sudo[3404]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:29 smsl-n100 sudo[3407]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan
Mar 18 10:48:29 smsl-n100 sudo[3407]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:29 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:30 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:30 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:31 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:31 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:31 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:31 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Mar 18 10:48:32 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso
Mar 18 10:48:32 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"...
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: Starting MyVolumio Remote Streaming Endpoints
Mar 18 10:48:34 smsl-n100 sudo[3407]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: MyVolumio not started
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: Initializing device activation check
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started
Mar 18 10:48:34 smsl-n100 volumio[2975]: error: [MyVolumio PluginManager] Could not read package.json file: Error: /myvolumio/plugins/music_service/streaming_services//package.json: ENOENT: no such file or directory, open '/myvolumio/plugins/music_service/streaming_services//package.json'
Mar 18 10:48:34 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:34 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:35 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:35 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:35 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:36 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:36 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:36 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:37 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:37 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:37 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:39 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:39 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:39 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:40 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:40 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:40 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:41 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:41 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:41 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:42 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: network , saveWirelessNetworkSettings
Mar 18 10:48:42 smsl-n100 volumio[2975]: info: Saving new wireless network
Mar 18 10:48:42 smsl-n100 sudo[3468]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/wpa_supplicant/wpa_supplicant.conf
Mar 18 10:48:42 smsl-n100 sudo[3468]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:42 smsl-n100 sudo[3468]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:42 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , onNetworkingRestart
Mar 18 10:48:42 smsl-n100 volumio[2975]: info: Discovery: Restarting Advertising due to device name change
Mar 18 10:48:42 smsl-n100 sudo[3471]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart wireless.service
Mar 18 10:48:42 smsl-n100 sudo[3471]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:42 smsl-n100 systemd[1]: Stopping Wireless Services...
Mar 18 10:48:42 smsl-n100 wpa_supplicant[2431]: wlan0: CTRL-EVENT-DISCONNECTED bssid=f4:2a:7d:d8:0f:b9 reason=3 locally_generated=1
Mar 18 10:48:42 smsl-n100 dhcpcd[977]: wlan0: carrier lost
Mar 18 10:48:42 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: running
Mar 18 10:48:42 smsl-n100 wpa_supplicant[2431]: nl80211: deinit ifname=wlan0 disabled_11b_rates=0
Mar 18 10:48:42 smsl-n100 avahi-daemon[567]: Interface wlan0.IPv4 no longer relevant for mDNS.
Mar 18 10:48:42 smsl-n100 avahi-daemon[567]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.0.24.
Mar 18 10:48:42 smsl-n100 avahi-daemon[567]: Withdrawing address record for 192.168.0.24 on wlan0.
Mar 18 10:48:42 smsl-n100 wpa_supplicant[2431]: wlan0: CTRL-EVENT-TERMINATING
Mar 18 10:48:42 smsl-n100 volumio[2975]: info: Discovery: A device disappeared from network
Mar 18 10:48:42 smsl-n100 systemd[1]: wireless.service: Succeeded.
Mar 18 10:48:42 smsl-n100 systemd[1]: Stopped Wireless Services.
Mar 18 10:48:42 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Mar 18 10:48:42 smsl-n100 systemd[1]: Starting Wireless Services...
Mar 18 10:48:42 smsl-n100 dhcpcd[977]: wlan0: deleting route to 192.168.0.0/24
Mar 18 10:48:42 smsl-n100 dhcpcd[977]: wlan0: deleting default route via 192.168.0.1
Mar 18 10:48:42 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: running
Mar 18 10:48:42 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 27
Mar 18 10:48:42 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:42 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:43 smsl-n100 volumio[2975]: info: Discovery: A device disappeared from network
Mar 18 10:48:43 smsl-n100 wireless.js[3486]: Cleaning previous...
Mar 18 10:48:43 smsl-n100 sudo[3518]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0
Mar 18 10:48:43 smsl-n100 sudo[3518]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:43 smsl-n100 sudo[3518]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:43 smsl-n100 volumio[2975]: 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 18 10:48:43 smsl-n100 sudo[3520]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 down
Mar 18 10:48:43 smsl-n100 sudo[3520]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:43 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:43 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:43 smsl-n100 sudo[3520]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:43 smsl-n100 volumio[2975]: error: MyVolumio Plugin failed to start in a timely fashion
Mar 18 10:48:43 smsl-n100 volumio[2975]: [Metrics] CommandRouter: 58s 778.45ms
Mar 18 10:48:43 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumiosetStartupVolume
Mar 18 10:48:43 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:43 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:43 smsl-n100 volumio[2975]: info: CoreCommandRouter::Close All Modals sent
Mar 18 10:48:43 smsl-n100 volumio[2975]: info: CoreCommandRouter::Close All Modals sent
Mar 18 10:48:43 smsl-n100 wireless.js[3486]: Stopped aP
Mar 18 10:48:43 smsl-n100 sudo[3529]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up
Mar 18 10:48:43 smsl-n100 sudo[3529]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:44 smsl-n100 dhcpcd[977]: wlan0: carrier acquired
Mar 18 10:48:44 smsl-n100 sudo[3529]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:44 smsl-n100 dhcpcd[977]: wlan0: IAID 2b:ee:c8:de
Mar 18 10:48:44 smsl-n100 sudo[3532]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw reg get
Mar 18 10:48:44 smsl-n100 sudo[3532]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:44 smsl-n100 sudo[3532]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:44 smsl-n100 sudo[3539]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 up
Mar 18 10:48:44 smsl-n100 sudo[3539]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:44 smsl-n100 sudo[3539]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:44 smsl-n100 sudo[3541]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw wlan0 scan
Mar 18 10:48:44 smsl-n100 sudo[3541]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:44 smsl-n100 dhcpcd[977]: wlan0: soliciting an IPv6 router
Mar 18 10:48:44 smsl-n100 dhcpcd[977]: wlan0: rebinding lease of 192.168.0.24
Mar 18 10:48:44 smsl-n100 volumio[2975]: 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 18 10:48:44 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:44 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:44 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable
Mar 18 10:48:44 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus
Mar 18 10:48:45 smsl-n100 volumio[2975]: xcb_connection_has_error() returned true
Mar 18 10:48:45 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect
Mar 18 10:48:45 smsl-n100 ntpd[2576]: Deleting interface #4 wlan0, 192.168.0.24#123, interface stats: received=0, sent=0, dropped=0, active_time=107 secs
Mar 18 10:48:46 smsl-n100 volumio[2975]: 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 18 10:48:46 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:46 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:46 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Mar 18 10:48:46 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Mar 18 10:48:46 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Mar 18 10:48:46 smsl-n100 volumio-remote-updater[574]: No test mode
Mar 18 10:48:46 smsl-n100 volumio-remote-updater[574]: No alpha test mode
Mar 18 10:48:46 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled
Mar 18 10:48:47 smsl-n100 volumio[2975]: 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 18 10:48:47 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:47 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:47 smsl-n100 volumio[2975]: info: Discovery: Started advertising with name: SMSL N100
Mar 18 10:48:47 smsl-n100 volumio[2975]: info: Update Ready: {"changeLogLink":"http://volumio.org","description":"FIXES
- Improved translations
- Fix Multiroom Buffer Sizes
- Increase results for Kana-Kanji Conversion
- Fix for streaming interruptions
NEW ADDITIONS
- Add network status on the serial API
","title":"Update v3.789","updateavailable":true}
Mar 18 10:48:47 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache
Mar 18 10:48:48 smsl-n100 volumio[2975]: info: Discovery: adding f27ca38c-d778-4dd6-9a9e-5cb4a4817be3
Mar 18 10:48:48 smsl-n100 volumio[2975]: info: Discovery: Found device SMSL N100
Mar 18 10:48:48 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:48 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:48 smsl-n100 volumio[2975]: 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 18 10:48:48 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:48 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:48 smsl-n100 sudo[3541]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:48 smsl-n100 wireless.js[3486]: Start wireless flow
Mar 18 10:48:48 smsl-n100 wireless.js[3486]: Stopped hotspot (if there)..
Mar 18 10:48:48 smsl-n100 sudo[3554]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ip addr flush dev wlan0
Mar 18 10:48:48 smsl-n100 sudo[3554]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:48 smsl-n100 sudo[3554]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:48 smsl-n100 sudo[3556]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 down
Mar 18 10:48:48 smsl-n100 sudo[3556]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:48 smsl-n100 dhcpcd[977]: wlan0: carrier lost
Mar 18 10:48:48 smsl-n100 sudo[3556]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:48 smsl-n100 wireless.js[3486]: DHCP IP
Mar 18 10:48:48 smsl-n100 wireless.js[3486]: Start ap
Mar 18 10:48:48 smsl-n100 wpa_supplicant[3562]: Successfully initialized wpa_supplicant
Mar 18 10:48:48 smsl-n100 sudo[3565]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/dhcpcd
Mar 18 10:48:48 smsl-n100 sudo[3565]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:48 smsl-n100 dhcpcd[3574]: sending commands to master dhcpcd process
Mar 18 10:48:48 smsl-n100 sudo[3565]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:49 smsl-n100 dhcpcd[977]: wlan0: carrier acquired
Mar 18 10:48:49 smsl-n100 dhcpcd[977]: wlan0: IAID 2b:ee:c8:de
Mar 18 10:48:49 smsl-n100 dhcpcd[977]: control command: /sbin/dhcpcd
Mar 18 10:48:49 smsl-n100 dhcpcd[977]: wlan0: carrier lost
Mar 18 10:48:49 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Mar 18 10:48:49 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:50 smsl-n100 sudo[3610]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:50 smsl-n100 sudo[3610]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:50 smsl-n100 volumio[2975]: 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 18 10:48:50 smsl-n100 sudo[3610]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:50 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: Reporting MCU Network Status: 1
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: Volumio Network Manager: Network status updated: 1
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:50 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:50 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: MAXVOL, message:
Mar 18 10:48:50 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff
Mar 18 10:48:50 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 1, message: undefined
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: VolumeController::SetAlsaVolume0
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:50 smsl-n100 volumio[2975]: info: BOOT COMPLETED
Mar 18 10:48:50 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:50 smsl-n100 sudo[3623]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:50 smsl-n100 sudo[3623]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:50 smsl-n100 sudo[3623]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:51 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8
Mar 18 10:48:51 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:51 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:51 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:51 smsl-n100 sudo[3629]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:51 smsl-n100 sudo[3629]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:51 smsl-n100 sudo[3629]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:52 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: Not Reporting Auto name since its the default one
Mar 18 10:48:52 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkCurrentAudioDeviceAvailable
Mar 18 10:48:52 smsl-n100 volumio[2975]: xcb_connection_has_error() returned true
Mar 18 10:48:52 smsl-n100 sudo[3638]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed raat-daemon.service
Mar 18 10:48:52 smsl-n100 sudo[3638]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:52 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:52 smsl-n100 sudo[3638]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:52 smsl-n100 sudo[3641]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:52 smsl-n100 sudo[3641]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:52 smsl-n100 sudo[3642]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart raat-daemon.service
Mar 18 10:48:52 smsl-n100 sudo[3642]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:52 smsl-n100 sudo[3641]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:53 smsl-n100 systemd[1]: Stopping RAAT DAEMON...
Mar 18 10:48:53 smsl-n100 systemd[1]: raat-daemon.service: Main process exited, code=killed, status=15/TERM
Mar 18 10:48:53 smsl-n100 systemd[1]: raat-daemon.service: Succeeded.
Mar 18 10:48:53 smsl-n100 systemd[1]: Stopped RAAT DAEMON.
Mar 18 10:48:53 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: running
Mar 18 10:48:53 smsl-n100 systemd[1]: Started RAAT DAEMON.
Mar 18 10:48:53 smsl-n100 sudo[3642]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:53 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Mar 18 10:48:53 smsl-n100 volumio[2975]: info: Raat Daemon started successfully
Mar 18 10:48:53 smsl-n100 volumio[2975]: info: Executing endpoint restartRAATSocket
Mar 18 10:48:53 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: raat , establishDaemonConnection
Mar 18 10:48:53 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:53 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8
Mar 18 10:48:53 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9
Mar 18 10:48:53 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:53 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:53 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:53 smsl-n100 sudo[3657]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:53 smsl-n100 sudo[3657]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:53 smsl-n100 sudo[3657]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:54 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:54 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Mar 18 10:48:54 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam
Mar 18 10:48:54 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam
Mar 18 10:48:54 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject
Mar 18 10:48:54 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetBrowseSources
Mar 18 10:48:54 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Mar 18 10:48:54 smsl-n100 wpa_supplicant[3579]: wlan0: Trying to associate with f4:2a:7d:d8:0f:b9 (SSID='TP-LINK_0FB7' freq=5765 MHz)
Mar 18 10:48:54 smsl-n100 wpa_supplicant[3579]: wlan0: Associated with f4:2a:7d:d8:0f:b9
Mar 18 10:48:54 smsl-n100 wpa_supplicant[3579]: wlan0: CTRL-EVENT-SUBNET-STATUS-UPDATE status=0
Mar 18 10:48:54 smsl-n100 wpa_supplicant[3579]: wlan0: CTRL-EVENT-REGDOM-CHANGE init=COUNTRY_IE type=COUNTRY alpha2=CN
Mar 18 10:48:54 smsl-n100 wpa_supplicant[3579]: wlan0: WPA: Key negotiation completed with f4:2a:7d:d8:0f:b9 [PTK=CCMP GTK=CCMP]
Mar 18 10:48:54 smsl-n100 wpa_supplicant[3579]: wlan0: CTRL-EVENT-CONNECTED - Connection to f4:2a:7d:d8:0f:b9 completed [id=0 id_str=]
Mar 18 10:48:54 smsl-n100 dhcpcd[977]: wlan0: carrier acquired
Mar 18 10:48:54 smsl-n100 dhcpcd[977]: wlan0: IAID 2b:ee:c8:de
Mar 18 10:48:54 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:54 smsl-n100 sudo[3663]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:54 smsl-n100 sudo[3663]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:54 smsl-n100 sudo[3663]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:55 smsl-n100 dhcpcd[977]: wlan0: rebinding lease of 192.168.0.24
Mar 18 10:48:55 smsl-n100 dhcpcd[977]: wlan0: probing address 192.168.0.24/24
Mar 18 10:48:55 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:55 smsl-n100 dhcpcd[977]: wlan0: soliciting an IPv6 router
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: RAAT: Requesting Headphone Status
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: inputs , getHeadphoneStatus
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:48:55 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:55 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: MAXVOL, message:
Mar 18 10:48:55 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:48:55 smsl-n100 volumio[2975]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff
Mar 18 10:48:55 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:55 smsl-n100 sudo[3666]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:55 smsl-n100 sudo[3666]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:55 smsl-n100 sudo[3666]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:56 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9
Mar 18 10:48:56 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:56 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:56 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:56 smsl-n100 sudo[3669]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:56 smsl-n100 sudo[3669]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:56 smsl-n100 sudo[3669]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:57 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9
Mar 18 10:48:57 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:57 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:57 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:57 smsl-n100 sudo[3672]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:57 smsl-n100 sudo[3672]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:57 smsl-n100 sudo[3672]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:58 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9
Mar 18 10:48:58 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:58 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:58 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:58 smsl-n100 sudo[3675]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:58 smsl-n100 sudo[3675]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:48:58 smsl-n100 sudo[3675]: pam_unix(sudo:session): session closed for user root
Mar 18 10:48:59 smsl-n100 volumio[2975]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9
Mar 18 10:48:59 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:48:59 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:48:59 smsl-n100 dhcpcd[977]: wlan0: leased 192.168.0.24 for 172800 seconds
Mar 18 10:48:59 smsl-n100 dhcpcd[977]: wlan0: adding route to 192.168.0.0/24
Mar 18 10:48:59 smsl-n100 dhcpcd[977]: wlan0: adding default route via 192.168.0.1
Mar 18 10:48:59 smsl-n100 avahi-daemon[567]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.0.24.
Mar 18 10:48:59 smsl-n100 avahi-daemon[567]: New relevant interface wlan0.IPv4 for mDNS.
Mar 18 10:48:59 smsl-n100 avahi-daemon[567]: Registering new address record for 192.168.0.24 on wlan0.IPv4.
Mar 18 10:48:59 smsl-n100 wireless.js[3486]: trying...
Mar 18 10:48:59 smsl-n100 sudo[3696]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwgetid -r
Mar 18 10:48:59 smsl-n100 sudo[3696]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:49:00 smsl-n100 sudo[3696]: pam_unix(sudo:session): session closed for user root
Mar 18 10:49:00 smsl-n100 wireless.js[3486]: Connected to: ----TP-LINK_0FB7
Mar 18 10:49:00 smsl-n100 wireless.js[3486]: ----
Mar 18 10:49:00 smsl-n100 sudo[3706]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Mar 18 10:49:00 smsl-n100 sudo[3706]: pam_unix(sudo:session): session opened for user root by (uid=0)
Mar 18 10:49:00 smsl-n100 sudo[3706]: pam_unix(sudo:session): session closed for user root
Mar 18 10:49:00 smsl-n100 wireless.js[3486]: ... joined AP, wlan0 IPv4 is 192.168.0.24, ipV6 is undefined
Mar 18 10:49:00 smsl-n100 wireless.js[3486]: It's done! AP
Mar 18 10:49:00 smsl-n100 iwconfig[3722]: Error for wireless request "Set Power Management" (8B2C) :
Mar 18 10:49:00 smsl-n100 iwconfig[3722]: SET failed on device wlan0 ; Operation not permitted.
Mar 18 10:49:00 smsl-n100 systemd[1]: Started Wireless Services.
Mar 18 10:49:00 smsl-n100 sudo[3471]: pam_unix(sudo:session): session closed for user root
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: Reporting MCU Network Status: 3
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: Volumio Network Manager: Network status updated: 3
Mar 18 10:49:00 smsl-n100 ntpd[2576]: ntpd exiting on signal 15 (Terminated)
Mar 18 10:49:00 smsl-n100 systemd[1]: Stopping Network Time Service...
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 193.182.111.143 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 162.159.200.123 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 162.159.200.1 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 117.80.231.60 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 185.209.85.222 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 193.182.111.12 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 systemd[1]: ntp.service: Succeeded.
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 172.105.240.243 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 116.203.151.74 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 193.182.111.142 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 108.59.2.24 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 117.80.112.205 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 119.28.183.184 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 systemd[1]: Stopped Network Time Service.
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 113.207.49.85 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 202.118.1.130 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 111.230.189.174 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 84.16.67.12 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 ntpd[2576]: 78.46.102.180 local addr 192.168.0.23 ->
Mar 18 10:49:00 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: running
Mar 18 10:49:00 smsl-n100 systemd[1]: Starting Network Time Service...
Mar 18 10:49:00 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: CoreStateMachine::pushState
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioPushState
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output update for this device
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: MRS: Pushing multiroomSync output
Mar 18 10:49:00 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:49:00 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: MAXVOL, message:
Mar 18 10:49:00 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 100, message: undefined
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: MCU Signalled PowerOff Capabilities, enabling MCU Poweroff
Mar 18 10:49:00 smsl-n100 volumio[2975]: error: Serial API: Failed to decode command: 3, message: undefined
Mar 18 10:49:00 smsl-n100 ntpd[3733]: ntpd 4.2.8p12@1.3728-o (1): Starting
Mar 18 10:49:00 smsl-n100 ntpd[3733]: Command line: /usr/sbin/ntpd -p /var/run/ntpd.pid -g -u 104:103
Mar 18 10:49:00 smsl-n100 volumio[2975]: ------------------------------------ BT MESSAGE: BT STATUS: running
Mar 18 10:49:00 smsl-n100 systemd[1]: Started Network Time Service.
Mar 18 10:49:00 smsl-n100 ntpd[3739]: proto: precision = 1.166 usec (-20)
Mar 18 10:49:00 smsl-n100 ntpd[3739]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): good hash signature
Mar 18 10:49:00 smsl-n100 ntpd[3739]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): loaded, expire=2022-12-28T00:00:00Z last=2017-01-01T00:00:00Z ofs=37
Mar 18 10:49:00 smsl-n100 ntpd[3739]: leapsecond file ('/usr/share/zoneinfo/leap-seconds.list'): expired less than 812 days ago
Mar 18 10:49:00 smsl-n100 ntpd[3739]: Listen and drop on 0 v6wildcard [::]:123
Mar 18 10:49:00 smsl-n100 ntpd[3739]: Listen and drop on 1 v4wildcard 0.0.0.0:123
Mar 18 10:49:00 smsl-n100 ntpd[3739]: Listen normally on 2 lo 127.0.0.1:123
Mar 18 10:49:00 smsl-n100 ntpd[3739]: Listen normally on 3 eth0 192.168.0.23:123
Mar 18 10:49:00 smsl-n100 ntpd[3739]: Listen normally on 4 wlan0 192.168.0.24:123
Mar 18 10:49:00 smsl-n100 ntpd[3739]: Listening on routing socket on fd #21 for interface updates
Mar 18 10:49:00 smsl-n100 ntpd[3739]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized
Mar 18 10:49:00 smsl-n100 ntpd[3739]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: CURURI: music-library
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: Preload queue cleared
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: Discovery: this is already registered, f27ca38c-d778-4dd6-9a9e-5cb4a4817be3
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: Discovery: Found device SMSL N100
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: CoreCommandRouter::volumioGetState
Mar 18 10:49:00 smsl-n100 volumio[2975]: info: CorePlayQueue::getTrack 0
Mar 18 10:49:00 smsl-n100 volumio[2975]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Mar 18 10:49:00 smsl-n100 volumio[2975]: Error: The value NaN is not a number
Mar 18 10:49:00 smsl-n100 volumio[2975]: at Config.forceToType (/volumio/node_modules/v-conf/index.js:322:20)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at Config.set (/volumio/node_modules/v-conf/index.js:153:25)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at ControllerVolumioDiscovery.updateMultiroomDevice (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:323:25)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at ControllerVolumioDiscovery.connectToRemoteVolumio (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:273:10)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at Browser. (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:192:12)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at Browser.emit (events.js:400:28)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at on_resolver_done (/volumio/node_modules/mdns/lib/browser.js:31:14)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at next (/volumio/node_modules/mdns/lib/browser.js:106:7)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at Array.makeAddressesUnique (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:177:5)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at next (/volumio/node_modules/mdns/lib/browser.js:109:21)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at /volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:160:11
Mar 18 10:49:00 smsl-n100 volumio[2975]: at getaddrinfo_complete (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:108:7)
Mar 18 10:49:00 smsl-n100 volumio[2975]: at GetAddrInfoReqWrap.oncomplete (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:120:9)
Mar 18 10:49:00 smsl-n100 volumio[2975]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Mar 18 10:49:01 smsl-n100 ntpd[3739]: Soliciting pool server 193.182.111.141
Mar 18 10:49:01 smsl-n100 sudo[3753]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-03-18 10:48
Mar 18 10:49:01 smsl-n100 sudo[3753]: 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="8205c9d25502d90d2bb411bb156e1d5a8ef7404e"
VOLUMIO_ARCH="armv7"
VOLUMIO_VARIANT="smsl"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Mon 20 Jan 2025 07:23:13 PM CET"
VOLUMIO_VERSION="3.788"
VOLUMIO_HARDWARE="nanopineo3"
VOLUMIO_DEVICENAME="Nanopi Neo3"
VOLUMIO_VENDOR_MODEL="SMSL S100"
VOLUMIO_VENDOR="SMSL"
VOLUMIO_MODEL="S100"
VOLUMIO_HASH="b3195a7f5841a4bc08e3e196c1a91b34"