-- Logs begin at Thu 2019-02-14 10:11:59 UTC, end at Mon 2025-04-21 17:37:35 UTC. -- Apr 21 17:36:01 volumio-gutanw sudo[1364]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/DYSK AUDIO /mnt/NAS/DYSK_AUDIO Apr 21 17:36:01 volumio-gutanw sudo[1364]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:02 volumio-gutanw systemd[1]: systemd-timedated.service: Succeeded. Apr 21 17:36:03 volumio-gutanw volumio[1347]: ................................................++++ Apr 21 17:36:06 volumio-gutanw sudo[1226]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:06 volumio-gutanw volumio[1168]: info: Cannot mount NAS JAPAN_MUZYK at system boot, trial number 1 ,retrying in 5 seconds Apr 21 17:36:06 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:36:06 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:36:06 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/Music Apr 21 17:36:10 volumio-gutanw volumio[1347]: ..................................................++++ Apr 21 17:36:10 volumio-gutanw volumio[1347]: e is 65537 (0x010001) Apr 21 17:36:10 volumio-gutanw volumio[1347]: writing RSA key Apr 21 17:36:12 volumio-gutanw sudo[1403]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/JAPAN MUZYK /mnt/NAS/JAPAN_MUZYK Apr 21 17:36:12 volumio-gutanw sudo[1403]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:16 volumio-gutanw sudo[1230]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:16 volumio-gutanw volumio[1168]: info: Cannot mount NAS Music at system boot, trial number 1 ,retrying in 5 seconds Apr 21 17:36:16 volumio-gutanw volumio[1168]: info: Completed loading Core Plugins Apr 21 17:36:16 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:36:16 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:36:16 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/DYSK AUDIO Apr 21 17:36:16 volumio-gutanw volumio[1168]: info: Preparing to generate the ALSA configuration file Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Asound.conf file unchanged, so no further update is needed Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Output device has changed, restarting MPD Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Output device has changed, restarting Shairport Sync Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: ___________ START PLUGINS ___________ Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: ControllerMpd::onStart: Initializing MPD Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Creating MPD Configuration file Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: [1745256977139] CoreMusicLibrary::Adding element Serwery Mediów Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 21 17:36:17 volumio-gutanw sudo[1432]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Apr 21 17:36:17 volumio-gutanw sudo[1432]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:17 volumio-gutanw sudo[1430]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Apr 21 17:36:17 volumio-gutanw sudo[1430]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:17 volumio-gutanw sudo[1430]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw systemd[1]: Stopping Music Player Daemon... Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:17 volumio-gutanw sudo[1437]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Apr 21 17:36:17 volumio-gutanw sudo[1437]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:17 volumio-gutanw sudo[1437]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:17 volumio-gutanw sudo[1439]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Apr 21 17:36:17 volumio-gutanw sudo[1439]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: [1745256977327] CoreMusicLibrary::Adding element Last_100 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: [1745256977332] CoreMusicLibrary::Adding element Webradio Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Initializing BBC Radios Apr 21 17:36:17 volumio-gutanw systemd[1]: mpd.service: Succeeded. Apr 21 17:36:17 volumio-gutanw systemd[1]: Stopped Music Player Daemon. Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Creating Spotify config file Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw systemd[1]: Starting Music Player Daemon... Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: [1745256977546] CoreMusicLibrary::Adding element YouTube2 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 21 17:36:17 volumio-gutanw volumio[1168]: Cannot find translation for source YouTube2 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: [1745256977558] CoreMusicLibrary::Adding element YouTube Music Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 21 17:36:17 volumio-gutanw volumio[1168]: Cannot find translation for source YouTube2 Apr 21 17:36:17 volumio-gutanw volumio[1168]: Cannot find translation for source YouTube Music Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: [1745256977568] CoreMusicLibrary::Adding element RADIO 357 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 21 17:36:17 volumio-gutanw volumio[1168]: Cannot find translation for source YouTube2 Apr 21 17:36:17 volumio-gutanw volumio[1168]: Cannot find translation for source YouTube Music Apr 21 17:36:17 volumio-gutanw volumio[1168]: Cannot find translation for source RADIO 357 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Volumio Calling Home Apr 21 17:36:17 volumio-gutanw sudo[1453]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Apr 21 17:36:17 volumio-gutanw sudo[1453]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:17 volumio-gutanw sudo[1453]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: MPD Permissions set Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: MPD Permissions set Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Spotify config file written Apr 21 17:36:17 volumio-gutanw volumio[1168]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 4 Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: No need to fix Spotify hosts Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw sudo[1467]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart go-librespot-daemon.service Apr 21 17:36:17 volumio-gutanw sudo[1467]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:17 volumio-gutanw systemd[1]: Started go-librespot Daemon. Apr 21 17:36:17 volumio-gutanw go-librespot[1477]: Librespot-go daemon starting... Apr 21 17:36:17 volumio-gutanw sudo[1467]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Volumio called home Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Starting Shairport Sync Apr 21 17:36:17 volumio-gutanw volumio[1168]: info: Starting Shairport Sync Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: Starting Shairport Sync Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:18 volumio-gutanw sudo[1482]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 21 17:36:18 volumio-gutanw sudo[1480]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 21 17:36:18 volumio-gutanw sudo[1482]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:18 volumio-gutanw sudo[1480]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:18 volumio-gutanw sudo[1484]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 21 17:36:18 volumio-gutanw sudo[1484]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:18 volumio-gutanw systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Apr 21 17:36:18 volumio-gutanw systemd[1]: shairport-sync.service: Succeeded. Apr 21 17:36:18 volumio-gutanw systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Apr 21 17:36:18 volumio-gutanw volumio[1168]: SPOTIFY: ------------------------------------------------------ ACCESS TOKEN ------------------------------------------------------ Apr 21 17:36:18 volumio-gutanw volumio[1168]: SPOTIFY: BQDAYsxIK_TOPFQmdyMk_F2jI1d0onx7Kn5Gw6w3VP51FkLKaHOdHGxQaFgSacw9xz_MJbVgLt5edF9ik0i5WXmZy0pjn5os47KQ6yZ-NLBuFkzxFdUhOA4GnHcfWSYnbBMd3e36swUXLjnvumWySRGEb2dwS5aXeKztMaV-LhMRzGPGFN8GOla-K0WlKr1k3KvcwPbrCFxxulvdR8JHKxLIg4cgPTtUVow3BKJ09MO6-_OM4ewtxIHtC7erzP8jy0moubX7y-CLOWpHAonZkgdOZOtxiu5LrJZ3X_U Apr 21 17:36:18 volumio-gutanw volumio[1168]: SPOTIFY: ------------------------------------------------------ ACCESS TOKEN ------------------------------------------------------ Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: New Spotify access token = BQDAYsxIK_TOPFQmdyMk_F2jI1d0onx7Kn5Gw6w3VP51FkLKaHOdHGxQaFgSacw9xz_MJbVgLt5edF9ik0i5WXmZy0pjn5os47KQ6yZ-NLBuFkzxFdUhOA4GnHcfWSYnbBMd3e36swUXLjnvumWySRGEb2dwS5aXeKztMaV-LhMRzGPGFN8GOla-K0WlKr1k3KvcwPbrCFxxulvdR8JHKxLIg4cgPTtUVow3BKJ09MO6-_OM4ewtxIHtC7erzP8jy0moubX7y-CLOWpHAonZkgdOZOtxiu5LrJZ3X_U Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: Spotify credentials grant success - running version from March 24, 2019 Apr 21 17:36:18 volumio-gutanw systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Apr 21 17:36:18 volumio-gutanw sudo[1484]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:18 volumio-gutanw sudo[1482]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:18 volumio-gutanw sudo[1480]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: Shairport-Sync Started Apr 21 17:36:18 volumio-gutanw volumio[1168]: Error adding Membership: Error: addMembership EINVAL Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: Shairport-Sync Started Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: Shairport-Sync Started Apr 21 17:36:18 volumio-gutanw volumio[1168]: SPOTIFY: User informations: {"country":"PL","display_name":"Grzegorz","email":"grzegorz.czopik@poczta.fm","explicit_content":{"filter_enabled":false,"filter_locked":false},"external_urls":{"spotify":"https://open.spotify.com/user/ignnj3g0iv1fmo79xq88t6439"},"followers":{"href":null,"total":0},"href":"https://api.spotify.com/v1/users/ignnj3g0iv1fmo79xq88t6439","id":"ignnj3g0iv1fmo79xq88t6439","images":[],"product":"free","type":"user","uri":"spotify:user:ignnj3g0iv1fmo79xq88t6439"} Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: Spotify Successfully logged in Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: [1745256978465] CoreMusicLibrary::Adding element Spotify Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 21 17:36:18 volumio-gutanw volumio[1168]: Cannot find translation for source YouTube2 Apr 21 17:36:18 volumio-gutanw volumio[1168]: Cannot find translation for source YouTube Music Apr 21 17:36:18 volumio-gutanw volumio[1168]: Cannot find translation for source RADIO 357 Apr 21 17:36:18 volumio-gutanw volumio[1168]: Cannot find translation for source Spotify Apr 21 17:36:18 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:18Z" level=info msg="generated new device id: 4dddeb8e58bebca11b4288dac12ebde32f31e0b8" Apr 21 17:36:18 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:18Z" level=debug msg="stored credentials found for ignnj3g0iv1fmo79xq88t6439" Apr 21 17:36:18 volumio-gutanw volumiologrotate[608]: ls: cannot access '/var/log/samba/log.wb-VOLUMIO': No such file or directory Apr 21 17:36:18 volumio-gutanw volumiologrotate[608]: ls: cannot access 'GUTANÓW': No such file or directory Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:18 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:36:19 volumio-gutanw volumio[1168]: verbose: New Socket.io Connection to 192.168.1.161:3000 from 192.168.1.199 UA: Dart/3.4 (dart:io) Engine version: 3 Transport: websocket Total Clients: 5 Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Apr 21 17:36:19 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:19Z" level=debug msg="fetched new accesspoints: [ap-gew4.spotify.com:4070 ap-gew4.spotify.com:443 ap-gew4.spotify.com:80 ap-guc3.spotify.com:4070 ap-gew1.spotify.com:443 ap-gae2.spotify.com:80]" Apr 21 17:36:19 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:19Z" level=debug msg="fetched new dealers: [gew4-dealer.spotify.com:443 guc3-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gae2-dealer.spotify.com:443]" Apr 21 17:36:19 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:19Z" level=debug msg="fetched new spclients: [gew4-spclient.spotify.com:443 guc3-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gae2-spclient.spotify.com:443]" Apr 21 17:36:19 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:19Z" level=debug msg="zeroconf server listening on port 35853" Apr 21 17:36:19 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:19Z" level=debug msg="obtained new client token: AABYhjWzXR2LuReZvawYie9jHTBrQh3QYAceVKXzDl5r2+czwNv8RCAFP3AEEkoiZysXFor9tEvD/WkZQ4n2jxY9sSL3+/Gnr2Gr5iwcOzEMvbNw1XpNs7+B2gjfMPtdtBGN01TRozUKNbTx9nPsnllrZijh88rUrEnZWvXrDSc82rqmjxg6tK7ZGD9zNpavHr2VrbTLukADsRcmu4+PuqGOcy560/Hvj6U4VbmZn+qp1JyvqZqN7yLKIiQ=" Apr 21 17:36:19 volumio-gutanw mpd[1465]: Apr 21 17:36 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Apr 21 17:36:19 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:19Z" level=info msg="connected to ap-gew4.spotify.com:4070" Apr 21 17:36:19 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:19Z" level=debug msg="completed keyexchange" Apr 21 17:36:19 volumio-gutanw systemd[1]: Started Music Player Daemon. Apr 21 17:36:19 volumio-gutanw sudo[1439]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:19 volumio-gutanw sudo[1432]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: Completed starting Core Plugins Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: ------------------------------------------- Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: ----- MyVolumio plugins startup ---- Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: ------------------------------------------- Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Fetching plans data.... Apr 21 17:36:19 volumio-gutanw volumio[1168]: error: MPD error: The expression evaluated to a falsy value: Apr 21 17:36:19 volumio-gutanw volumio[1168]: assert.ok(self.idling) Apr 21 17:36:19 volumio-gutanw volumio[1168]: error: The expression evaluated to a falsy value: Apr 21 17:36:19 volumio-gutanw volumio[1168]: assert.ok(self.idling) Apr 21 17:36:19 volumio-gutanw volumio[1168]: info: MPD running with PID1465 Apr 21 17:36:19 volumio-gutanw volumio[1168]: ,establishing connection Apr 21 17:36:19 volumio-gutanw volumio[1168]: error: MPD error: The expression evaluated to a falsy value: Apr 21 17:36:19 volumio-gutanw volumio[1168]: assert.ok(self.idling) Apr 21 17:36:19 volumio-gutanw volumio[1168]: error: The expression evaluated to a falsy value: Apr 21 17:36:19 volumio-gutanw volumio[1168]: assert.ok(self.idling) Apr 21 17:36:19 volumio-gutanw volumio[1168]: error: updateQueue error: null Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="completed challenge" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="authenticated as ignnj3g0iv1fmo79xq88t6439" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="authenticated as ignnj3g0iv1fmo79xq88t6439" Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="dealer connection opened" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="initializing zeroconf session, username: ignnj3g0iv1fmo79xq88t6439" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="skipping packet PacketTypeSecretBlock, len: 336" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="skipping packet PacketTypeLicenseVersion, len: 2" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="skipping packet PacketTypeUnknown1f, len: 17" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="skipping packet PacketTypeLegacyWelcome, len: 0" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="skipping packet PacketTypeMercuryEvent, len: 481" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="autoplay enabled: false" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="received connection id: OTg3MzY4MDktNjVjMi00N2Y4LTgxNTgtZTQwZWE0NzdlMWUzK2RlYWxlcit0Y3A6Ly8wYWNhNWEzMy5pcC5nZXc0LnNwb3RpZnkubmV0OjU3MDArQ0NCMjlENkI5OURFMTFFRDg0Rjk1ODUxRTA2ODExMzdCQzhBOEYxM0JFREE4M0JEODJDQzkyMzc5RDUzNjc1QQ==" Apr 21 17:36:20 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:20Z" level=debug msg="put connect state because NEW_DEVICE" Apr 21 17:36:21 volumio-gutanw volumio[1168]: info: go-librespot daemon successfully initialized Apr 21 17:36:22 volumio-gutanw sudo[1541]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/Music /mnt/NAS/Music Apr 21 17:36:22 volumio-gutanw sudo[1541]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:24 volumio-gutanw volumio[1168]: info: Initializing connection to go-librespot Websocket Apr 21 17:36:24 volumio-gutanw go-librespot[1477]: time="2025-04-21T17:36:24Z" level=debug msg="new websocket client" Apr 21 17:36:24 volumio-gutanw volumio[1168]: info: Connection to go-librespot Websocket established Apr 21 17:36:25 volumio-gutanw volumio[1168]: error: Failed LSINFO: Error: [50@0] {lsinfo} No such directory Apr 21 17:36:25 volumio-gutanw ntpd[801]: Soliciting pool server 194.146.251.114 Apr 21 17:36:26 volumio-gutanw ntpd[801]: Soliciting pool server 212.127.78.21 Apr 21 17:36:27 volumio-gutanw sudo[1364]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:27 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:36:27 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:36:27 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/JAPAN MUZYK Apr 21 17:36:27 volumio-gutanw volumio[1168]: info: Getting Spotify volume Apr 21 17:36:27 volumio-gutanw ntpd[801]: Soliciting pool server 162.159.200.123 Apr 21 17:36:27 volumio-gutanw volumio[1168]: info: Cannot mount NAS DYSK_AUDIO at system boot, trial number 2 ,retrying in 5 seconds Apr 21 17:36:27 volumio-gutanw volumio[1168]: info: Spotify volume: 100 Apr 21 17:36:28 volumio-gutanw ntpd[801]: Soliciting pool server 162.159.200.1 Apr 21 17:36:28 volumio-gutanw ntpd[801]: Soliciting pool server 195.46.37.22 Apr 21 17:36:28 volumio-gutanw volumio[1168]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 5 Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:29 volumio-gutanw ntpd[801]: Soliciting pool server 185.157.13.96 Apr 21 17:36:29 volumio-gutanw ntpd[801]: Soliciting pool server 194.29.130.252 Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: Adding plugin bluetooth to MyMusic Plugins Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: Adding plugin multiroom to MyMusic Plugins Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: Adding plugin metavolumio to MyMusic Plugins Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: Adding plugin cd_controller to MyMusic Plugins Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: Adding plugin smart_inputs to MyMusic Plugins Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: Adding plugin tidalconnect to MyMusic Plugins Apr 21 17:36:29 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... Apr 21 17:36:30 volumio-gutanw ntpd[801]: Soliciting pool server 178.215.228.24 Apr 21 17:36:30 volumio-gutanw ntpd[801]: Soliciting pool server 89.250.197.242 Apr 21 17:36:31 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded Apr 21 17:36:31 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio Apr 21 17:36:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:31 volumio-gutanw volumio[1168]: info: Starting MyVolumio Remote Streaming Endpoints Apr 21 17:36:31 volumio-gutanw volumio[1168]: info: MyVolumio login type: Token Apr 21 17:36:31 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started Apr 21 17:36:31 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... Apr 21 17:36:31 volumio-gutanw ntpd[801]: Soliciting pool server 46.174.178.150 Apr 21 17:36:31 volumio-gutanw ntpd[801]: Soliciting pool server 51.68.141.5 Apr 21 17:36:31 volumio-gutanw ntpd[801]: Soliciting pool server 192.86.14.67 Apr 21 17:36:32 volumio-gutanw ntpd[801]: Soliciting pool server 185.79.243.74 Apr 21 17:36:32 volumio-gutanw ntpd[801]: Soliciting pool server 46.175.224.7 Apr 21 17:36:32 volumio-gutanw ntpd[801]: Soliciting pool server 89.161.47.136 Apr 21 17:36:32 volumio-gutanw volumio[1168]: info: Starting Streaming Service Transparent Proxy Apr 21 17:36:32 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Apr 21 17:36:32 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Apr 21 17:36:32 volumio-gutanw volumio[1168]: info: Streaming services startup Apr 21 17:36:32 volumio-gutanw volumio[1168]: info: Starting Streaming Daemon Apr 21 17:36:32 volumio-gutanw volumio[1168]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started Apr 21 17:36:32 volumio-gutanw sudo[1570]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Apr 21 17:36:32 volumio-gutanw sudo[1570]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:32 volumio-gutanw sudo[1570]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:32 volumio-gutanw volumio[1168]: error: Cannot start Volumio Streaming Daemon Apr 21 17:36:32 volumio-gutanw volumio[1168]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Apr 21 17:36:32 volumio-gutanw volumio[1168]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Apr 21 17:36:32 volumio-gutanw sudo[1578]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/DYSK AUDIO /mnt/NAS/DYSK_AUDIO Apr 21 17:36:32 volumio-gutanw sudo[1578]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:33 volumio-gutanw volumio[1168]: error: MyVolumio Custom Token format not valid, refreshing it Apr 21 17:36:33 volumio-gutanw ntpd[801]: Soliciting pool server 91.212.242.21 Apr 21 17:36:33 volumio-gutanw ntpd[801]: Soliciting pool server 2a05:f480:2400:18af:5400:4ff:fe0c:1486 Apr 21 17:36:33 volumio-gutanw ntpd[801]: Soliciting pool server 91.212.242.20 Apr 21 17:36:33 volumio-gutanw volumio[1168]: STREAMING PROXY: Starting server on port 3245 Apr 21 17:36:33 volumio-gutanw volumio[1168]: Node JS runtime: 14 Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: MyVolumio login type: Token Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: Airplay started streaming, receiving metadatas Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioStop Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::stop Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: Airplay started streaming, receiving metadatas Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioStop Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::stop Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: Airplay started streaming, receiving metadatas Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioStop Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::stop Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 21 17:36:34 volumio-gutanw shairport-sync[1493]: % Total % Received % Xferd Average Speed Time Time Time Current Apr 21 17:36:34 volumio-gutanw shairport-sync[1493]: Dload Upload Total Spent Left Speed Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: Updating volume from AirPlay: -20; 33% Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: VolumeController::SetAlsaVolume33 Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: Apr 21 17:36:34 volumio-gutanw volumio[1168]: ---------------------------- Client requests Start Airplay PlaybackRoutine Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: airplay_emulation , startAirplayPlayback Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: Airplay playback start Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CorePlayQueue::getTrack 0 Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioStop Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::stop Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 21 17:36:34 volumio-gutanw volumio[1168]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 21 17:36:34 volumio-gutanw shairport-sync[1493]: [158B blob data] Apr 21 17:36:35 volumio-gutanw volumio[1168]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN Apr 21 17:36:37 volumio-gutanw ntpd[801]: receive: Unexpected origin timestamp 0xebb100a3.61f85bd4 does not match aorg 0000000000.00000000 from server@46.174.178.150 xmt 0xebb100a5.cd9498b4 Apr 21 17:36:37 volumio-gutanw ntpd[801]: receive: Unexpected origin timestamp 0xebb100a3.61fef6ad does not match aorg 0000000000.00000000 from server@195.46.37.22 xmt 0xebb100a5.cf65913f Apr 21 17:36:37 volumio-gutanw ntpd[801]: receive: Unexpected origin timestamp 0xebb100a3.6202a4c2 does not match aorg 0000000000.00000000 from server@212.127.78.21 xmt 0xebb100a5.d104b4dd Apr 21 17:36:37 volumio-gutanw ntpd[801]: receive: Unexpected origin timestamp 0xebb100a3.61fc693e does not match aorg 0000000000.00000000 from server@178.215.228.24 xmt 0xebb100a5.d02b7a80 Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:38 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw kernel: bcm2835-i2s 3f203000.i2s: I2S SYNC error! Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw sudo[1403]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:36:39 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:36:39 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/Music Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: Cannot mount NAS JAPAN_MUZYK at system boot, trial number 2 ,retrying in 5 seconds Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: MyVolumio token set successfully Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: MYVOLUMIO: Adding device Apr 21 17:36:39 volumio-gutanw volumio[1168]: info: MYVOLUMIO: Evaluating Server Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: MyVolumio status changed Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: Streaming services startup Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: Starting Streaming Daemon Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: Removing browser output: myVolumio user plan is not superstar Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: Removing audio output: Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: Starting Tunnel 2 Apr 21 17:36:40 volumio-gutanw sudo[1622]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Apr 21 17:36:40 volumio-gutanw sudo[1622]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:40 volumio-gutanw sudo[1622]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:40 volumio-gutanw sudo[1624]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop tunnel.service Apr 21 17:36:40 volumio-gutanw sudo[1624]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:40 volumio-gutanw volumio[1168]: error: Cannot start Volumio Streaming Daemon Apr 21 17:36:40 volumio-gutanw volumio[1168]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Apr 21 17:36:40 volumio-gutanw volumio[1168]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Apr 21 17:36:40 volumio-gutanw sudo[1624]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:40 volumio-gutanw volumio[1168]: error: Cannot stop Remote Daemon: Error: Command failed: /usr/bin/sudo /bin/systemctl stop tunnel.service Apr 21 17:36:40 volumio-gutanw volumio[1168]: Failed to stop tunnel.service: Unit tunnel.service not loaded. Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: Setting Geolocation for MyVolumio to eu2 Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:40 volumio-gutanw volumio[1168]: info: Successfully Added MyVolumio device Apr 21 17:36:41 volumio-gutanw volumio[1168]: info: Updating MyVolumio device info Apr 21 17:36:41 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:42 volumio-gutanw volumio[1168]: info: Successfully Updated MyVolumio device Apr 21 17:36:44 volumio-gutanw sudo[1628]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/JAPAN MUZYK /mnt/NAS/JAPAN_MUZYK Apr 21 17:36:44 volumio-gutanw sudo[1628]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:48 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Apr 21 17:36:48 volumio-gutanw volumio[1168]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 6 Apr 21 17:36:48 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:36:49 volumio-gutanw sudo[1541]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:49 volumio-gutanw volumio[1168]: info: Cannot mount NAS Music at system boot, trial number 2 ,retrying in 5 seconds Apr 21 17:36:49 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:36:49 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:36:49 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/DYSK AUDIO Apr 21 17:36:50 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Apr 21 17:36:50 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:50 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Apr 21 17:36:50 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Apr 21 17:36:50 volumio-gutanw volumio-remote-updater[594]: No test mode Apr 21 17:36:50 volumio-gutanw volumio-remote-updater[594]: No alpha test mode Apr 21 17:36:50 volumio-gutanw volumio[1168]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} Apr 21 17:36:50 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Apr 21 17:36:51 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:36:51 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:36:51 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:36:51 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:36:51 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:36:53 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:53 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:53 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Apr 21 17:36:53 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Apr 21 17:36:53 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Apr 21 17:36:53 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject Apr 21 17:36:53 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetBrowseSources Apr 21 17:36:53 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Apr 21 17:36:54 volumio-gutanw sudo[1653]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/Music /mnt/NAS/Music Apr 21 17:36:54 volumio-gutanw sudo[1653]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:36:55 volumio-gutanw volumio[1168]: error: MyVolumio Plugin failed to authenticate in a timely fashion Apr 21 17:36:55 volumio-gutanw volumio[1168]: info: Completed starting MyVolumio Plugin Apr 21 17:36:55 volumio-gutanw volumio[1168]: [Metrics] CommandRouter: 69s 839.75ms Apr 21 17:36:55 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumiosetStartupVolume Apr 21 17:36:55 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 21 17:36:55 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 21 17:36:55 volumio-gutanw volumio[1168]: info: CoreCommandRouter::Close All Modals sent Apr 21 17:36:55 volumio-gutanw volumio[1168]: info: CoreCommandRouter::Close All Modals sent Apr 21 17:36:55 volumio-gutanw volumio[1168]: info: Cannot play startup sound: Error: Command failed: /usr/bin/aplay -D volumio /volumio/app/startup.wav Apr 21 17:36:55 volumio-gutanw volumio[1168]: aplay: main:828: audio open error: Device or resource busy Apr 21 17:36:56 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Apr 21 17:36:56 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 21 17:36:56 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::servicePushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreStateMachine::pushState Apr 21 17:36:57 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioPushState Apr 21 17:36:59 volumio-gutanw sudo[1578]: pam_unix(sudo:session): session closed for user root Apr 21 17:36:59 volumio-gutanw volumio[1168]: info: Cannot mount NAS DYSK_AUDIO at system boot, trial number 3 ,retrying in 5 seconds Apr 21 17:36:59 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:36:59 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:36:59 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/JAPAN MUZYK Apr 21 17:37:02 volumio-gutanw volumio[1168]: info: BOOT COMPLETED Apr 21 17:37:04 volumio-gutanw sudo[1674]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/DYSK AUDIO /mnt/NAS/DYSK_AUDIO Apr 21 17:37:04 volumio-gutanw sudo[1674]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:37:09 volumio-gutanw sudo[1628]: pam_unix(sudo:session): session closed for user root Apr 21 17:37:09 volumio-gutanw volumio[1168]: info: Cannot mount NAS JAPAN_MUZYK at system boot, trial number 3 ,retrying in 5 seconds Apr 21 17:37:09 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:37:09 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:37:09 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/Music Apr 21 17:37:12 volumio-gutanw sudo[1693]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Apr 21 17:37:12 volumio-gutanw sudo[1693]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:37:12 volumio-gutanw sudo[1693]: pam_unix(sudo:session): session closed for user root Apr 21 17:37:12 volumio-gutanw sudo[1695]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Apr 21 17:37:12 volumio-gutanw sudo[1695]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:37:12 volumio-gutanw sudo[1695]: pam_unix(sudo:session): session closed for user root Apr 21 17:37:12 volumio-gutanw volumio[1168]: verbose: New Socket.io Connection to 192.168.1.58 from 192.168.1.199 UA: Mozilla/5.0 (Linux; Android 12; SM-N975F Build/SP1A.210812.016; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/135.0.7049.99 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7 Apr 21 17:37:13 volumio-gutanw sudo[1699]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Apr 21 17:37:13 volumio-gutanw sudo[1699]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:37:13 volumio-gutanw sudo[1701]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Apr 21 17:37:13 volumio-gutanw sudo[1701]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:37:13 volumio-gutanw sudo[1699]: pam_unix(sudo:session): session closed for user root Apr 21 17:37:13 volumio-gutanw sudo[1701]: pam_unix(sudo:session): session closed for user root Apr 21 17:37:13 volumio-gutanw volumio[1168]: verbose: New Socket.io Connection to 192.168.1.58 from 192.168.1.199 UA: Mozilla/5.0 (Linux; Android 12; SM-N975F Build/SP1A.210812.016; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/135.0.7049.99 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 8 Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetVisibleSources Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: Received Get System Info Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: Listing playlists Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Apr 21 17:37:13 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Apr 21 17:37:14 volumio-gutanw sudo[1708]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/JAPAN MUZYK /mnt/NAS/JAPAN_MUZYK Apr 21 17:37:14 volumio-gutanw sudo[1708]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:37:15 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Apr 21 17:37:15 volumio-gutanw volumio[1168]: info: Received Get System Info Apr 21 17:37:15 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:37:15 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:37:15 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:37:15 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:37:15 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:37:15 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Apr 21 17:37:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Apr 21 17:37:17 volumio-gutanw volumio[1168]: info: Received Get System Info Apr 21 17:37:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:37:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:37:17 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:37:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:37:17 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:37:19 volumio-gutanw sudo[1653]: pam_unix(sudo:session): session closed for user root Apr 21 17:37:19 volumio-gutanw volumio[1168]: info: Cannot mount NAS Music at system boot, trial number 3 ,retrying in 5 seconds Apr 21 17:37:19 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:37:19 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:37:19 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/DYSK AUDIO Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Retrieving Cloud Streaming UI Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Getting Tidal Cloud Configuration Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Getting Qobuz Cloud Configuration Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Asking plugin for UI Config Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Getting Spotify Cloud Configuration Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Asking plugin for UI Config Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Saving Spotify Acccount Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Got Tidal Cloud Configuration Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Got it Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: Got it Apr 21 17:37:20 volumio-gutanw volumio[1168]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::getUIConfigOnPlugin Apr 21 17:37:20 volumio-gutanw volumio[1168]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetBrowseSources Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetBrowseSources Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetBrowseSources Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 21 17:37:20 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Apr 21 17:37:21 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:37:21 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:37:21 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:37:21 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:37:21 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:37:21 volumio-gutanw volumiologrotate[608]: ls: cannot access '/var/log/samba/log.wb-VOLUMIO': No such file or directory Apr 21 17:37:21 volumio-gutanw volumiologrotate[608]: ls: cannot access 'GUTANÓW': No such file or directory Apr 21 17:37:23 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Apr 21 17:37:24 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 21 17:37:24 volumio-gutanw sudo[1774]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o guest,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.0.103/Music /mnt/NAS/Music Apr 21 17:37:24 volumio-gutanw sudo[1774]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 21 17:37:26 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: networkfs , deleteShare Apr 21 17:37:28 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Apr 21 17:37:28 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 21 17:37:29 volumio-gutanw sudo[1674]: pam_unix(sudo:session): session closed for user root Apr 21 17:37:29 volumio-gutanw volumio[1168]: info: Cannot mount NAS DYSK_AUDIO at system boot, trial number 4 ,retrying in 5 seconds Apr 21 17:37:29 volumio-gutanw kernel: CIFS: VFS: Error connecting to socket. Aborting operation. Apr 21 17:37:29 volumio-gutanw kernel: CIFS: VFS: cifs_mount failed w/return code = -115 Apr 21 17:37:29 volumio-gutanw kernel: CIFS: Attempting to mount //192.168.0.103/JAPAN MUZYK Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: Received Get System Version Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: Received Get System Info Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: Discovery: Getting this device information Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::volumioGetState Apr 21 17:37:31 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Apr 21 17:37:32 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: networkfs , deleteShare Apr 21 17:37:32 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Apr 21 17:37:33 volumio-gutanw volumio[1168]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Apr 21 17:37:34 volumio-gutanw volumio[1168]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 21 17:37:34 volumio-gutanw volumio[1168]: TypeError: Cannot read property 'replace' of undefined Apr 21 17:37:34 volumio-gutanw volumio[1168]: at ControllerNetworkfs.mountShare (/volumio/app/plugins/system_controller/networkfs/index.js:202:28) Apr 21 17:37:34 volumio-gutanw volumio[1168]: at Timeout._onTimeout (/volumio/app/plugins/system_controller/networkfs/index.js:255:20) Apr 21 17:37:34 volumio-gutanw volumio[1168]: at listOnTimeout (internal/timers.js:554:17) Apr 21 17:37:34 volumio-gutanw volumio[1168]: at processTimers (internal/timers.js:497:7) Apr 21 17:37:34 volumio-gutanw volumio[1168]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 21 17:37:35 volumio-gutanw sudo[1817]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-04-21 17:36 Apr 21 17:37:35 volumio-gutanw sudo[1817]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 10 (buster)" NAME="Raspbian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster 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="147953990fca4aa103a8f90538ef56fb0454638c" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="e32c2c71ae78852844c70357816bdd871c155ab8" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Mon 31 Mar 2025 06:54:47 PM CEST" VOLUMIO_VERSION="3.799" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="436f3f84f6d0b4ffc344f0bc132a32e8"