-- Logs begin at Thu 2019-02-14 11:12:02 CET, end at Thu 2025-05-22 15:16:27 CEST. -- May 22 15:16:03 volumio-2 systemd[1]: Starting Daily apt download activities... May 22 15:16:03 volumio-2 systemd[1]: systemd-fsckd.service: Succeeded. May 22 15:16:05 volumio-2 volumio[723]: info: ------------------------------------------- May 22 15:16:05 volumio-2 volumio[723]: info: ----- Volumio3 ---- May 22 15:16:05 volumio-2 volumio[723]: info: ------------------------------------------- May 22 15:16:05 volumio-2 volumio[723]: info: ----- System startup ---- May 22 15:16:05 volumio-2 volumio[723]: info: ------------------------------------------- May 22 15:16:06 volumio-2 systemd[1]: apt-daily.service: Succeeded. May 22 15:16:06 volumio-2 systemd[1]: Started Daily apt download activities. May 22 15:16:06 volumio-2 systemd[1]: Starting Daily apt upgrade and clean activities... May 22 15:16:08 volumio-2 systemd[1]: apt-daily-upgrade.service: Succeeded. May 22 15:16:08 volumio-2 systemd[1]: Started Daily apt upgrade and clean activities. May 22 15:16:08 volumio-2 volumio[723]: info: MYVOLUMIO Environment detected May 22 15:16:08 volumio-2 volumio[723]: info: Plugin folders cleanup May 22 15:16:08 volumio-2 volumio[723]: info: Scanning into folder /volumio/app/plugins/ May 22 15:16:08 volumio-2 volumio[723]: info: Scanning category audio_interface May 22 15:16:08 volumio-2 volumio[723]: info: Scanning category miscellanea May 22 15:16:08 volumio-2 volumio[723]: info: Scanning category music_service May 22 15:16:08 volumio-2 volumio[723]: info: Scanning category plugins.json May 22 15:16:08 volumio-2 volumio[723]: info: Scanning category system_controller May 22 15:16:08 volumio-2 volumio[723]: info: Scanning category user_interface May 22 15:16:08 volumio-2 volumio[723]: info: Scanning into folder /data/plugins/ May 22 15:16:08 volumio-2 volumio[723]: info: Plugin folders cleanup completed May 22 15:16:08 volumio-2 volumio[723]: info: ------------------------------------------- May 22 15:16:08 volumio-2 volumio[723]: info: ----- Core plugins startup ---- May 22 15:16:08 volumio-2 volumio[723]: info: ------------------------------------------- May 22 15:16:08 volumio-2 volumio[723]: info: Loading plugins from folder /volumio/app/plugins/ May 22 15:16:08 volumio-2 volumio[723]: info: Adding plugin upnp to MyMusic Plugins May 22 15:16:08 volumio-2 volumio[723]: info: Adding plugin airplay_emulation to MyMusic Plugins May 22 15:16:08 volumio-2 volumio[723]: info: Adding plugin upnp_browser to MyMusic Plugins May 22 15:16:08 volumio-2 volumio[723]: info: Loading plugins from folder /data/plugins/ May 22 15:16:08 volumio-2 volumio[723]: info: Loading plugin "system"... May 22 15:16:09 volumio-2 volumio[723]: info: Loading plugin "appearance"... May 22 15:16:09 volumio-2 volumio-remote-updater[464]: [2025-05-22 15:16:09] [connect] Successful connection May 22 15:16:13 volumio-2 volumio[723]: info: Loading plugin "network"... May 22 15:16:13 volumio-2 volumio[723]: info: Refreshing Cached IP Addresses May 22 15:16:13 volumio-2 volumio[723]: info: Loading plugin "services"... May 22 15:16:13 volumio-2 volumio[723]: info: Loading plugin "alsa_controller"... May 22 15:16:13 volumio-2 sudo[866]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 22 15:16:13 volumio-2 sudo[864]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 22 15:16:13 volumio-2 sudo[868]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan May 22 15:16:13 volumio-2 sudo[866]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:13 volumio-2 sudo[864]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:13 volumio-2 sudo[868]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:13 volumio-2 sudo[864]: pam_unix(sudo:session): session closed for user root May 22 15:16:13 volumio-2 sudo[866]: pam_unix(sudo:session): session closed for user root May 22 15:16:13 volumio-2 sudo[868]: pam_unix(sudo:session): session closed for user root May 22 15:16:13 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 22 15:16:13 volumio-2 volumio[723]: info: Loading plugin "wizard"... May 22 15:16:13 volumio-2 volumio[723]: info: Loading plugin "networkfs"... May 22 15:16:14 volumio-2 volumio[723]: info: Starting Udev Watcher for removable devices May 22 15:16:14 volumio-2 sudo[881]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o username=admin,password=jan2020,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.178.52/Public/Downloads/complete/Muziek CD /mnt/NAS/NAS23D8CB May 22 15:16:14 volumio-2 sudo[881]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:14 volumio-2 volumio[723]: info: Ignoring mount for partition: boot May 22 15:16:14 volumio-2 volumio[723]: info: Ignoring mount for partition: volumio May 22 15:16:14 volumio-2 volumio[723]: info: Ignoring mount for partition: volumio_data May 22 15:16:14 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback May 22 15:16:14 volumio-2 volumio[723]: info: Loading plugin "volumio_command_line_client"... May 22 15:16:14 volumio-2 volumio[723]: info: Loading plugin "upnp"... May 22 15:16:14 volumio-2 volumio[723]: info: [1747919774575] Starting Upmpd Daemon May 22 15:16:14 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback May 22 15:16:14 volumio-2 volumio[723]: info: Loading plugin "my_music"... May 22 15:16:14 volumio-2 volumio[723]: info: Loading plugin "mpd"... May 22 15:16:14 volumio-2 kernel: Key type cifs.spnego registered May 22 15:16:14 volumio-2 kernel: Key type cifs.idmap registered May 22 15:16:14 volumio-2 kernel: CIFS: No dialect specified on mount. Default has changed to a more secure dialect, SMB2.1 or later (e.g. SMB3.1.1), from CIFS (SMB1). To use the less secure SMB1 dialect to access old servers which do not support SMB3.1.1 (or even SMB3 or SMB2.1) specify vers=1.0 on mount. May 22 15:16:14 volumio-2 kernel: CIFS: Attempting to mount \\192.168.178.52\Public May 22 15:16:15 volumio-2 sudo[881]: pam_unix(sudo:session): session closed for user root May 22 15:16:15 volumio-2 volumio[723]: info: Loading plugin "upnp_browser"... May 22 15:16:17 volumio-2 volumio[723]: info: Loading plugin "alarm-clock"... May 22 15:16:17 volumio-2 volumio[723]: info: Plugin airplay_emulation is not enabled May 22 15:16:17 volumio-2 volumio[723]: info: Loading plugin "last_100"... May 22 15:16:17 volumio-2 volumio[723]: info: Loading plugin "webradio"... May 22 15:16:18 volumio-2 volumio[723]: info: Loading plugin "i2s_dacs"... May 22 15:16:18 volumio-2 volumio[723]: info: I2S DAC not set, start Auto-detection May 22 15:16:18 volumio-2 volumio[723]: info: Loading plugin "volumiodiscovery"... May 22 15:16:18 volumio-2 volumio[723]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. May 22 15:16:18 volumio-2 volumio[723]: *** WARNING *** Please fix your application to use the native API of Avahi! May 22 15:16:18 volumio-2 volumio[723]: *** WARNING *** For more information see May 22 15:16:18 volumio-2 node[723]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. May 22 15:16:18 volumio-2 volumio[723]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. May 22 15:16:18 volumio-2 volumio[723]: *** WARNING *** Please fix your application to use the native API of Avahi! May 22 15:16:18 volumio-2 volumio[723]: *** WARNING *** For more information see May 22 15:16:18 volumio-2 node[723]: *** WARNING *** Please fix your application to use the native API of Avahi! May 22 15:16:18 volumio-2 node[723]: *** WARNING *** For more information see May 22 15:16:18 volumio-2 node[723]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. May 22 15:16:18 volumio-2 node[723]: *** WARNING *** Please fix your application to use the native API of Avahi! May 22 15:16:18 volumio-2 node[723]: *** WARNING *** For more information see May 22 15:16:18 volumio-2 volumio[723]: info: Applying required configuration parameters for plugin volumiodiscovery May 22 15:16:18 volumio-2 volumio[723]: info: Discovery: Started advertising with name: Volumio 2 May 22 15:16:18 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback May 22 15:16:18 volumio-2 volumio[723]: info: Loading plugin "outputs"... May 22 15:16:18 volumio-2 volumio[723]: info: Loading plugin "albumart"... May 22 15:16:18 volumio-2 volumio[723]: info: Plugin example_plugin is not enabled May 22 15:16:18 volumio-2 volumio[723]: info: Loading plugin "inputs"... May 22 15:16:18 volumio-2 volumio[723]: info: Loading plugin "updater_comm"... May 22 15:16:19 volumio-2 volumio[723]: info: Plugin mpdemulation is not enabled May 22 15:16:19 volumio-2 volumio[723]: info: Loading plugin "rest_api"... May 22 15:16:19 volumio-2 volumio[723]: info: Loading plugin "websocket"... May 22 15:16:19 volumio-2 volumio[723]: info: Starting Socket.io Server version 2.3.0 May 22 15:16:19 volumio-2 volumio[723]: info: Loading i18n strings for locale nl May 22 15:16:19 volumio-2 volumio[723]: Forking 3 albumart workers May 22 15:16:19 volumio-2 volumio[723]: Updating browse sources language May 22 15:16:19 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::initPlayerControls May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: Express server listening on port 3000 May 22 15:16:20 volumio-2 volumio[723]: [Metrics] WebUI: 18s 894.19ms May 22 15:16:20 volumio-2 volumio[723]: info: CoreStateMachine::resetVolumioState May 22 15:16:20 volumio-2 volumio[723]: info: CoreStateMachine::getcurrentVolume May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::volumioRetrievevolume May 22 15:16:20 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 22 15:16:20 volumio-2 volumio[723]: error: An error occurred while scanning: Error: Command failed: sudo /sbin/iwlist wlan0 scan May 22 15:16:20 volumio-2 volumio[723]: wlan0 Interface doesn't support scanning. May 22 15:16:20 volumio-2 volumio[723]: info: Cannot use regular scanning, forcing with ap-force May 22 15:16:20 volumio-2 sudo[947]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iw dev wlan0 scan ap-force May 22 15:16:20 volumio-2 sudo[947]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:20 volumio-2 sudo[947]: pam_unix(sudo:session): session closed for user root May 22 15:16:20 volumio-2 volumio[723]: command failed: No such device (-19) May 22 15:16:20 volumio-2 volumio[723]: error: Cannot use fallback scanning method: Error: Command failed: /usr/bin/sudo /sbin/iw dev wlan0 scan ap-force May 22 15:16:20 volumio-2 volumio[723]: command failed: No such device (-19) May 22 15:16:21 volumio-2 volumio[723]: verbose: New Socket.io Connection to 192.168.178.207 from 192.168.178.101 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/605.1.15 (KHTML, like Gecko) Engine version: 3 Transport: polling Total Clients: 1 May 22 15:16:21 volumio-2 volumio[723]: verbose: New Socket.io Connection to 192.168.178.207 from 192.168.178.101 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/605.1.15 (KHTML, like Gecko) Engine version: 3 Transport: polling Total Clients: 2 May 22 15:16:21 volumio-2 volumio[723]: verbose: New Socket.io Connection to 192.168.178.207 from 192.168.178.101 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/605.1.15 (KHTML, like Gecko) Engine version: 3 Transport: polling Total Clients: 3 May 22 15:16:21 volumio-2 volumio[723]: info: Reloading queue from file May 22 15:16:21 volumio-2 volumio[723]: Starting albumart workers May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::volumioGetState May 22 15:16:21 volumio-2 volumio[723]: info: CorePlayQueue::getTrack 0 May 22 15:16:21 volumio-2 volumio[723]: info: CoreStateMachine::setRepeat true single undefined May 22 15:16:21 volumio-2 volumio[723]: info: CoreStateMachine::pushState May 22 15:16:21 volumio-2 volumio[723]: info: CorePlayQueue::getTrack 0 May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::volumioPushState May 22 15:16:21 volumio-2 volumio[723]: info: CoreStateMachine::setRandom false May 22 15:16:21 volumio-2 volumio[723]: info: CoreStateMachine::pushState May 22 15:16:21 volumio-2 volumio[723]: info: CorePlayQueue::getTrack 0 May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::volumioPushState May 22 15:16:21 volumio-2 volumio[723]: info: Setting Device type: Raspberry PI May 22 15:16:21 volumio-2 volumio[723]: Starting albumart workers May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom May 22 15:16:21 volumio-2 volumio[723]: Starting albumart workers May 22 15:16:21 volumio-2 volumio[723]: info: Listing playlists May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::volumioGetVisibleSources May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::volumioGetQueue May 22 15:16:21 volumio-2 volumio[723]: info: CoreStateMachine::getQueue May 22 15:16:21 volumio-2 volumio[723]: info: CorePlayQueue::getQueue May 22 15:16:21 volumio-2 volumio[723]: info: VolumeController:: Volume=60 Mute =false May 22 15:16:21 volumio-2 volumio[723]: info: CoreStateMachine::pushState May 22 15:16:21 volumio-2 volumio[723]: info: CorePlayQueue::getTrack 0 May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::volumioPushState May 22 15:16:21 volumio-2 volumio[723]: info: CoreStateMachine::updateTrackBlock May 22 15:16:21 volumio-2 volumio[723]: info: CorePlayQueue::getTrackBlock May 22 15:16:21 volumio-2 volumio[723]: info: CoreCommandRouter::volumioRetrievevolume May 22 15:16:22 volumio-2 volumio[723]: info: Discovery: adding 375ca179-5e3e-4054-bb86-7496e1af4baf May 22 15:16:22 volumio-2 volumio[723]: info: Discovery: Found device Volumio 2 May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::volumioGetState May 22 15:16:22 volumio-2 volumio[723]: info: CorePlayQueue::getTrack 0 May 22 15:16:22 volumio-2 volumio[723]: info: VolumeController:: Volume=60 Mute =false May 22 15:16:22 volumio-2 volumio[723]: info: CoreStateMachine::pushState May 22 15:16:22 volumio-2 volumio[723]: info: CorePlayQueue::getTrack 0 May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::volumioPushState May 22 15:16:22 volumio-2 volumio[723]: info: Completed loading Core Plugins May 22 15:16:22 volumio-2 volumio[723]: info: Preparing to generate the ALSA configuration file May 22 15:16:22 volumio-2 volumio[723]: info: Asound.conf file unchanged, so no further update is needed May 22 15:16:22 volumio-2 volumio[723]: info: Output device has changed, restarting MPD May 22 15:16:22 volumio-2 volumio[723]: info: ___________ START PLUGINS ___________ May 22 15:16:22 volumio-2 volumio[723]: info: ControllerMpd::onStart: Initializing MPD May 22 15:16:22 volumio-2 volumio[723]: info: Creating MPD Configuration file May 22 15:16:22 volumio-2 sudo[961]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 22 15:16:22 volumio-2 sudo[961]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:22 volumio-2 sudo[961]: pam_unix(sudo:session): session closed for user root May 22 15:16:22 volumio-2 sudo[962]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 22 15:16:22 volumio-2 sudo[962]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] May 22 15:16:22 volumio-2 volumio[723]: info: [1747919782620] CoreMusicLibrary::Adding element Media Servers May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 22 15:16:22 volumio-2 sudo[965]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf May 22 15:16:22 volumio-2 sudo[965]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:22 volumio-2 sudo[965]: pam_unix(sudo:session): session closed for user root May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] May 22 15:16:22 volumio-2 volumio[723]: info: [1747919782733] CoreMusicLibrary::Adding element Last_100 May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 22 15:16:22 volumio-2 sudo[968]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service May 22 15:16:22 volumio-2 sudo[968]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] May 22 15:16:22 volumio-2 volumio[723]: info: [1747919782752] CoreMusicLibrary::Adding element Webradio May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources May 22 15:16:22 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 22 15:16:22 volumio-2 systemd[1]: Listening on mpd.socket. May 22 15:16:22 volumio-2 volumio[723]: info: Initializing BBC Radios May 22 15:16:22 volumio-2 systemd[1]: Starting Music Player Daemon... May 22 15:16:22 volumio-2 systemd[1]: mpd.service: Control process exited, code=killed, status=15/TERM May 22 15:16:22 volumio-2 systemd[1]: mpd.service: Succeeded. May 22 15:16:22 volumio-2 systemd[1]: Stopped Music Player Daemon. May 22 15:16:22 volumio-2 systemd[1]: Starting Music Player Daemon... May 22 15:16:23 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion May 22 15:16:23 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 22 15:16:23 volumio-2 volumio[723]: info: Volumio Calling Home May 22 15:16:23 volumio-2 sudo[975]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log May 22 15:16:23 volumio-2 sudo[975]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:23 volumio-2 sudo[975]: /bin/chown: cannot access '/var/log/mpd.log': No such file or directory May 22 15:16:23 volumio-2 sudo[975]: pam_unix(sudo:session): session closed for user root May 22 15:16:23 volumio-2 volumio[723]: info: MPD Permissions set May 22 15:16:23 volumio-2 volumio[723]: info: MPD Permissions set May 22 15:16:24 volumio-2 volumio[723]: info: Volumio called home May 22 15:16:24 volumio-2 volumio[723]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 4 May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam May 22 15:16:24 volumio-2 volumio-remote-updater[464]: [2025-05-22 15:16:24] [connect] Successful connection May 22 15:16:24 volumio-2 sudo[1022]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 May 22 15:16:24 volumio-2 sudo[1022]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:24 volumio-2 sudo[1022]: pam_unix(sudo:session): session closed for user root May 22 15:16:24 volumio-2 sudo[1024]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 May 22 15:16:24 volumio-2 sudo[1024]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:24 volumio-2 volumio-remote-updater[464]: [2025-05-22 15:16:24] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1747919784 101 May 22 15:16:24 volumio-2 volumio[723]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Engine version: 4 Transport: websocket Total Clients: 5 May 22 15:16:24 volumio-2 volumio[723]: info: CoreCommandRouter::volumioGetState May 22 15:16:24 volumio-2 sudo[1024]: pam_unix(sudo:session): session closed for user root May 22 15:16:24 volumio-2 volumio[723]: info: CorePlayQueue::getTrack 0 May 22 15:16:25 volumio-2 sudo[1030]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service May 22 15:16:25 volumio-2 sudo[1030]: pam_unix(sudo:session): session opened for user root by (uid=0) May 22 15:16:25 volumio-2 systemd[1]: Started UPnP Renderer front-end to MPD. May 22 15:16:25 volumio-2 sudo[1030]: pam_unix(sudo:session): session closed for user root May 22 15:16:25 volumio-2 volumio[723]: info: Upmpdcli Daemon Started May 22 15:16:26 volumio-2 volumio[723]: info: Preload queue cleared May 22 15:16:26 volumio-2 volumio[723]: info: CoreCommandRouter::volumioReplaceandPlayItems May 22 15:16:26 volumio-2 volumio[723]: info: CoreStateMachine::ClearQueue May 22 15:16:26 volumio-2 volumio[723]: info: CoreStateMachine::stop May 22 15:16:26 volumio-2 volumio[723]: info: CoreStateMachine::setConsumeUpdateService undefined May 22 15:16:26 volumio-2 volumio[723]: info: CorePlayQueue::clearPlayQueue May 22 15:16:26 volumio-2 volumio[723]: info: CorePlayQueue::saveQueue May 22 15:16:26 volumio-2 volumio[723]: info: CoreCommandRouter::volumioPushQueue May 22 15:16:26 volumio-2 volumio[723]: info: CoreStateMachine::addQueueItems May 22 15:16:26 volumio-2 volumio[723]: info: CorePlayQueue::addQueueItems May 22 15:16:26 volumio-2 volumio[723]: info: Preload queue cleared May 22 15:16:26 volumio-2 volumio[723]: info: Adding Item to queue: music-library/NAS/NAS23D8CB/Populair/Benny Andersson/Benny Andersson - Piano/01. I Let The Music Speak.flac May 22 15:16:26 volumio-2 volumio[723]: info: Exploding uri music-library/NAS/NAS23D8CB/Populair/Benny Andersson/Benny Andersson - Piano/01. I Let The Music Speak.flac in service mpd May 22 15:16:26 volumio-2 volumio[723]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 22 15:16:26 volumio-2 volumio[723]: TypeError: Cannot read property 'then' of undefined May 22 15:16:26 volumio-2 volumio[723]: at ControllerMpd.scanFolder (/volumio/app/plugins/music_service/mpd/index.js:2527:19) May 22 15:16:26 volumio-2 volumio[723]: at ControllerMpd.explodeUri (/volumio/app/plugins/music_service/mpd/index.js:2325:21) May 22 15:16:26 volumio-2 volumio[723]: at CoreCommandRouter.explodeUriFromService (/volumio/app/index.js:1365:16) May 22 15:16:26 volumio-2 volumio[723]: at CorePlayQueue.explodeUriFromCache (/volumio/app/playqueue.js:123:24) May 22 15:16:26 volumio-2 volumio[723]: at CorePlayQueue.explodeUri (/volumio/app/playqueue.js:181:19) May 22 15:16:26 volumio-2 volumio[723]: at CorePlayQueue.addQueueItems (/volumio/app/playqueue.js:223:30) May 22 15:16:26 volumio-2 volumio[723]: at CoreStateMachine.addQueueItems (/volumio/app/statemachine.js:247:25) May 22 15:16:26 volumio-2 volumio[723]: at CoreCommandRouter.replaceAndPlay (/volumio/app/index.js:507:23) May 22 15:16:26 volumio-2 volumio[723]: at CoreCommandRouter.playItemsList (/volumio/app/index.js:483:17) May 22 15:16:26 volumio-2 volumio[723]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:139:33) May 22 15:16:26 volumio-2 volumio[723]: at Socket.emit (events.js:315:20) May 22 15:16:26 volumio-2 volumio[723]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 May 22 15:16:26 volumio-2 volumio[723]: at processTicksAndRejections (internal/process/task_queues.js:75:11) May 22 15:16:26 volumio-2 volumio[723]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 22 15:16:27 volumio-2 sudo[1043]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-05-22 15:15 May 22 15:16:27 volumio-2 sudo[1043]: 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="4b122b2365bb8c09786cd63b50d1ea6db780eb4e" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="49f98390f2d84c6549f33dc85b694fbd99e4c720" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 04 Jun 2024 08:41:12 PM CEST" VOLUMIO_VERSION="3.703" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="8e78a6e3f56f1bcbbd1760812129a8e9"