-- Logs begin at Fri 2025-05-02 18:02:08 UTC, end at Fri 2025-05-02 18:04:58 UTC. -- May 02 18:03:00 eddieland volumio[924]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... May 02 18:03:01 eddieland volumio[924]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded May 02 18:03:01 eddieland volumio[924]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio May 02 18:03:01 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 02 18:03:01 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 02 18:03:01 eddieland volumio[924]: info: Starting MyVolumio Remote Streaming Endpoints May 02 18:03:01 eddieland volumio[924]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded May 02 18:03:01 eddieland volumio[924]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services May 02 18:03:01 eddieland volumio[924]: info: Streaming services startup May 02 18:03:01 eddieland volumio[924]: info: Starting Streaming Daemon May 02 18:03:01 eddieland volumio[924]: info: MyVolumio not started May 02 18:03:01 eddieland volumio[924]: info: Initializing device activation check May 02 18:03:01 eddieland sudo[1132]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service May 02 18:03:01 eddieland sudo[1132]: pam_unix(sudo:session): session opened for user root by (uid=0) May 02 18:03:01 eddieland systemd[1]: Stopping Volumio Streaming Daemon... May 02 18:03:01 eddieland volumio[924]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started May 02 18:03:01 eddieland systemd[1]: Starting Volumio Streaming Daemon... May 02 18:03:01 eddieland systemd[1]: Started Volumio Streaming Daemon. May 02 18:03:01 eddieland sudo[1132]: pam_unix(sudo:session): session closed for user root May 02 18:03:01 eddieland volumio-streaming-daemon[1138]: ############################ May 02 18:03:01 eddieland volumio-streaming-daemon[1138]: # Volumio Streaming Daemon # May 02 18:03:01 eddieland volumio-streaming-daemon[1138]: # Running on port 7777 # May 02 18:03:01 eddieland volumio-streaming-daemon[1138]: ############################ May 02 18:03:01 eddieland volumio-streaming-daemon[1138]: Environment: production May 02 18:03:04 eddieland volumio-remote-updater[602]: [2025-05-02 18:03:04] [connect] Successful connection May 02 18:03:04 eddieland volumio-remote-updater[602]: [2025-05-02 18:03:04] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.5.1" /socket.io/?EIO=4&transport=websocket&t=1746208984 101 May 02 18:03:04 eddieland volumio-streaming-daemon[1138]: Environment: production May 02 18:03:04 eddieland volumio[924]: info: Fetching Streaming Services browse cache May 02 18:03:04 eddieland volumio[924]: info: CoreCommandRouter::volumioRemoveToBrowseSourcesTIDAL May 02 18:03:04 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 02 18:03:04 eddieland volumio[924]: info: CoreCommandRouter::volumioRemoveToBrowseSourcesQOBUZ May 02 18:03:04 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 02 18:03:05 eddieland volumio[924]: info: Cannot call home: Error: Command failed: /usr/bin/curl -X POST --data-binary "device=pi&variante=volumio&version=2.853&uuid=bde66e4c5c211ff9c3d49228195a74f1" http://updates.volumio.org:7070/downloader-v1/track-device May 02 18:03:05 eddieland volumio[924]: % Total % Received % Xferd Average Speed Time Time Time Current May 02 18:03:05 eddieland volumio[924]: Dload Upload Total Spent Left Speed May 02 18:03:05 eddieland volumio[924]: 0 0 0 0 0 0 0 0 --:--:-- --:--:-- --:--:-- 0curl: (7) Failed to connect to updates.volumio.org port 7070: Connection refused May 02 18:03:05 eddieland volumio[924]: retrying in 5 seconds, trial 0 May 02 18:03:05 eddieland volumio[924]: Volumio Calling Home May 02 18:03:12 eddieland sudo[1177]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 02 18:03:12 eddieland sudo[1177]: pam_unix(sudo:session): session opened for user root by (uid=0) May 02 18:03:12 eddieland sudo[1179]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 02 18:03:12 eddieland sudo[1177]: pam_unix(sudo:session): session closed for user root May 02 18:03:12 eddieland sudo[1179]: pam_unix(sudo:session): session opened for user root by (uid=0) May 02 18:03:12 eddieland sudo[1179]: pam_unix(sudo:session): session closed for user root May 02 18:03:13 eddieland sudo[1197]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 02 18:03:13 eddieland sudo[1197]: pam_unix(sudo:session): session opened for user root by (uid=0) May 02 18:03:13 eddieland sudo[1200]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 02 18:03:13 eddieland sudo[1197]: pam_unix(sudo:session): session closed for user root May 02 18:03:13 eddieland sudo[1200]: pam_unix(sudo:session): session opened for user root by (uid=0) May 02 18:03:13 eddieland sudo[1200]: pam_unix(sudo:session): session closed for user root May 02 18:03:13 eddieland volumio[924]: info: CoreCommandRouter::volumioGetState May 02 18:03:13 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:13 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 02 18:03:13 eddieland volumio[924]: info: Listing playlists May 02 18:03:13 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings May 02 18:03:13 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard May 02 18:03:13 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard May 02 18:03:13 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus May 02 18:03:15 eddieland volumio[924]: info: Cannot call home: Error: Command failed: /usr/bin/curl -X POST --data-binary "device=pi&variante=volumio&version=2.853&uuid=bde66e4c5c211ff9c3d49228195a74f1" http://updates.volumio.org:7070/downloader-v1/track-device May 02 18:03:15 eddieland volumio[924]: % Total % Received % Xferd Average Speed Time Time Time Current May 02 18:03:15 eddieland volumio[924]: Dload Upload Total Spent Left Speed May 02 18:03:15 eddieland volumio[924]: 0 0 0 0 0 0 0 0 --:--:-- --:--:-- --:--:-- 0curl: (7) Failed to connect to updates.volumio.org port 7070: Connection refused May 02 18:03:15 eddieland volumio[924]: retrying in 5 seconds, trial 1 May 02 18:03:15 eddieland volumio[924]: Volumio Calling Home May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::getUIConfigOnPlugin May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::getUIConfigOnPlugin May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 02 18:03:15 eddieland volumio[924]: info: CoreCommandRouter::volumioGetBrowseSources May 02 18:03:16 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:16 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares May 02 18:03:19 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 02 18:03:19 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 02 18:03:20 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:21 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: networkfs , deleteShare May 02 18:03:22 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares May 02 18:03:24 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:25 eddieland volumio[924]: info: Cannot call home: Error: Command failed: /usr/bin/curl -X POST --data-binary "device=pi&variante=volumio&version=2.853&uuid=bde66e4c5c211ff9c3d49228195a74f1" http://updates.volumio.org:7070/downloader-v1/track-device May 02 18:03:25 eddieland volumio[924]: % Total % Received % Xferd Average Speed Time Time Time Current May 02 18:03:25 eddieland volumio[924]: Dload Upload Total Spent Left Speed May 02 18:03:25 eddieland volumio[924]: 0 0 0 0 0 0 0 0 --:--:-- --:--:-- --:--:-- 0curl: (7) Failed to connect to updates.volumio.org port 7070: Connection refused May 02 18:03:25 eddieland volumio[924]: retrying in 5 seconds, trial 2 May 02 18:03:25 eddieland volumio[924]: Volumio Calling Home May 02 18:03:26 eddieland volumio[924]: verbose: ControllerMpd::sendMpdCommand status May 02 18:03:26 eddieland volumio[924]: info: May 02 18:03:26 eddieland volumio[924]: ---------------------------- MPD announces state update: update May 02 18:03:26 eddieland volumio[924]: info: ControllerMpd::getState May 02 18:03:26 eddieland volumio[924]: verbose: ControllerMpd::sendMpdCommand status May 02 18:03:26 eddieland volumio[924]: verbose: ControllerMpd::sendMpdCommand status May 02 18:03:26 eddieland volumio[924]: info: May 02 18:03:26 eddieland volumio[924]: ---------------------------- MPD announces state update: update May 02 18:03:26 eddieland volumio[924]: info: ControllerMpd::getState May 02 18:03:26 eddieland volumio[924]: verbose: ControllerMpd::sendMpdCommand status May 02 18:03:26 eddieland volumio[924]: verbose: ControllerMpd::parseState May 02 18:03:27 eddieland volumio[924]: info: Command Router : Notfying DB Updatefalse May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::Close All Modals sent May 02 18:03:27 eddieland volumio[924]: verbose: ControllerMpd::parseState May 02 18:03:27 eddieland volumio[924]: verbose: ControllerMpd::parseState May 02 18:03:27 eddieland volumio[924]: info: Command Router : Notfying DB Updatefalse May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::Close All Modals sent May 02 18:03:27 eddieland volumio[924]: verbose: ControllerMpd::parseState May 02 18:03:27 eddieland volumio[924]: info: ControllerMpd::pushState May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::servicePushState May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::pushState May 02 18:03:27 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::volumioPushState May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 02 18:03:27 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:27 eddieland volumio[924]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} May 02 18:03:27 eddieland volumio[924]: verbose: CURRENT POSITION 0 May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::syncState stateService stop May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::syncState currentStatus stop May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::pushState May 02 18:03:27 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::volumioPushState May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 02 18:03:27 eddieland volumio[924]: info: No code May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::pushState May 02 18:03:27 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::volumioPushState May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 02 18:03:27 eddieland volumio[924]: info: ControllerMpd::pushState May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::servicePushState May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::pushState May 02 18:03:27 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::volumioPushState May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 02 18:03:27 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:27 eddieland volumio[924]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} May 02 18:03:27 eddieland volumio[924]: verbose: CURRENT POSITION 0 May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::syncState stateService stop May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::syncState currentStatus stop May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::pushState May 02 18:03:27 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::volumioPushState May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 02 18:03:27 eddieland volumio[924]: info: No code May 02 18:03:27 eddieland volumio[924]: info: CoreStateMachine::pushState May 02 18:03:27 eddieland volumio[924]: info: CorePlayQueue::getTrack 0 May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::volumioPushState May 02 18:03:27 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 02 18:03:27 eddieland volumio[924]: info: ------------------------------ 698ms May 02 18:03:27 eddieland volumio[924]: info: ------------------------------ 694ms May 02 18:03:28 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:32 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:36 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:41 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:45 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:49 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:53 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:03:57 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:01 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:05 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:09 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:13 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:17 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:21 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:25 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:30 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:33 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:37 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:41 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:45 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:51 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:52 eddieland sudo[987]: pam_unix(sudo:session): session closed for user root May 02 18:04:52 eddieland volumio[924]: info: Cannot mount NAS containertje at system boot, trial number 1 ,retrying in 5 seconds May 02 18:04:53 eddieland volumio[924]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats May 02 18:04:57 eddieland volumio[924]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 02 18:04:57 eddieland volumio[924]: TypeError: Cannot read property 'replace' of undefined May 02 18:04:57 eddieland volumio[924]: at ControllerNetworkfs.mountShare (/volumio/app/plugins/system_controller/networkfs/index.js:198:28) May 02 18:04:57 eddieland volumio[924]: at Timeout._onTimeout (/volumio/app/plugins/system_controller/networkfs/index.js:251:20) May 02 18:04:57 eddieland volumio[924]: at ontimeout (timers.js:482:11) May 02 18:04:57 eddieland volumio[924]: at tryOnTimeout (timers.js:317:5) May 02 18:04:57 eddieland volumio[924]: at Timer.listOnTimeout (timers.js:277:5) May 02 18:04:57 eddieland volumio[924]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 02 18:04:58 eddieland sudo[1487]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-05-02 18:03 May 02 18:04:58 eddieland sudo[1487]: 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="2c20ceacdd8365d3bd2fdff070d8c78700ff2903" VOLUMIO_FE_VERSION="fa55af43e5eb642e968aa6de2f8a985962941d63" VOLUMIO_BE_VERSION="c9e4849495e810bd6ebb6833232daba25d86dd4c" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri Nov 20 20:05:14 CET 2020" VOLUMIO_VERSION="2.853" VOLUMIO_HARDWARE="pi" VOLUMIO_HASH="f7f9725bb5ce7d6da77135f468c28964"