-- Logs begin at Thu 2019-02-14 11:11:58 CET, end at Sat 2024-09-07 07:35:06 CEST. -- Sep 07 07:34:19 minidsp-shd volumio[816]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Sep 07 07:34:19 minidsp-shd volumio[816]: info: CURURI: artists://The%20The Sep 07 07:34:20 minidsp-shd volumio[816]: Upnp client error: Error: This socket has been ended by the other party Sep 07 07:34:21 minidsp-shd volumio[816]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Sep 07 07:34:21 minidsp-shd volumio[816]: info: CURURI: artists://The%20The Sep 07 07:34:27 minidsp-shd volumio[816]: Cannot compose Albumart path Sep 07 07:34:28 minidsp-shd volumio[816]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Sep 07 07:34:28 minidsp-shd volumio[816]: info: CURURI: artists://The%20The Sep 07 07:34:28 minidsp-shd volumio[816]: Upnp client error: Error: This socket has been ended by the other party Sep 07 07:34:29 minidsp-shd volumio[816]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Sep 07 07:34:29 minidsp-shd volumio[816]: info: CURURI: artists://The%20The Sep 07 07:34:31 minidsp-shd volumio[816]: <--- Last few GCs ---> Sep 07 07:34:31 minidsp-shd volumio[816]: [816:0x42d2008] 850179 ms: Scavenge (reduce) 227.4 (234.3) -> 227.3 (234.3) MB, 8.8 / 0.0 ms (average mu = 0.869, current mu = 0.874) allocation failure Sep 07 07:34:31 minidsp-shd volumio[816]: [816:0x42d2008] 850241 ms: Scavenge (reduce) 234.2 (239.1) -> 234.0 (239.1) MB, 9.0 / 0.0 ms (average mu = 0.869, current mu = 0.874) allocation failure Sep 07 07:34:31 minidsp-shd volumio[816]: [816:0x42d2008] 850303 ms: Scavenge (reduce) 241.2 (246.1) -> 241.0 (246.1) MB, 8.9 / 0.0 ms (average mu = 0.869, current mu = 0.874) allocation failure Sep 07 07:34:31 minidsp-shd volumio[816]: <--- JS stacktrace ---> Sep 07 07:34:31 minidsp-shd volumio[816]: FATAL ERROR: MarkCompactCollector: young object promotion failed Allocation failed - JavaScript heap out of memory Sep 07 07:34:31 minidsp-shd systemd[1]: volumio.service: Main process exited, code=killed, status=6/ABRT Sep 07 07:34:31 minidsp-shd volumio-remote-updater[457]: [2024-09-07 07:34:31] [error] handle_read_frame error: websocketpp.transport:7 (End of File) Sep 07 07:34:31 minidsp-shd volumio-remote-updater[457]: [2024-09-07 07:34:31] [disconnect] Disconnect close local:[1006,End of File] remote:[1006] Sep 07 07:34:31 minidsp-shd vtcs[1254]: [2024-09-07 07:34:31.692] [tisoc] [error] [SpkconServer.cpp:377] recv error. socket disconnected Sep 07 07:34:31 minidsp-shd systemd[1]: volumio.service: Failed with result 'signal'. Sep 07 07:34:31 minidsp-shd systemd[1]: Started dynamicswap service. Sep 07 07:34:31 minidsp-shd systemd[1]: dynamicswap.service: Succeeded. Sep 07 07:34:31 minidsp-shd systemd[1]: volumio.service: Service RestartSec=100ms expired, scheduling restart. Sep 07 07:34:31 minidsp-shd systemd[1]: volumio.service: Scheduled restart job, restart counter is at 1. Sep 07 07:34:31 minidsp-shd systemd[1]: Stopped Volumio Backend Module. Sep 07 07:34:31 minidsp-shd systemd[1]: Started Volumio Backend Module. Sep 07 07:34:31 minidsp-shd systemd[1]: Started dynamicswap service. Sep 07 07:34:31 minidsp-shd systemd[1]: dynamicswap.service: Succeeded. Sep 07 07:34:35 minidsp-shd volumio[2110]: info: ------------------------------------------- Sep 07 07:34:35 minidsp-shd volumio[2110]: info: ----- Volumio3 ---- Sep 07 07:34:35 minidsp-shd volumio[2110]: info: ------------------------------------------- Sep 07 07:34:35 minidsp-shd volumio[2110]: info: ----- System startup ---- Sep 07 07:34:35 minidsp-shd volumio[2110]: info: ------------------------------------------- Sep 07 07:34:36 minidsp-shd volumio-remote-updater[457]: [2024-09-07 07:34:36] [connect] Successful connection Sep 07 07:34:36 minidsp-shd volumio[2110]: info: MYVOLUMIO Environment detected Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Plugin folders cleanup Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Scanning into folder /volumio/app/plugins/ Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Scanning category audio_interface Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Scanning category miscellanea Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Scanning category music_service Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Scanning category plugins.json Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Scanning category system_controller Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Scanning category user_interface Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Scanning into folder /data/plugins/ Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Plugin folders cleanup completed Sep 07 07:34:36 minidsp-shd volumio[2110]: info: ------------------------------------------- Sep 07 07:34:36 minidsp-shd volumio[2110]: info: ----- Core plugins startup ---- Sep 07 07:34:36 minidsp-shd volumio[2110]: info: ------------------------------------------- Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Loading plugins from folder /volumio/app/plugins/ Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin bluetooth to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin multiroom to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin upnp to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin metavolumio to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin ms_surface_dial to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin airplay_emulation to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin cd_controller to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin raat to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin tidalconnect to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Adding plugin upnp_browser to MyMusic Plugins Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Loading plugins from folder /data/plugins/ Sep 07 07:34:36 minidsp-shd volumio[2110]: info: Loading plugin "system"... Sep 07 07:34:37 minidsp-shd volumio[2110]: info: Loading plugin "appearance"... Sep 07 07:34:38 minidsp-shd volumio[2110]: info: Loading plugin "network"... Sep 07 07:34:38 minidsp-shd volumio[2110]: info: Refreshing Cached IP Addresses Sep 07 07:34:38 minidsp-shd sudo[2139]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Sep 07 07:34:38 minidsp-shd sudo[2139]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:34:38 minidsp-shd sudo[2139]: pam_unix(sudo:session): session closed for user root Sep 07 07:34:38 minidsp-shd sudo[2141]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 07 07:34:38 minidsp-shd volumio[2110]: info: Loading plugin "services"... Sep 07 07:34:38 minidsp-shd sudo[2141]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:34:38 minidsp-shd sudo[2141]: pam_unix(sudo:session): session closed for user root Sep 07 07:34:38 minidsp-shd volumio[2110]: info: Loading plugin "alsa_controller"... Sep 07 07:34:38 minidsp-shd sudo[2144]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Sep 07 07:34:38 minidsp-shd sudo[2144]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:34:38 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 07 07:34:38 minidsp-shd volumio[2110]: info: Loading plugin "wizard"... Sep 07 07:34:38 minidsp-shd volumio[2110]: info: Loading plugin "networkfs"... Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Cannot mount NAS MyMusic at system boot, trial number 1 ,retrying in 5 seconds Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Starting Udev Watcher for removable devices Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Ignoring mount for partition: BOOT Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Ignoring mount for partition: volumio Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Ignoring mount for partition: volumio_data Sep 07 07:34:39 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Loading plugin "volumio_command_line_client"... Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Loading plugin "upnp"... Sep 07 07:34:39 minidsp-shd volumio[2110]: info: [1725687279156] Starting Upmpd Daemon Sep 07 07:34:39 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Loading plugin "my_music"... Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Loading plugin "mpd"... Sep 07 07:34:39 minidsp-shd volumio[2110]: info: Loading plugin "upnp_browser"... Sep 07 07:34:40 minidsp-shd volumio[2110]: info: Loading plugin "bluetooth"... Sep 07 07:34:40 minidsp-shd volumio[2110]: info: [1725687280609] Starting BluetoothController Sep 07 07:34:40 minidsp-shd volumio[2110]: info: Loading plugin "alarm-clock"... Sep 07 07:34:41 minidsp-shd volumio[2110]: info: Loading plugin "manifestui"... Sep 07 07:34:41 minidsp-shd volumio[2110]: info: Loading plugin "metavolumio"... Sep 07 07:34:42 minidsp-shd sudo[2144]: pam_unix(sudo:session): session closed for user root Sep 07 07:34:43 minidsp-shd volumio[2110]: info: Loading plugin "airplay_emulation"... Sep 07 07:34:43 minidsp-shd volumio[2110]: info: Starting Shairport Sync Sep 07 07:34:43 minidsp-shd volumio[2110]: info: Loading plugin "cd_controller"... Sep 07 07:34:43 minidsp-shd volumio[2110]: info: Loading plugin "last_100"... Sep 07 07:34:43 minidsp-shd volumio[2110]: info: Loading plugin "raat"... Sep 07 07:34:44 minidsp-shd volumio[2110]: info: RAAT Plugin loaded Sep 07 07:34:44 minidsp-shd volumio[2110]: info: Adding restartRAATSocket REST API Endpoint Sep 07 07:34:44 minidsp-shd volumio[2110]: info: Adding restartRAATSocket REST Endpoint for plugin: music_service/raat Sep 07 07:34:44 minidsp-shd volumio[2110]: info: Loading plugin "streaming_services"... Sep 07 07:34:45 minidsp-shd volumio[2110]: info: Starting Streaming Service Transparent Proxy Sep 07 07:34:46 minidsp-shd volumio[2110]: info: Loading plugin "tidalconnect"... Sep 07 07:34:46 minidsp-shd volumio[2110]: info: Loading plugin "webradio"... Sep 07 07:34:46 minidsp-shd volumio[2110]: info: Loading plugin "i2s_dacs"... Sep 07 07:34:46 minidsp-shd volumio[2110]: info: I2S DAC not set, start Auto-detection Sep 07 07:34:46 minidsp-shd volumio[2110]: info: Loading plugin "volumiodiscovery"... Sep 07 07:34:46 minidsp-shd volumio[2110]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 07 07:34:46 minidsp-shd volumio[2110]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 07 07:34:46 minidsp-shd volumio[2110]: *** WARNING *** For more information see Sep 07 07:34:46 minidsp-shd volumio[2110]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 07 07:34:46 minidsp-shd volumio[2110]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 07 07:34:46 minidsp-shd volumio[2110]: *** WARNING *** For more information see Sep 07 07:34:46 minidsp-shd node[2110]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 07 07:34:46 minidsp-shd node[2110]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 07 07:34:46 minidsp-shd node[2110]: *** WARNING *** For more information see Sep 07 07:34:46 minidsp-shd node[2110]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 07 07:34:46 minidsp-shd node[2110]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 07 07:34:46 minidsp-shd node[2110]: *** WARNING *** For more information see Sep 07 07:34:46 minidsp-shd volumio[2110]: info: Applying required configuration parameters for plugin volumiodiscovery Sep 07 07:34:46 minidsp-shd volumio[2110]: info: Discovery: Started advertising with name: miniDSP SHD Sep 07 07:34:46 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 07 07:34:46 minidsp-shd volumio[2110]: info: Loading plugin "multiroom"... Sep 07 07:34:47 minidsp-shd volumio[2110]: STREAMING PROXY: Starting server on port 3245 Sep 07 07:34:47 minidsp-shd volumio[2110]: Node JS runtime: 14 Sep 07 07:34:49 minidsp-shd volumio[2110]: info: Applying required configuration parameters for plugin multiroom Sep 07 07:34:49 minidsp-shd volumio-remote-updater[457]: [2024-09-07 07:34:49] [connect] Successful connection Sep 07 07:34:49 minidsp-shd sudo[2162]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -rf /tmp/multiroom Sep 07 07:34:49 minidsp-shd sudo[2162]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:34:49 minidsp-shd sudo[2162]: pam_unix(sudo:session): session closed for user root Sep 07 07:34:49 minidsp-shd volumio[2110]: /bin/mkdir: cannot create directory ‘/tmp/hls’: File exists Sep 07 07:34:49 minidsp-shd volumio[2110]: info: MRS: MultiRoom plugin initialized Sep 07 07:34:49 minidsp-shd volumio[2110]: info: MRS: STOPPING SNAPCLIENT Sep 07 07:34:49 minidsp-shd volumio[2110]: info: MRS: Snap server stop Sep 07 07:34:49 minidsp-shd sudo[2178]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapclient Sep 07 07:34:49 minidsp-shd sudo[2178]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:34:49 minidsp-shd volumio[2110]: info: MRS: STOPPING volumioStreaming Sep 07 07:34:49 minidsp-shd sudo[2181]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapserver Sep 07 07:34:49 minidsp-shd sudo[2181]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:34:49 minidsp-shd systemd[1]: Starting Cleanup of Temporary Directories... Sep 07 07:34:49 minidsp-shd sudo[2184]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioStreaming Sep 07 07:34:49 minidsp-shd sudo[2184]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:34:49 minidsp-shd volumio[2110]: info: Loading plugin "outputs"... Sep 07 07:34:49 minidsp-shd sudo[2178]: pam_unix(sudo:session): session closed for user root Sep 07 07:34:49 minidsp-shd volumio[2110]: info: Loading plugin "albumart"... Sep 07 07:34:49 minidsp-shd sudo[2188]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/* Sep 07 07:34:49 minidsp-shd sudo[2188]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:34:49 minidsp-shd volumio[2110]: info: Loading plugin "ms_surface_dial"... Sep 07 07:34:49 minidsp-shd sudo[2188]: pam_unix(sudo:session): session closed for user root Sep 07 07:34:49 minidsp-shd sudo[2184]: pam_unix(sudo:session): session closed for user root Sep 07 07:34:49 minidsp-shd sudo[2181]: pam_unix(sudo:session): session closed for user root Sep 07 07:34:49 minidsp-shd systemd[1]: systemd-tmpfiles-clean.service: Succeeded. Sep 07 07:34:49 minidsp-shd systemd[1]: Started Cleanup of Temporary Directories. Sep 07 07:34:50 minidsp-shd volumio[2110]: Forking 3 albumart workers Sep 07 07:34:50 minidsp-shd volumio[2110]: info: Applying required configuration parameters for plugin ms_surface_dial Sep 07 07:34:50 minidsp-shd volumio[2110]: info: Plugin example_plugin is not enabled Sep 07 07:34:50 minidsp-shd volumio[2110]: info: Loading plugin "hi_res_audio"... Sep 07 07:34:51 minidsp-shd volumio[2110]: Starting albumart workers Sep 07 07:34:51 minidsp-shd volumio[2110]: Starting albumart workers Sep 07 07:34:51 minidsp-shd volumio[2110]: Starting albumart workers Sep 07 07:34:52 minidsp-shd volumio[2110]: info: Applying required configuration parameters for plugin hi_res_audio Sep 07 07:34:52 minidsp-shd volumio[2110]: info: Loading plugin "inputs"... Sep 07 07:34:53 minidsp-shd volumio[2110]: info: Loading plugin "qobuz"... Sep 07 07:34:55 minidsp-shd volumio[2110]: info: Loading plugin "tidal"... Sep 07 07:34:57 minidsp-shd volumio[2110]: info: Loading plugin "oem_helper"... Sep 07 07:34:59 minidsp-shd volumio[2110]: info: Applying required configuration parameters for plugin oem_helper Sep 07 07:34:59 minidsp-shd volumio[2110]: info: Loading plugin "updater_comm"... Sep 07 07:34:59 minidsp-shd volumio[2110]: info: Plugin mpdemulation is not enabled Sep 07 07:34:59 minidsp-shd volumio[2110]: info: Loading plugin "rest_api"... Sep 07 07:34:59 minidsp-shd volumio[2110]: info: Loading plugin "websocket"... Sep 07 07:34:59 minidsp-shd volumio[2110]: info: Loading i18n strings for locale de Sep 07 07:34:59 minidsp-shd volumio[2110]: Updating browse sources language Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::initPlayerControls Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: Express server listening on port 3000 Sep 07 07:34:59 minidsp-shd volumio[2110]: [Metrics] WebUI: 25s 569.35ms Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreStateMachine::resetVolumioState Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreStateMachine::getcurrentVolume Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioRetrievevolume Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreStateMachine::pushState Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CorePlayQueue::getTrack 0 Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioPushState Sep 07 07:34:59 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 07 07:34:59 minidsp-shd volumio[2110]: info: Cannot mount NAS MyMusic at system boot, trial number 2 ,retrying in 5 seconds Sep 07 07:35:00 minidsp-shd sudo[2285]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Sep 07 07:35:00 minidsp-shd sudo[2285]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:00 minidsp-shd sudo[2285]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: inputs , getVolume Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: inputs , getDSP Sep 07 07:35:00 minidsp-shd sudo[2288]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 07 07:35:00 minidsp-shd sudo[2288]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:00 minidsp-shd sudo[2288]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:00 minidsp-shd volumio[2110]: error: Cannot read config.txt file: Error: ENOENT: no such file or directory, open '/boot/config.txt' Sep 07 07:35:00 minidsp-shd volumio[2110]: info: Completed loading Core Plugins Sep 07 07:35:00 minidsp-shd volumio[2110]: info: Preparing to generate the ALSA configuration file Sep 07 07:35:00 minidsp-shd volumio[2110]: info: MRS: Removed streaming files Sep 07 07:35:00 minidsp-shd volumio[2110]: info: MRS: volumioStreaming STOPPED Sep 07 07:35:00 minidsp-shd volumio[2110]: info: MRS: SNAPSERVER STOPPED Sep 07 07:35:00 minidsp-shd volumio[2110]: info: MRS: SNAPCLIENT STOPPED Sep 07 07:35:00 minidsp-shd volumio[2110]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Sep 07 07:35:00 minidsp-shd volumio[2110]: info: Reading ALSA contributions from plugins. Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 1 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 2 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 3 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 4 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 5 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 6 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 7 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 8 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 9 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 10 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 11 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 12 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 13 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 14 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 15 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 16 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 17 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 18 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 19 Sep 07 07:35:00 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 20 Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 07 07:35:00 minidsp-shd volumio[2110]: info: Discovery: Getting this device information Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioGetState Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CorePlayQueue::getTrack 0 Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioGetState Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CorePlayQueue::getTrack 0 Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Sep 07 07:35:00 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Reloading queue from file Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Setting Device type: NanoPi NEO 2 Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreStateMachine::setRepeat null single undefined Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreStateMachine::pushState Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CorePlayQueue::getTrack 0 Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioPushState Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreStateMachine::setRandom null Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreStateMachine::pushState Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CorePlayQueue::getTrack 0 Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioPushState Sep 07 07:35:01 minidsp-shd sudo[2297]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Sep 07 07:35:01 minidsp-shd sudo[2297]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:01 minidsp-shd sudo[2297]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Asound.conf file unchanged, so no further update is needed Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Output device has changed, restarting MPD Sep 07 07:35:01 minidsp-shd sudo[2300]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 07 07:35:01 minidsp-shd sudo[2300]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:01 minidsp-shd sudo[2300]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Output device has changed, restarting Shairport Sync Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 07 07:35:01 minidsp-shd sudo[2303]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 07 07:35:01 minidsp-shd sudo[2303]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:01 minidsp-shd systemd[1]: Stopping Music Player Daemon... Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 07 07:35:01 minidsp-shd volumio[2110]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:01 minidsp-shd volumio[2110]: info: ___________ START PLUGINS ___________ Sep 07 07:35:01 minidsp-shd volumio[2110]: info: ControllerMpd::onStart: Initializing MPD Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Creating MPD Configuration file Sep 07 07:35:01 minidsp-shd sudo[2311]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 07 07:35:01 minidsp-shd sudo[2311]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:01 minidsp-shd sudo[2311]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 07 07:35:01 minidsp-shd volumio[2110]: info: [1725687301622] CoreMusicLibrary::Adding element Medienserver Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 07 07:35:01 minidsp-shd sudo[2314]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 07 07:35:01 minidsp-shd sudo[2314]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding Manifest REST API Endpoints Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding manifestui REST Endpoint for plugin: miscellanea/manifestui Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding METAVOLUMIO REST API Endpoints Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding metavolumio REST Endpoint for plugin: miscellanea/metavolumio Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding getSimilarArtists REST Endpoint for plugin: miscellanea/metavolumio Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding getSimilarAlbums REST Endpoint for plugin: miscellanea/metavolumio Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding getSimilarTracks REST Endpoint for plugin: miscellanea/metavolumio Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:01 minidsp-shd sudo[2317]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/hciconfig hci0 name miniDSP SHD Sep 07 07:35:01 minidsp-shd sudo[2317]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 07 07:35:01 minidsp-shd sudo[2317]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Preparing CD Folders Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding CD REST API Endpoints Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Adding cdPostRip REST Endpoint for plugin: music_service/cd_controller Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Starting UDEV Watcher for CD Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Detecting CD presence with UDEV Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: networkfs , getUdevDevices Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 07 07:35:01 minidsp-shd volumio[2110]: info: [1725687301932] CoreMusicLibrary::Adding element Last_100 Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Starting RAAT Plugin Sep 07 07:35:01 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , addAdditionalUISections Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Additional UI Settings Added for plugin music_service/raat Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Streaming services startup Sep 07 07:35:01 minidsp-shd volumio[2110]: info: Starting Streaming Daemon Sep 07 07:35:02 minidsp-shd sudo[2326]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Sep 07 07:35:02 minidsp-shd sudo[2326]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:02 minidsp-shd sudo[2326]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 07 07:35:02 minidsp-shd volumio[2110]: info: [1725687302129] CoreMusicLibrary::Adding element Webradio Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 07 07:35:02 minidsp-shd sudo[2334]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Sep 07 07:35:02 minidsp-shd sudo[2334]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , pushMultiRoomStatus Sep 07 07:35:02 minidsp-shd volumio[2110]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:02 minidsp-shd systemd[1]: Stopping Volumio Tidal Connect Service... Sep 07 07:35:02 minidsp-shd systemd[1]: vtcs.service: Main process exited, code=killed, status=15/TERM Sep 07 07:35:02 minidsp-shd systemd[1]: vtcs.service: Succeeded. Sep 07 07:35:02 minidsp-shd systemd[1]: Stopped Volumio Tidal Connect Service. Sep 07 07:35:02 minidsp-shd sudo[2334]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:02 minidsp-shd volumio[2110]: error: Hi Res Audio Failed Login: Missing Login Data Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Adding HIGHRESAUDIO REST API Endpoints Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Adding getStreamUrlhi_res_audio REST Endpoint for plugin: music_service/hi_res_audio Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 07 07:35:02 minidsp-shd systemd[1]: mpd.service: Succeeded. Sep 07 07:35:02 minidsp-shd systemd[1]: Stopped Music Player Daemon. Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Volumio Calling Home Sep 07 07:35:02 minidsp-shd systemd[1]: Starting Music Player Daemon... Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Stopping AccessToken refresher cron for QOBUZ Sep 07 07:35:02 minidsp-shd volumio[2110]: info: AccessToken refresher cron started for QOBUZ Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Stopping AccessToken refresher cron Sep 07 07:35:02 minidsp-shd volumio[2110]: info: AccessToken refresher cron started Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Adding TIDAL REST API Endpoints Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Adding getStreamUrltidal REST Endpoint for plugin: music_service/tidal Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Adding QOBUZ REST API Endpoints Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Adding getStreamUrlqobuz REST Endpoint for plugin: music_service/qobuz Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Discovery: adding b4b37217-76f2-4143-a79b-b59232a953be Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Discovery: Found device miniDSP SHD Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioGetState Sep 07 07:35:02 minidsp-shd volumio[2110]: info: CorePlayQueue::getTrack 0 Sep 07 07:35:02 minidsp-shd volumio[2110]: info: MRS: Pushing multiroomSync output for this device Sep 07 07:35:02 minidsp-shd volumio[2110]: info: MRS: Pushing multiroomSync output Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Adding audio output: Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Adding audio output: Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Upmpdcli Daemon Started Sep 07 07:35:02 minidsp-shd volumio[2110]: info: Serial port opened successfully Sep 07 07:35:03 minidsp-shd volumio[2110]: error: Cannot start Volumio Streaming Daemon Sep 07 07:35:03 minidsp-shd volumio[2110]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Sep 07 07:35:03 minidsp-shd volumio[2110]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Sep 07 07:35:03 minidsp-shd volumio[2110]: error: Cannot set new Bluetooth Name : Error: Command failed: /usr/bin/sudo /bin/hciconfig hci0 name 'miniDSP SHD' Sep 07 07:35:03 minidsp-shd volumio[2110]: Can't get device info: No such device Sep 07 07:35:03 minidsp-shd volumio[2110]: info: MPD Permissions set Sep 07 07:35:03 minidsp-shd volumio[2110]: info: MPD Permissions set Sep 07 07:35:03 minidsp-shd volumio[2110]: info: msSurfaceDial Managed Objs {"/org/bluez":{"org.freedesktop.DBus.Introspectable":{},"org.bluez.AgentManager1":{},"org.bluez.ProfileManager1":{}}} Sep 07 07:35:03 minidsp-shd volumio[2110]: info: [msSurfaceDial init()] check /org/bluez Sep 07 07:35:03 minidsp-shd volumio[2110]: info: [msSurfaceDial init()] Adapter: null; SurfaceDial: null Sep 07 07:35:03 minidsp-shd volumio[2110]: info: msSurfaceDial BluetoothSurfaceDial init() - ready! Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::Reload Ui Sep 07 07:35:03 minidsp-shd volumio[2110]: info: Volumio called home Sep 07 07:35:03 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Total Clients: 21 Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: msSurfaceDial volumioupdatevolume callback: {"vol":98,"dbVolume":-2.5,"disableVolumeControl":false} Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreStateMachine::pushState Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CorePlayQueue::getTrack 0 Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioPushState Sep 07 07:35:03 minidsp-shd volumio[2110]: info: MRS: Pushing multiroomSync output update for this device Sep 07 07:35:03 minidsp-shd volumio[2110]: info: MRS: Pushing multiroomSync output Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: raat , updateRoonVolume Sep 07 07:35:03 minidsp-shd volumio[2110]: info: Ignoring ROON Volume update because of undefined data Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: raat , updateDSP Sep 07 07:35:03 minidsp-shd volumio[2110]: info: updateDSP function in raat called! Sep 07 07:35:03 minidsp-shd volumio[2110]: info: Updating RAAT Signal Path Sep 07 07:35:03 minidsp-shd volumio[2110]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: raat , reconfigureAndRestartRaat Sep 07 07:35:03 minidsp-shd volumio[2110]: info: Reconfiguring and Restarting RAAT Plugin Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 07 07:35:03 minidsp-shd volumio[2110]: info: Not Reporting Auto name since its the default one Sep 07 07:35:03 minidsp-shd volumio[2110]: info: RAAT Overriding default device vendor model Sep 07 07:35:03 minidsp-shd volumio[2110]: info: Adding MINIDSP Inputs Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 07 07:35:03 minidsp-shd volumio[2110]: info: [1725687303656] CoreMusicLibrary::Adding element Inputs Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 07 07:35:03 minidsp-shd volumio[2110]: info: [1725687303662] CoreMusicLibrary::Adding element Presets Sep 07 07:35:03 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 07 07:35:03 minidsp-shd volumio[2110]: Cannot find translation for source Presets Sep 07 07:35:03 minidsp-shd volumio[2110]: (node:2110) [DEP0005] DeprecationWarning: Buffer() is deprecated due to security and usability issues. Please use the Buffer.alloc(), Buffer.allocUnsafe(), or Buffer.from() methods instead. Sep 07 07:35:03 minidsp-shd volumio[2110]: (Use `node --trace-deprecation ...` to show where the warning was created) Sep 07 07:35:03 minidsp-shd volumio[2110]: info: Starting Shairport Sync Sep 07 07:35:03 minidsp-shd volumio[2110]: info: Starting Shairport Sync Sep 07 07:35:03 minidsp-shd sudo[2373]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Sep 07 07:35:03 minidsp-shd sudo[2373]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:04 minidsp-shd volumio[2110]: info: Starting Shairport Sync Sep 07 07:35:04 minidsp-shd systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Sep 07 07:35:04 minidsp-shd systemd[1]: shairport-sync.service: Succeeded. Sep 07 07:35:04 minidsp-shd systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Sep 07 07:35:04 minidsp-shd sudo[2376]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Sep 07 07:35:04 minidsp-shd sudo[2376]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:04 minidsp-shd systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Sep 07 07:35:04 minidsp-shd sudo[2373]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:04 minidsp-shd systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Sep 07 07:35:04 minidsp-shd systemd[1]: shairport-sync.service: Main process exited, code=killed, status=15/TERM Sep 07 07:35:04 minidsp-shd systemd[1]: shairport-sync.service: Succeeded. Sep 07 07:35:04 minidsp-shd sudo[2380]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Sep 07 07:35:04 minidsp-shd sudo[2380]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:04 minidsp-shd systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Sep 07 07:35:04 minidsp-shd systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Sep 07 07:35:04 minidsp-shd sudo[2376]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:04 minidsp-shd volumio-remote-updater[457]: [2024-09-07 07:35:04] [connect] Successful connection Sep 07 07:35:04 minidsp-shd systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Sep 07 07:35:04 minidsp-shd systemd[1]: shairport-sync.service: Main process exited, code=killed, status=15/TERM Sep 07 07:35:04 minidsp-shd systemd[1]: shairport-sync.service: Succeeded. Sep 07 07:35:04 minidsp-shd systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Sep 07 07:35:04 minidsp-shd systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Sep 07 07:35:04 minidsp-shd sudo[2380]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:04 minidsp-shd volumio[2110]: info: MRS: Found cast device: SHIELD-Android-TV-8c0979a10d14af55705cdff1f56832d4 Sep 07 07:35:04 minidsp-shd volumio[2110]: info: Adding audio output: Sep 07 07:35:04 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkCurrentAudioDeviceAvailable Sep 07 07:35:04 minidsp-shd sudo[2390]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart raat-daemon.service Sep 07 07:35:04 minidsp-shd sudo[2390]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:04 minidsp-shd systemd[1]: Stopping RAAT DAEMON... Sep 07 07:35:04 minidsp-shd systemd[1]: raat-daemon.service: Main process exited, code=killed, status=15/TERM Sep 07 07:35:04 minidsp-shd systemd[1]: raat-daemon.service: Succeeded. Sep 07 07:35:04 minidsp-shd systemd[1]: Stopped RAAT DAEMON. Sep 07 07:35:04 minidsp-shd systemd[1]: Started RAAT DAEMON. Sep 07 07:35:04 minidsp-shd sudo[2390]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:04 minidsp-shd volumio[2110]: info: Shairport-Sync Started Sep 07 07:35:04 minidsp-shd volumio[2110]: Error adding Membership: Error: addMembership EINVAL Sep 07 07:35:04 minidsp-shd volumio[2110]: info: Shairport-Sync Started Sep 07 07:35:04 minidsp-shd volumio[2110]: info: Shairport-Sync Started Sep 07 07:35:04 minidsp-shd volumio-remote-updater[457]: [2024-09-07 07:35:04] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1725687304 101 Sep 07 07:35:04 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Total Clients: 22 Sep 07 07:35:04 minidsp-shd volumio[2110]: info: Raat Daemon started successfully Sep 07 07:35:04 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumiosetSourceActiveno-source Sep 07 07:35:04 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 07 07:35:04 minidsp-shd volumio[2110]: Cannot find translation for source Presets Sep 07 07:35:04 minidsp-shd sudo[2403]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumiobt.service Sep 07 07:35:04 minidsp-shd sudo[2403]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:04 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioGetState Sep 07 07:35:04 minidsp-shd volumio[2110]: info: CorePlayQueue::getTrack 0 Sep 07 07:35:04 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Total Clients: 23 Sep 07 07:35:04 minidsp-shd sudo[2403]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:04 minidsp-shd volumio[2110]: info: Executing endpoint restartRAATSocket Sep 07 07:35:04 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: raat , establishDaemonConnection Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Volumio BT Module successfully started Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Cannot mount NAS MyMusic at system boot, trial number 3 ,retrying in 5 seconds Sep 07 07:35:05 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Total Clients: 24 Sep 07 07:35:05 minidsp-shd volumio[2110]: info: TidalConnect service stoped! Sep 07 07:35:05 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Enabling external Volume Control Sep 07 07:35:05 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:05 minidsp-shd volumio[2110]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 07 07:35:05 minidsp-shd mpd[2351]: Sep 07 07:35 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Sep 07 07:35:05 minidsp-shd volumio[2110]: verbose: New Socket.io Connection to 192.168.1.220 from 192.168.1.79 UA: okhttp/4.9.2 Total Clients: 25 Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Adding tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Adding tc_connect REST Endpoint for plugin: music_service/tidalconnect Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Preload queue cleared Sep 07 07:35:05 minidsp-shd volumio[2110]: info: CoreCommandRouter::volumioAddQueueItems Sep 07 07:35:05 minidsp-shd volumio[2110]: info: CoreStateMachine::addQueueItems Sep 07 07:35:05 minidsp-shd volumio[2110]: info: CorePlayQueue::addQueueItems Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Preload queue cleared Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Adding Item to queue: artists://The%20The Sep 07 07:35:05 minidsp-shd sudo[2415]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Sep 07 07:35:05 minidsp-shd sudo[2415]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 07 07:35:05 minidsp-shd volumio[2110]: info: Exploding uri artists://The%20The in service mpd Sep 07 07:35:05 minidsp-shd volumio[2110]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 07 07:35:05 minidsp-shd volumio[2110]: TypeError: Cannot read property 'sendCommand' of undefined Sep 07 07:35:05 minidsp-shd volumio[2110]: at ControllerMpd.explodeUri (/volumio/app/plugins/music_service/mpd/index.js:2187:20) Sep 07 07:35:05 minidsp-shd volumio[2110]: at CoreCommandRouter.explodeUriFromService (/volumio/app/index.js:1359:16) Sep 07 07:35:05 minidsp-shd volumio[2110]: at CorePlayQueue.explodeUriFromCache (/volumio/app/playqueue.js:123:24) Sep 07 07:35:05 minidsp-shd volumio[2110]: at CorePlayQueue.explodeUri (/volumio/app/playqueue.js:181:19) Sep 07 07:35:05 minidsp-shd volumio[2110]: at CorePlayQueue.addQueueItems (/volumio/app/playqueue.js:223:30) Sep 07 07:35:05 minidsp-shd volumio[2110]: at CoreStateMachine.addQueueItems (/volumio/app/statemachine.js:247:25) Sep 07 07:35:05 minidsp-shd volumio[2110]: at CoreCommandRouter.addQueueItems (/volumio/app/index.js:447:28) Sep 07 07:35:05 minidsp-shd volumio[2110]: at CoreCommandRouter.addPlay (/volumio/app/index.js:465:10) Sep 07 07:35:05 minidsp-shd volumio[2110]: at CoreCommandRouter.playItemsList (/volumio/app/index.js:475:17) Sep 07 07:35:05 minidsp-shd volumio[2110]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:118:33) Sep 07 07:35:05 minidsp-shd volumio[2110]: at Socket.emit (events.js:400:28) Sep 07 07:35:05 minidsp-shd volumio[2110]: at /volumio/node_modules/socket.io/lib/socket.js:503:12 Sep 07 07:35:05 minidsp-shd volumio[2110]: at processTicksAndRejections (internal/process/task_queues.js:77:11) Sep 07 07:35:05 minidsp-shd volumio[2110]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 07 07:35:05 minidsp-shd systemd[1]: Started Volumio Tidal Connect Service. Sep 07 07:35:05 minidsp-shd sudo[2415]: pam_unix(sudo:session): session closed for user root Sep 07 07:35:06 minidsp-shd sudo[2430]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-09-07 07:34 Sep 07 07:35:06 minidsp-shd sudo[2430]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 10 (buster)" NAME="Debian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="17fcb754ddd6bd152b01008c46cc4ba1ca48bf35" VOLUMIO_FE_VERSION="614d7b13ffdcb0cc5a6072e7d06f59d52e323e71" VOLUMIO_FE3_VERSION="570aaed971c1346d45d1172dc445b086b258c6d1" VOLUMIO_BE_VERSION="281cefcd7a302aa7cfba569185cf7aae19b8c376" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="minidspshd" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri 22 Mar 2024 03:00:28 PM CET" VOLUMIO_VERSION="3.608" VOLUMIO_HARDWARE="nanopineo2" VOLUMIO_DEVICENAME="NanoPi Neo2" VOLUMIO_VENDOR="miniDSP" VOLUMIO_MODEL="SHD" VOLUMIO_VENDOR_MODEL="miniDSP SHD" VOLUMIO_HASH="29ccfe8a9cff19911db4b736879ac117"