-- Logs begin at Wed 2024-10-09 20:42:42 UTC, end at Wed 2024-10-09 20:54:20 UTC. --
Oct 09 20:53:00 volumiopi0w volumio[828]: info: Loading plugin "appearance"...
Oct 09 20:53:09 volumiopi0w nmbd[716]: [2024/10/09 20:53:09.575402, 0] ../source3/nmbd/nmbd_namequery.c:109(query_name_response)
Oct 09 20:53:09 volumiopi0w nmbd[716]: query_name_response: Multiple (2) responses received for a query on subnet 192.168.1.169 for name WORKGROUP<1d>.
Oct 09 20:53:09 volumiopi0w nmbd[716]: This response was from IP 192.168.1.174, reporting an IP address of 192.168.1.174.
Oct 09 20:53:10 volumiopi0w volumio[828]: info: Loading plugin "network"...
Oct 09 20:53:10 volumiopi0w volumio[828]: info: Refreshing Cached IP Addresses
Oct 09 20:53:10 volumiopi0w volumio[828]: info: Loading plugin "services"...
Oct 09 20:53:10 volumiopi0w sudo[880]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Oct 09 20:53:11 volumiopi0w volumio[828]: info: Loading plugin "alsa_controller"...
Oct 09 20:53:11 volumiopi0w sudo[880]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:11 volumiopi0w sudo[880]: pam_unix(sudo:session): session closed for user root
Oct 09 20:53:11 volumiopi0w sudo[882]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Oct 09 20:53:11 volumiopi0w sudo[882]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:11 volumiopi0w sudo[882]: pam_unix(sudo:session): session closed for user root
Oct 09 20:53:11 volumiopi0w volumio[828]: info: Loading plugin "wizard"...
Oct 09 20:53:11 volumiopi0w volumio[828]: info: Loading plugin "volumio_command_line_client"...
Oct 09 20:53:11 volumiopi0w volumio[828]: info: Loading plugin "upnp"...
Oct 09 20:53:11 volumiopi0w volumio[828]: info: [1728507191776] Starting Upmpd Daemon
Oct 09 20:53:11 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Oct 09 20:53:11 volumiopi0w volumio[828]: info: Loading plugin "my_music"...
Oct 09 20:53:11 volumiopi0w volumio[828]: info: Loading plugin "mpd"...
Oct 09 20:53:12 volumiopi0w volumio-remote-updater[477]: [2024-10-09 20:53:12] [connect] Successful connection
Oct 09 20:53:13 volumiopi0w volumio[828]: info: Loading plugin "upnp_browser"...
Oct 09 20:53:15 volumiopi0w volumio[828]: info: Loading plugin "networkfs"...
Oct 09 20:53:16 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Oct 09 20:53:16 volumiopi0w volumio[828]: info: Loading plugin "alarm-clock"...
Oct 09 20:53:17 volumiopi0w volumio[828]: info: Alarm: Scheduling Playlist Radiok at 4:0
Oct 09 20:53:17 volumiopi0w volumio[828]: info: Loading plugin "airplay_emulation"...
Oct 09 20:53:17 volumiopi0w volumio[828]: info: Starting Shairport Sync
Oct 09 20:53:17 volumiopi0w volumio[828]: info: Loading plugin "last_100"...
Oct 09 20:53:17 volumiopi0w volumio[828]: info: Loading plugin "webradio"...
Oct 09 20:53:17 volumiopi0w volumio[828]: info: Loading plugin "i2s_dacs"...
Oct 09 20:53:17 volumiopi0w volumio[828]: info: I2S DAC not set, start Auto-detection
Oct 09 20:53:17 volumiopi0w volumio[828]: info: Loading plugin "volumiodiscovery"...
Oct 09 20:53:18 volumiopi0w volumio[828]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi.
Oct 09 20:53:18 volumiopi0w node[828]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi.
Oct 09 20:53:18 volumiopi0w node[828]: *** WARNING *** Please fix your application to use the native API of Avahi!
Oct 09 20:53:18 volumiopi0w node[828]: *** WARNING *** For more information see
Oct 09 20:53:18 volumiopi0w node[828]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi.
Oct 09 20:53:18 volumiopi0w node[828]: *** WARNING *** Please fix your application to use the native API of Avahi!
Oct 09 20:53:18 volumiopi0w node[828]: *** WARNING *** For more information see
Oct 09 20:53:18 volumiopi0w volumio[828]: *** WARNING *** Please fix your application to use the native API of Avahi!
Oct 09 20:53:18 volumiopi0w volumio[828]: *** WARNING *** For more information see
Oct 09 20:53:18 volumiopi0w volumio[828]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi.
Oct 09 20:53:18 volumiopi0w volumio[828]: *** WARNING *** Please fix your application to use the native API of Avahi!
Oct 09 20:53:18 volumiopi0w volumio[828]: *** WARNING *** For more information see
Oct 09 20:53:18 volumiopi0w volumio[828]: info: Applying required configuration parameters for plugin volumiodiscovery
Oct 09 20:53:18 volumiopi0w volumio[828]: Discovery: StartAdv! undefined
Oct 09 20:53:18 volumiopi0w volumio[828]: Discovery: Started advertising... Volumiopi0w - undefined
Oct 09 20:53:18 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Oct 09 20:53:18 volumiopi0w volumio[828]: info: Loading plugin "auto_play"...
Oct 09 20:53:18 volumiopi0w volumio[828]: info: ControllerAutoPlay - connecting mpd on host: localhost; port: 6600
Oct 09 20:53:18 volumiopi0w volumio[828]: info: Loading plugin "autostart"...
Oct 09 20:53:19 volumiopi0w volumio[828]: info: Applying required configuration parameters for plugin autostart
Oct 09 20:53:19 volumiopi0w volumio[828]: info: Loading plugin "outputs"...
Oct 09 20:53:19 volumiopi0w volumio[828]: info: Loading plugin "albumart"...
Oct 09 20:53:19 volumiopi0w volumio[828]: info: Plugin example_plugin is not enabled
Oct 09 20:53:19 volumiopi0w volumio[828]: info: Loading plugin "inputs"...
Oct 09 20:53:19 volumiopi0w volumio[828]: info: Loading plugin "updater_comm"...
Oct 09 20:53:20 volumiopi0w volumio[828]: info: Plugin mpdemulation is not enabled
Oct 09 20:53:20 volumiopi0w volumio[828]: info: Loading plugin "rest_api"...
Oct 09 20:53:20 volumiopi0w volumio[828]: info: Loading plugin "websocket"...
Oct 09 20:53:21 volumiopi0w volumio[828]: info: Plugin ir_controller is not enabled
Oct 09 20:53:21 volumiopi0w volumio[828]: info: Loading plugin "80s80s"...
Oct 09 20:53:22 volumiopi0w volumio[828]: Forking 1 albumart workers
Oct 09 20:53:23 volumiopi0w volumio[828]: info: Applying required configuration parameters for plugin 80s80s
Oct 09 20:53:23 volumiopi0w volumio[828]: info: [1728507203757] [80s80s] API delay: 30
Oct 09 20:53:23 volumiopi0w volumio[828]: info: Loading plugin "hotelradio"...
Oct 09 20:53:27 volumiopi0w volumio-remote-updater[477]: [2024-10-09 20:53:27] [connect] Successful connection
Oct 09 20:53:28 volumiopi0w volumio[828]: Starting albumart workers
Oct 09 20:53:33 volumiopi0w volumio[828]: info: Loading plugin "spop"...
Oct 09 20:53:39 volumiopi0w volumio[828]: info: Loading plugin "ledstatus"...
Oct 09 20:53:42 volumiopi0w volumio[828]: info: Applying required configuration parameters for plugin ledstatus
Oct 09 20:53:42 volumiopi0w volumio[828]: info: Loading plugin "rotaryencoder"...
Oct 09 20:53:42 volumiopi0w volumio-remote-updater[477]: [2024-10-09 20:53:42] [connect] Successful connection
Oct 09 20:53:44 volumiopi0w volumio[828]: info: Applying required configuration parameters for plugin rotaryencoder
Oct 09 20:53:44 volumiopi0w volumio[828]: info: ___________ START PLUGINS ___________
Oct 09 20:53:44 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Oct 09 20:53:44 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Oct 09 20:53:44 volumiopi0w volumio[828]: info: [1728507224842] CoreMusicLibrary::Adding element Media Servers
Oct 09 20:53:44 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Oct 09 20:53:45 volumiopi0w volumio[828]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Oct 09 20:53:45 volumiopi0w volumio[828]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Oct 09 20:53:45 volumiopi0w volumio[828]: info: [1728507225382] CoreMusicLibrary::Adding element Last_100
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Oct 09 20:53:45 volumiopi0w volumio[828]: info: [1728507225402] CoreMusicLibrary::Adding element Webradio
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Oct 09 20:53:45 volumiopi0w volumio[828]: info: [1728507225488] CoreMusicLibrary::Adding element 80s80s Radio
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Oct 09 20:53:45 volumiopi0w volumio[828]: [SpotifyConnect] Creating VLS config file
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:45 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:45 volumiopi0w sudo[950]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/hosts
Oct 09 20:53:45 volumiopi0w volumio[828]: [SpotifyConnect] Starting metadata listener
Oct 09 20:53:45 volumiopi0w sudo[950]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:45 volumiopi0w sudo[950]: pam_unix(sudo:session): session closed for user root
Oct 09 20:53:45 volumiopi0w volumio[828]: info: LedStatus : init GPIO
Oct 09 20:53:46 volumiopi0w sudo[959]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volspotconnect.service
Oct 09 20:53:46 volumiopi0w sudo[959]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:46 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:53:46 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:53:46 volumiopi0w volumio[975]: /usr/lib/startconnect.sh: line 5: 981 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:53:46 volumiopi0w volumio[828]: info: -------------------------------------------
Oct 09 20:53:46 volumiopi0w volumio[828]: info: ----- MyVolumio plugins startup ----
Oct 09 20:53:46 volumiopi0w volumio[828]: info: -------------------------------------------
Oct 09 20:53:46 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Fetching plans data....
Oct 09 20:53:46 volumiopi0w volumio[828]: info: Loading i18n strings for locale en
Oct 09 20:53:46 volumiopi0w volumio[828]: Updating browse sources language
Oct 09 20:53:46 volumiopi0w volumio[828]: Cannot find translation for sourceMedia Servers
Oct 09 20:53:46 volumiopi0w volumio[828]: Cannot find translation for source80s80s Radio
Oct 09 20:53:46 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::initPlayerControls
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getAlsaCards
Oct 09 20:53:47 volumiopi0w sudo[959]: pam_unix(sudo:session): session closed for user root
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Oct 09 20:53:47 volumiopi0w volumio[828]: info: BOOT COMPLETED
Oct 09 20:53:47 volumiopi0w volumio[828]: [Metrics] CommandRouter: 53s 651.12ms
Oct 09 20:53:47 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:53:49 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:53:49 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:53:49 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:53:49 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:53:49 volumiopi0w volumio[1004]: /usr/lib/startconnect.sh: line 5: 1005 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:53:51 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:53:51 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:53:51 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:53:51 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:53:51 volumiopi0w volumio[1007]: /usr/lib/startconnect.sh: line 5: 1008 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:53:52 volumiopi0w volumio[828]: Playing WAVE '/volumio/app/startup.wav' : Signed 16 bit Little Endian, Rate 44100 Hz, Stereo
Oct 09 20:53:52 volumiopi0w volumio[828]: info: CoreCommandRouter::Close All Modals sent
Oct 09 20:53:52 volumiopi0w volumio[828]: info: CoreCommandRouter::Close All Modals sent
Oct 09 20:53:52 volumiopi0w volumio[828]: Express server listening on port 3000
Oct 09 20:53:52 volumiopi0w volumio[828]: [Metrics] WebUI: 61s 637.99ms
Oct 09 20:53:53 volumiopi0w volumio[828]: Volumio Calling Home
Oct 09 20:53:53 volumiopi0w volumio[828]: (node:828) Warning: N-API is an experimental feature and could change at any time.
Oct 09 20:53:53 volumiopi0w volumio[828]: info: CoreStateMachine::resetVolumioState
Oct 09 20:53:53 volumiopi0w volumio[828]: info: CoreStateMachine::getcurrentVolume
Oct 09 20:53:53 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioRetrievevolume
Oct 09 20:53:53 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:53:53 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:53:53 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:53:53 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:53:53 volumiopi0w volumio[1017]: /usr/lib/startconnect.sh: line 5: 1018 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:53:54 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable
Oct 09 20:53:54 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus
Oct 09 20:53:54 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect
Oct 09 20:53:54 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:53:54 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Oct 09 20:53:54 volumiopi0w sudo[1023]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Oct 09 20:53:54 volumiopi0w sudo[1023]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:54 volumiopi0w sudo[1025]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Oct 09 20:53:54 volumiopi0w sudo[1023]: pam_unix(sudo:session): session closed for user root
Oct 09 20:53:54 volumiopi0w sudo[1025]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:54 volumiopi0w sudo[1025]: pam_unix(sudo:session): session closed for user root
Oct 09 20:53:54 volumiopi0w volumio[828]: info: Volumio called home
Oct 09 20:53:54 volumiopi0w volumio[828]: info: Setting Device type: Raspberry PI
Oct 09 20:53:54 volumiopi0w volumio[828]: [SpotifyConnect] Vollibrespot Daemon service started!
Oct 09 20:53:54 volumiopi0w volumio[828]: [Metrics] SpotifyConnect: 9s 293.67ms
Oct 09 20:53:55 volumiopi0w volumio[828]: info: MPD running with PID554
Oct 09 20:53:55 volumiopi0w volumio[828]: ,establishing connection
Oct 09 20:53:55 volumiopi0w sudo[1044]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/sbin/i2cdetect -y 1
Oct 09 20:53:55 volumiopi0w sudo[1044]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:55 volumiopi0w sudo[1044]: pam_unix(sudo:session): session closed for user root
Oct 09 20:53:55 volumiopi0w volumio[828]: info: VolumeController:: Volume=50 Mute =false
Oct 09 20:53:55 volumiopi0w volumio[828]: info: CoreStateMachine::pushState
Oct 09 20:53:55 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:53:55 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:53:55 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:53:55 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:53:55 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioPushState
Oct 09 20:53:56 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Oct 09 20:53:56 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:53:56 volumiopi0w volumio[828]: info: CoreStateMachine::updateTrackBlock
Oct 09 20:53:56 volumiopi0w volumio[828]: info: CorePlayQueue::getTrackBlock
Oct 09 20:53:56 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioRetrievevolume
Oct 09 20:53:56 volumiopi0w volumio[1052]: /usr/lib/startconnect.sh: line 5: 1053 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:53:56 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:53:56 volumiopi0w volumio[828]: info: Reloading queue from file
Oct 09 20:53:57 volumiopi0w volumio[828]: error: updateQueue error: null
Oct 09 20:53:57 volumiopi0w volumio[828]: error: Failed LSINFO: Error: [50@0] {} No such directory
Oct 09 20:53:57 volumiopi0w volumio-remote-updater[477]: [2024-10-09 20:53:57] [connect] Successful connection
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CoreStateMachine::setRepeat null single undefined
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CoreStateMachine::pushState
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioPushState
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CoreStateMachine::setRandom null
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CoreStateMachine::pushState
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioPushState
Oct 09 20:53:57 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Oct 09 20:53:58 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:53:58 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:53:58 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:53:58 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:53:58 volumiopi0w volumio[1058]: /usr/lib/startconnect.sh: line 5: 1059 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:53:58 volumiopi0w volumio[828]: info: VolumeController:: Volume=50 Mute =false
Oct 09 20:53:58 volumiopi0w volumio[828]: info: CoreStateMachine::pushState
Oct 09 20:53:58 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:53:58 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioPushState
Oct 09 20:53:58 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Oct 09 20:53:59 volumiopi0w volumio-remote-updater[477]: [2024-10-09 20:53:59] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.5.1" /socket.io/?EIO=4&transport=websocket&t=1728507237 101
Oct 09 20:53:59 volumiopi0w volumio[828]: info: Checking Spotify Web API
Oct 09 20:53:59 volumiopi0w volumio[828]: info: Starting Shairport Sync
Oct 09 20:53:59 volumiopi0w volumio[828]: info: Starting Shairport Sync
Oct 09 20:53:59 volumiopi0w sudo[1062]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Oct 09 20:53:59 volumiopi0w sudo[1062]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:59 volumiopi0w sudo[1064]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Oct 09 20:53:59 volumiopi0w systemd[1]: Starting Shairport Sync - AirPlay Audio Receiver...
Oct 09 20:53:59 volumiopi0w systemd[1]: Started Shairport Sync - AirPlay Audio Receiver.
Oct 09 20:53:59 volumiopi0w sudo[1064]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:59 volumiopi0w sudo[1062]: pam_unix(sudo:session): session closed for user root
Oct 09 20:53:59 volumiopi0w sudo[1070]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service
Oct 09 20:53:59 volumiopi0w systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver...
Oct 09 20:53:59 volumiopi0w sudo[1070]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:53:59 volumiopi0w systemd[1]: Starting Shairport Sync - AirPlay Audio Receiver...
Oct 09 20:53:59 volumiopi0w systemd[1]: Started Shairport Sync - AirPlay Audio Receiver.
Oct 09 20:53:59 volumiopi0w sudo[1064]: pam_unix(sudo:session): session closed for user root
Oct 09 20:54:00 volumiopi0w systemd[1]: Starting UPnP Renderer front-end to MPD...
Oct 09 20:54:00 volumiopi0w systemd[1]: Started UPnP Renderer front-end to MPD.
Oct 09 20:54:00 volumiopi0w sudo[1070]: pam_unix(sudo:session): session closed for user root
Oct 09 20:54:00 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:00 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:00 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:00 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:00 volumiopi0w volumio[1100]: /usr/lib/startconnect.sh: line 5: 1102 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:00 volumiopi0w volumio[828]: Discovery: adding 4535ef88-8098-417a-bad9-afbc9387c539
Oct 09 20:54:00 volumiopi0w volumio[828]: info: mDNS: Found device Volumiopi0w
Oct 09 20:54:00 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioGetState
Oct 09 20:54:00 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso
Oct 09 20:54:01 volumiopi0w volumio[828]: info: Adding plugin bluetooth to MyMusic Plugins
Oct 09 20:54:01 volumiopi0w volumio[828]: info: Adding plugin cd_controller to MyMusic Plugins
Oct 09 20:54:01 volumiopi0w volumio[828]: info: Adding plugin smart_inputs to MyMusic Plugins
Oct 09 20:54:01 volumiopi0w volumio[828]: info: Adding plugin tidalconnect to MyMusic Plugins
Oct 09 20:54:01 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"...
Oct 09 20:54:02 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:02 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:02 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:02 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:02 volumiopi0w volumio[1104]: /usr/lib/startconnect.sh: line 5: 1105 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:04 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"...
Oct 09 20:54:04 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:04 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:04 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:04 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:05 volumiopi0w volumio[1107]: /usr/lib/startconnect.sh: line 5: 1108 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:05 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded
Oct 09 20:54:05 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio
Oct 09 20:54:05 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:05 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:05 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:05 volumiopi0w volumio[828]: info: Starting MyVolumio Remote Streaming Endpoints
Oct 09 20:54:05 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded
Oct 09 20:54:05 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services
Oct 09 20:54:05 volumiopi0w volumio[828]: info: Streaming services startup
Oct 09 20:54:05 volumiopi0w volumio[828]: info: Starting Streaming Daemon
Oct 09 20:54:05 volumiopi0w sudo[1111]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service
Oct 09 20:54:05 volumiopi0w sudo[1111]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:54:05 volumiopi0w volumio[828]: info: MyVolumio login type: Token
Oct 09 20:54:05 volumiopi0w volumio[828]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started
Oct 09 20:54:05 volumiopi0w systemd[1]: Stopping Volumio Streaming Daemon...
Oct 09 20:54:06 volumiopi0w systemd[1]: Starting Volumio Streaming Daemon...
Oct 09 20:54:06 volumiopi0w systemd[1]: Started Volumio Streaming Daemon.
Oct 09 20:54:06 volumiopi0w sudo[1111]: pam_unix(sudo:session): session closed for user root
Oct 09 20:54:06 volumiopi0w volumio-streaming-daemon[1121]: ############################
Oct 09 20:54:06 volumiopi0w volumio-streaming-daemon[1121]: # Volumio Streaming Daemon #
Oct 09 20:54:06 volumiopi0w volumio-streaming-daemon[1121]: # Running on port 7777 #
Oct 09 20:54:06 volumiopi0w volumio-streaming-daemon[1121]: ############################
Oct 09 20:54:06 volumiopi0w volumio-streaming-daemon[1121]: Environment: production
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus: state = stop
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus: stop => switch off led
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus : remove blinking interval
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus: state = stop
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus: stop => switch off led
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus : remove blinking interval
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus: state = stop
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus: stop => switch off led
Oct 09 20:54:06 volumiopi0w volumio[828]: info: LedStatus : remove blinking interval
Oct 09 20:54:06 volumiopi0w volumio[828]: info: Upmpdcli Daemon Started
Oct 09 20:54:06 volumiopi0w volumio[828]: info: Shairport-Sync Started
Oct 09 20:54:06 volumiopi0w volumio[828]: Error adding Membership: Error: addMembership EINVAL
Oct 09 20:54:06 volumiopi0w volumio[828]: info: Shairport-Sync Started
Oct 09 20:54:07 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:07 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:07 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:07 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:07 volumiopi0w volumio[1128]: /usr/lib/startconnect.sh: line 5: 1129 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:07 volumiopi0w volumio[828]: info: ControllerAutoPlay - mpd ready
Oct 09 20:54:07 volumiopi0w volumio[828]: info: [ASDebug] CurState: stop PrevState: na
Oct 09 20:54:07 volumiopi0w volumio[828]: info: [ASDebug] InitTimeout - Amp off in: 720 ms
Oct 09 20:54:07 volumiopi0w volumio[828]: info: [ASDebug] CurState: stop PrevState: na
Oct 09 20:54:07 volumiopi0w volumio[828]: info: [ASDebug] InitTimeout - Amp off in: 720 ms
Oct 09 20:54:08 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioGetState
Oct 09 20:54:08 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:08 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioGetState
Oct 09 20:54:08 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:08 volumiopi0w volumio[828]: info: [ASDebug] Togle GPIO: OFF
Oct 09 20:54:08 volumiopi0w volumio[828]: info: [ASDebug] CurState: stop PrevState: stop
Oct 09 20:54:09 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:09 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:09 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:09 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:09 volumiopi0w volumio[1140]: /usr/lib/startconnect.sh: line 5: 1144 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:09 volumiopi0w sudo[1134]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Oct 09 20:54:10 volumiopi0w sudo[1134]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:54:10 volumiopi0w sudo[1134]: pam_unix(sudo:session): session closed for user root
Oct 09 20:54:10 volumiopi0w sudo[1150]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Oct 09 20:54:10 volumiopi0w sudo[1150]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:54:10 volumiopi0w sudo[1150]: pam_unix(sudo:session): session closed for user root
Oct 09 20:54:10 volumiopi0w volumio-streaming-daemon[1121]: Environment: production
Oct 09 20:54:10 volumiopi0w volumio[828]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN
Oct 09 20:54:10 volumiopi0w volumio[828]: info: MYVOLUMIO: Adding device
Oct 09 20:54:10 volumiopi0w volumio[828]: info: MYVOLUMIO: Evaluating Server
Oct 09 20:54:11 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:11 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:11 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:11 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:11 volumiopi0w volumio[1187]: /usr/lib/startconnect.sh: line 5: 1188 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:12 volumiopi0w volumio[828]: info: Fetching Streaming Services browse cache
Oct 09 20:54:12 volumiopi0w volumio[828]: info: ControllerAutoPlay - getting queue
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioGetQueue
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CoreStateMachine::getQueue
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CorePlayQueue::getQueue
Oct 09 20:54:12 volumiopi0w volumio[828]: info: ControllerAutoPlay - start playing -> queue is not empty
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioPlay
Oct 09 20:54:12 volumiopi0w volumio[828]: verbose: UNSET VOLATILE
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CoreStateMachine::play index undefined
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CoreStateMachine::setConsumeUpdateService undefined
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CoreStateMachine::startPlaybackTimer
Oct 09 20:54:12 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:12 volumiopi0w volumio[828]: info: [1728507252879] [80s80s] clearAddPlayTrack url: http://streams.90s90s.de/pop/mp3-192/volumio
Oct 09 20:54:12 volumiopi0w volumio[828]: info: [1728507252886] [80s80s] getContentOfUrl started with url http://iris-90s90s.loverad.io/flow.json?station=141&count=2
Oct 09 20:54:13 volumiopi0w sudo[1194]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Oct 09 20:54:13 volumiopi0w sudo[1194]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:54:13 volumiopi0w sudo[1196]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Oct 09 20:54:13 volumiopi0w sudo[1194]: pam_unix(sudo:session): session closed for user root
Oct 09 20:54:13 volumiopi0w sudo[1196]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:54:13 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:13 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:13 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:13 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:14 volumiopi0w sudo[1196]: pam_unix(sudo:session): session closed for user root
Oct 09 20:54:14 volumiopi0w volumio[1209]: /usr/lib/startconnect.sh: line 5: 1212 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:15 volumiopi0w volumio[828]: info: MyVolumio status changed
Oct 09 20:54:15 volumiopi0w volumio[828]: info: Streaming services startup
Oct 09 20:54:15 volumiopi0w volumio[828]: info: Re-Starting Streaming Daemon
Oct 09 20:54:15 volumiopi0w volumio[828]: info: Removing browser output: myVolumio user plan is not superstar
Oct 09 20:54:15 volumiopi0w volumio[828]: info: Removing audio output:
Oct 09 20:54:15 volumiopi0w volumio[828]: info: Stoppping Tunnel 1
Oct 09 20:54:15 volumiopi0w sudo[1234]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop sshtunnel.service
Oct 09 20:54:15 volumiopi0w volumio[828]: info: [1728507255300] [80s80s] received new event containing 2 songs.
Oct 09 20:54:15 volumiopi0w sudo[1234]: pam_unix(sudo:session): session opened for user root by (uid=0)
Oct 09 20:54:15 volumiopi0w volumio[828]: verbose: ControllerMpd::sendMpdCommand stop
Oct 09 20:54:15 volumiopi0w systemd[1]: Stopped MyVolumio SSH Tunnel.
Oct 09 20:54:15 volumiopi0w sudo[1234]: pam_unix(sudo:session): session closed for user root
Oct 09 20:54:15 volumiopi0w volumio-streaming-daemon[1121]: Restarting daemon
Oct 09 20:54:15 volumiopi0w volumio-streaming-daemon[1121]: Environment: production
Oct 09 20:54:15 volumiopi0w volumio[828]: /usr/bin/md5sum: /sys/class/net/eth0/address: No such file or directory
Oct 09 20:54:15 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:15 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Oct 09 20:54:15 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:15 volumiopi0w volumio[828]: info: sendMpdCommand stop took 327 milliseconds
Oct 09 20:54:15 volumiopi0w volumio[828]: verbose: ControllerMpd::sendMpdCommand clear
Oct 09 20:54:15 volumiopi0w volumio[828]: info: Setting Geolocation for MyVolumio to eu7
Oct 09 20:54:15 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:15 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:15 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:15 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Oct 09 20:54:15 volumiopi0w volumio[828]: info: Remote SSH Stopped
Oct 09 20:54:15 volumiopi0w volumio[828]: info:
Oct 09 20:54:15 volumiopi0w volumio[828]: ---------------------------- MPD announces system playlist update
Oct 09 20:54:15 volumiopi0w volumio[828]: info: Ignoring MPD Status Update
Oct 09 20:54:15 volumiopi0w volumio[828]: info: sendMpdCommand clear took 255 milliseconds
Oct 09 20:54:15 volumiopi0w volumio[828]: verbose: ControllerMpd::sendMpdCommand consume 1
Oct 09 20:54:15 volumiopi0w volumio[828]: error: updateQueue error: null
Oct 09 20:54:15 volumiopi0w volumio[828]: info:
Oct 09 20:54:15 volumiopi0w volumio[828]: ---------------------------- MPD announces state update: options
Oct 09 20:54:15 volumiopi0w volumio[828]: info: ------------------------------ 49ms
Oct 09 20:54:15 volumiopi0w volumio[828]: info: sendMpdCommand consume 1 took 31 milliseconds
Oct 09 20:54:15 volumiopi0w volumio[828]: info: ControllerMpd::getState
Oct 09 20:54:15 volumiopi0w volumio[828]: verbose: ControllerMpd::sendMpdCommand status
Oct 09 20:54:15 volumiopi0w volumio[828]: info: [1728507255973] [80s80s] adding url: http://streams.90s90s.de/pop/mp3-192/volumio
Oct 09 20:54:15 volumiopi0w volumio[828]: verbose: ControllerMpd::sendMpdCommand add "http://streams.90s90s.de/pop/mp3-192/volumio"
Oct 09 20:54:15 volumiopi0w volumio[828]: info:
Oct 09 20:54:15 volumiopi0w volumio[828]: ---------------------------- MPD announces system playlist update
Oct 09 20:54:16 volumiopi0w volumio[828]: info: Ignoring MPD Status Update
Oct 09 20:54:16 volumiopi0w volumio[828]: info: sendMpdCommand status took 34 milliseconds
Oct 09 20:54:16 volumiopi0w volumio[828]: info: sendMpdCommand add "http://streams.90s90s.de/pop/mp3-192/volumio" took 26 milliseconds
Oct 09 20:54:16 volumiopi0w volumio[828]: verbose: ControllerMpd::parseState
Oct 09 20:54:16 volumiopi0w volumio[828]: verbose: ControllerMpd::sendMpdCommand play
Oct 09 20:54:16 volumiopi0w volumio[828]: info: ControllerMpd::pushState
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreCommandRouter::servicePushState
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreStateMachine::pushState
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioPushState
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:16 volumiopi0w volumio[828]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current 80s80s Received mpd
Oct 09 20:54:16 volumiopi0w volumio[828]: info: ------------------------------ 187ms
Oct 09 20:54:16 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:16 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:16 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:16 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:16 volumiopi0w volumio[828]: info: ------------------------------ 329ms
Oct 09 20:54:16 volumiopi0w volumio[828]: info: sendMpdCommand play took 285 milliseconds
Oct 09 20:54:16 volumiopi0w volumio[1247]: /usr/lib/startconnect.sh: line 5: 1248 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:16 volumiopi0w volumio[828]: info: [1728507256348] [80s80s] Pushing the next song state: Rollergirl - Dear Jessie
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreCommandRouter::servicePushState
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:16 volumiopi0w volumio[828]: verbose: STATE SERVICE {"status":"play","service":"80s80s","type":"track","trackType":"80s80s Radio","radioType":"80s80s","albumart":"https://is3-ssl.mzstatic.com/image/thumb/Music7/v4/19/06/0d/19060dc0-6084-3a6a-6441-5eefd2693457/source/600x600bb.jpg","name":"Rollergirl - Dear Jessie","title":"Dear Jessie","artist":"90s90s Hits","album":"","streaming":true,"disableUiControls":true,"duration":"239","seek":0,"samplerate":"44.1 KHz","bitdepth":"16 bit","channels":2}
Oct 09 20:54:16 volumiopi0w volumio[828]: verbose: CURRENT POSITION 0
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreStateMachine::syncState stateService play
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreStateMachine::syncState currentStatus stop
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreStateMachine::pushState
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CorePlayQueue::getTrack 0
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreCommandRouter::volumioPushState
Oct 09 20:54:16 volumiopi0w volumio[828]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Oct 09 20:54:16 volumiopi0w volumio[828]: info: [1728507256479] [80s80s] PlayNextTrack API delay: 30
Oct 09 20:54:16 volumiopi0w volumio[828]: info: [1728507256584] [80s80s] Setting timer to: 239000 milliseconds.
Oct 09 20:54:16 volumiopi0w volumio[828]: info: LedStatus: state = stop
Oct 09 20:54:16 volumiopi0w volumio[828]: info: LedStatus: stop => switch off led
Oct 09 20:54:16 volumiopi0w volumio[828]: info: LedStatus : remove blinking interval
Oct 09 20:54:16 volumiopi0w volumio[828]: info: LedStatus: state = play
Oct 09 20:54:16 volumiopi0w volumio[828]: info: LedStatus: play => start blinking led
Oct 09 20:54:16 volumiopi0w volumio[828]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Oct 09 20:54:16 volumiopi0w volumio[828]: Error: The value undefined is not a number
Oct 09 20:54:16 volumiopi0w volumio[828]: at Config.forceToType (/data/plugins/user_interface/ledstatus/node_modules/v-conf/index.js:322:20)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Config.get (/data/plugins/user_interface/ledstatus/node_modules/v-conf/index.js:137:21)
Oct 09 20:54:16 volumiopi0w volumio[828]: at ledstatus.startBlink (/data/plugins/user_interface/ledstatus/index.js:93:31)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Socket. (/data/plugins/user_interface/ledstatus/index.js:41:26)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Socket.Emitter.emit (/data/plugins/user_interface/ledstatus/node_modules/component-emitter/index.js:133:20)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Socket.onevent (/data/plugins/user_interface/ledstatus/node_modules/socket.io-client/lib/socket.js:270:10)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Socket.onpacket (/data/plugins/user_interface/ledstatus/node_modules/socket.io-client/lib/socket.js:228:12)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Manager. (/data/plugins/user_interface/ledstatus/node_modules/component-bind/index.js:21:15)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Manager.Emitter.emit (/data/plugins/user_interface/ledstatus/node_modules/component-emitter/index.js:133:20)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Manager.ondecoded (/data/plugins/user_interface/ledstatus/node_modules/socket.io-client/lib/manager.js:332:8)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Decoder. (/data/plugins/user_interface/ledstatus/node_modules/component-bind/index.js:21:15)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Decoder.Emitter.emit (/data/plugins/user_interface/ledstatus/node_modules/socket.io-parser/node_modules/component-emitter/index.js:134:20)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Decoder.add (/data/plugins/user_interface/ledstatus/node_modules/socket.io-parser/index.js:246:12)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Manager.ondata (/data/plugins/user_interface/ledstatus/node_modules/socket.io-client/lib/manager.js:322:16)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Socket. (/data/plugins/user_interface/ledstatus/node_modules/component-bind/index.js:21:15)
Oct 09 20:54:16 volumiopi0w volumio[828]: at Socket.Emitter.emit (/data/plugins/user_interface/ledstatus/node_modules/component-emitter/index.js:133:20)
Oct 09 20:54:16 volumiopi0w volumio[828]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Oct 09 20:54:18 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:18 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:18 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:18 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:18 volumiopi0w volumio[1258]: /usr/lib/startconnect.sh: line 5: 1259 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:20 volumiopi0w systemd[1]: volspotconnect.service holdoff time over, scheduling restart.
Oct 09 20:54:20 volumiopi0w systemd[1]: Stopping Volspotconnect2 Daemon...
Oct 09 20:54:20 volumiopi0w systemd[1]: Starting Volspotconnect2 Daemon...
Oct 09 20:54:20 volumiopi0w systemd[1]: Started Volspotconnect2 Daemon.
Oct 09 20:54:20 volumiopi0w sudo[1262]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-10-09 20:53
Oct 09 20:54:20 volumiopi0w volumio[1263]: /usr/lib/startconnect.sh: line 5: 1264 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml
Oct 09 20:54:20 volumiopi0w sudo[1262]: pam_unix(sudo:session): session opened for user root by (uid=0)
PRETTY_NAME="Raspbian GNU/Linux 8 (jessie)"
NAME="Raspbian GNU/Linux"
VERSION_ID="8"
VERSION="8 (jessie)"
ID=raspbian
ID_LIKE=debian
HOME_URL="http://www.raspbian.org/"
SUPPORT_URL="http://www.raspbian.org/RaspbianForums"
BUG_REPORT_URL="http://www.raspbian.org/RaspbianBugs"
VOLUMIO_BUILD_VERSION="dd2a4339faaeb892c7f467e7dc8d424aefb0bd03"
VOLUMIO_FE_VERSION="958dedc0edff114f244fa9acc70cf53089d9e5ae"
VOLUMIO_BE_VERSION="fd3e37ffec12db034ec93f94dbc26e5495d5b91a"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Wed Oct 6 12:34:49 CEST 2021"
VOLUMIO_VERSION="2.917"
VOLUMIO_HARDWARE="pi"
VOLUMIO_HASH="98c8f08c531a6f0456f17ab17795e35f"