-- Logs begin at Fri 2019-01-11 23:37:59 UTC, end at Fri 2025-05-30 11:31:33 UTC. -- May 30 11:30:22 livingroom volumio[839]: info: Enabling plugin spop May 30 11:30:22 livingroom volumio[839]: info: Loading plugin "spop"... May 30 11:30:28 livingroom volumio[839]: info: PLUGIN START: spop May 30 11:30:29 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback May 30 11:30:29 livingroom volumio[839]: [SpotifyConnect] Creating VLS config file May 30 11:30:29 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:30:29 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:30:29 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:30:29 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:30:29 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:30:29 livingroom volumio[839]: [SpotifyConnect] Starting metadata listener May 30 11:30:29 livingroom sudo[13443]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/hosts May 30 11:30:29 livingroom sudo[13443]: pam_unix(sudo:session): session opened for user root by (uid=0) May 30 11:30:29 livingroom sudo[13443]: pam_unix(sudo:session): session closed for user root May 30 11:30:29 livingroom sudo[13450]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volspotconnect.service May 30 11:30:29 livingroom volumio[839]: [SpotifyConnect] Error: bind EADDRINUSE 0.0.0.0:5030 May 30 11:30:29 livingroom volumio[839]: at Object._errnoException (util.js:1022:11) May 30 11:30:29 livingroom volumio[839]: at _exceptionWithHostPort (util.js:1044:20) May 30 11:30:29 livingroom volumio[839]: at _handle.lookup (dgram.js:266:18) May 30 11:30:29 livingroom volumio[839]: at _combinedTickCallback (internal/process/next_tick.js:141:11) May 30 11:30:29 livingroom volumio[839]: at process._tickCallback (internal/process/next_tick.js:180:9) May 30 11:30:29 livingroom volumio[839]: [SpotifyConnect] Error [ERR_SOCKET_CANNOT_SEND]: Unable to send data May 30 11:30:29 livingroom volumio[839]: at Socket.onListenError (dgram.js:362:22) May 30 11:30:29 livingroom volumio[839]: at Object.onceWrapper (events.js:315:30) May 30 11:30:29 livingroom volumio[839]: at emitOne (events.js:121:20) May 30 11:30:29 livingroom volumio[839]: at Socket.emit (events.js:211:7) May 30 11:30:29 livingroom volumio[839]: at _handle.lookup (dgram.js:267:14) May 30 11:30:29 livingroom volumio[839]: at _combinedTickCallback (internal/process/next_tick.js:141:11) May 30 11:30:29 livingroom volumio[839]: at process._tickCallback (internal/process/next_tick.js:180:9) May 30 11:30:29 livingroom sudo[13450]: pam_unix(sudo:session): session opened for user root by (uid=0) May 30 11:30:30 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:30 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:30 livingroom sudo[13450]: pam_unix(sudo:session): session closed for user root May 30 11:30:30 livingroom volumio[13457]: /usr/lib/startconnect.sh: line 5: 13458 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:31 livingroom volumio[839]: [SpotifyConnect] Vollibrespot Daemon service started! May 30 11:30:31 livingroom volumio[839]: SpotifyConnect: 2512.810ms May 30 11:30:31 livingroom volumio[839]: info: Done. May 30 11:30:31 livingroom volumio[839]: info: CoreCommandRouter::getUIConfigOnPlugin May 30 11:30:32 livingroom volumio[839]: info: Successfully fixed Spotify hosts May 30 11:30:32 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:32 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:32 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:32 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:32 livingroom volumio[13470]: /usr/lib/startconnect.sh: line 5: 13472 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:33 livingroom sudo[13473]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 30 11:30:33 livingroom sudo[13473]: pam_unix(sudo:session): session opened for user root by (uid=0) May 30 11:30:33 livingroom sudo[13476]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 30 11:30:33 livingroom sudo[13476]: pam_unix(sudo:session): session opened for user root by (uid=0) May 30 11:30:33 livingroom sudo[13473]: pam_unix(sudo:session): session closed for user root May 30 11:30:33 livingroom sudo[13476]: pam_unix(sudo:session): session closed for user root May 30 11:30:33 livingroom volumio[839]: info: CoreCommandRouter::volumioGetBrowseSources May 30 11:30:33 livingroom volumio[839]: info: CoreCommandRouter::volumioGetState May 30 11:30:33 livingroom volumio[839]: info: CoreStateMachine::getState May 30 11:30:33 livingroom volumio[839]: info: CorePlayQueue::getTrack 0 May 30 11:30:33 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings May 30 11:30:33 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard May 30 11:30:33 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard May 30 11:30:33 livingroom sudo[13501]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 30 11:30:34 livingroom sudo[13501]: pam_unix(sudo:session): session opened for user root by (uid=0) May 30 11:30:34 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 30 11:30:34 livingroom volumio[839]: info: Listing playlists May 30 11:30:34 livingroom sudo[13501]: pam_unix(sudo:session): session closed for user root May 30 11:30:34 livingroom sudo[13505]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 30 11:30:34 livingroom sudo[13505]: pam_unix(sudo:session): session opened for user root by (uid=0) May 30 11:30:34 livingroom sudo[13505]: pam_unix(sudo:session): session closed for user root May 30 11:30:34 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:34 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:34 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:34 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:34 livingroom volumio[13529]: /usr/lib/startconnect.sh: line 5: 13530 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:35 livingroom volumio[839]: info: Checking Spotify Web API May 30 11:30:37 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:37 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:37 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:37 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:37 livingroom volumio[13546]: /usr/lib/startconnect.sh: line 5: 13547 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:37 livingroom volumio[839]: info: [{"prettyName":"Spotify","name":"spop","category":"music_service","version":"3.0.3","icon":"fa-spotify","enabled":true,"active":true},{"prettyName":"Volumio Spotify Connect2","name":"volspotconnect2","category":"music_service","version":"1.0.5","icon":"fa-spotify","enabled":true,"active":true}] May 30 11:30:39 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:39 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:39 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:39 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:39 livingroom volumio[13563]: /usr/lib/startconnect.sh: line 5: 13564 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:41 livingroom volumio[839]: info: CoreCommandRouter::getUIConfigOnPlugin May 30 11:30:41 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:41 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:41 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:41 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:41 livingroom volumio[13580]: /usr/lib/startconnect.sh: line 5: 13581 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:43 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:43 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:43 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:43 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:43 livingroom volumio[13599]: /usr/lib/startconnect.sh: line 5: 13600 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:46 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:46 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:46 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:46 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:46 livingroom volumio[13616]: /usr/lib/startconnect.sh: line 5: 13617 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:48 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:48 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:48 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:48 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:48 livingroom volumio[13633]: /usr/lib/startconnect.sh: line 5: 13634 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:50 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:50 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:50 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:50 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:50 livingroom volumio[13650]: /usr/lib/startconnect.sh: line 5: 13651 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:52 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:52 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:52 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:52 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:52 livingroom volumio[13667]: /usr/lib/startconnect.sh: line 5: 13668 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:55 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:55 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:55 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:55 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:55 livingroom volumio[13684]: /usr/lib/startconnect.sh: line 5: 13685 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:57 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:57 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:57 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:57 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:57 livingroom volumio[13701]: /usr/lib/startconnect.sh: line 5: 13702 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:30:59 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:30:59 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:30:59 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:30:59 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:30:59 livingroom volumio[13718]: /usr/lib/startconnect.sh: line 5: 13719 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:31:01 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:31:01 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:31:01 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:31:01 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:31:01 livingroom volumio[13735]: /usr/lib/startconnect.sh: line 5: 13736 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:31:04 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:31:04 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:31:04 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:31:04 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:31:04 livingroom volumio[13753]: /usr/lib/startconnect.sh: line 5: 13754 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:31:06 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:31:06 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:31:06 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:31:06 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:31:06 livingroom volumio[839]: info: CALLMETHOD: music_service spop saveVolspotconnectAccount [object Object] May 30 11:31:06 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: spop , saveVolspotconnectAccount May 30 11:31:06 livingroom volumio[839]: [SpotifyConnect] Creating VLS config file May 30 11:31:06 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:31:06 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:31:06 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:31:06 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:31:06 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 30 11:31:06 livingroom volumio[13770]: /usr/lib/startconnect.sh: line 5: 13771 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:31:06 livingroom volumio[839]: [SpotifyConnect] Restarting Vollibrespot Daemon May 30 11:31:06 livingroom sudo[13774]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volspotconnect.service May 30 11:31:06 livingroom sudo[13774]: pam_unix(sudo:session): session opened for user root by (uid=0) May 30 11:31:06 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:31:06 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:31:06 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:31:06 livingroom sudo[13774]: pam_unix(sudo:session): session closed for user root May 30 11:31:07 livingroom volumio[839]: [SpotifyConnect] Vollibrespot Daemon service restarted! May 30 11:31:07 livingroom volumio[13779]: /usr/lib/startconnect.sh: line 5: 13783 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:31:09 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:31:09 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:31:09 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:31:09 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:31:09 livingroom volumio[13799]: /usr/lib/startconnect.sh: line 5: 13800 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:31:11 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:31:11 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:31:11 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:31:11 livingroom systemd[1]: Started Volspotconnect2 Daemon. May 30 11:31:11 livingroom volumio[13816]: /usr/lib/startconnect.sh: line 5: 13817 Illegal instruction .$SPOP_PLUGIN_DATA -c /tmp/volspotify.toml May 30 11:31:13 livingroom volumio[839]: info: Checking Spotify Web API May 30 11:31:13 livingroom systemd[1]: volspotconnect.service holdoff time over, scheduling restart. May 30 11:31:13 livingroom systemd[1]: Stopping Volspotconnect2 Daemon... May 30 11:31:13 livingroom systemd[1]: Starting Volspotconnect2 Daemon... May 30 11:31:13 livingroom systemd[1]: volspotconnect.service start request repeated too quickly, refusing to start. May 30 11:31:13 livingroom systemd[1]: Failed to start Volspotconnect2 Daemon. May 30 11:31:13 livingroom systemd[1]: Unit volspotconnect.service entered failed state. May 30 11:31:25 livingroom volumio[839]: info: CALLMETHOD: music_service spop saveVolspotconnectSettings [object Object] May 30 11:31:25 livingroom volumio[839]: info: CoreCommandRouter::executeOnPlugin: spop , saveVolspotconnectSettings May 30 11:31:25 livingroom volumio[839]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 30 11:31:25 livingroom volumio[839]: TypeError: Cannot read property 'config' of undefined May 30 11:31:25 livingroom volumio[839]: at ControllerSpotify.saveVolspotconnectSettings (/data/plugins/music_service/spop/index.js:2612:19) May 30 11:31:25 livingroom volumio[839]: at CoreCommandRouter.executeOnPlugin (/volumio/app/index.js:1018:29) May 30 11:31:25 livingroom volumio[839]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:307:38) May 30 11:31:25 livingroom volumio[839]: at emitTwo (events.js:126:13) May 30 11:31:25 livingroom volumio[839]: at Socket.emit (events.js:214:7) May 30 11:31:25 livingroom volumio[839]: at /volumio/node_modules/socket.io/lib/socket.js:503:12 May 30 11:31:25 livingroom volumio[839]: at _combinedTickCallback (internal/process/next_tick.js:131:7) May 30 11:31:25 livingroom volumio[839]: at process._tickCallback (internal/process/next_tick.js:180:9) May 30 11:31:25 livingroom volumio[839]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 30 11:31:33 livingroom sudo[13919]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-05-30 11:30 May 30 11:31:33 livingroom sudo[13919]: 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="91bc32a3daa69e09170e613c40f8b5c279962098" VOLUMIO_FE_VERSION="9511ab07247d3b65ded550111191469fa3626bd6" VOLUMIO_BE_VERSION="78de34390ebc5df0b086e244ca969a4e0ddc40d1" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sat Jan 12 00:37:59 CET 2019" VOLUMIO_VERSION="2.526" VOLUMIO_HARDWARE="pi" VOLUMIO_HASH="fe6efee3fc492df251c9b38e25d0dec3"