-- Logs begin at Sun 2025-10-26 18:24:25 MST, end at Sun 2025-10-26 18:47:43 MST. -- Oct 26 18:46:02 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:46:02 volumio-1 volumiossh-tunnel[24664]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:02 volumio-1 autossh[24665]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:02 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:02 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:02 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:02 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 10. Oct 26 18:46:02 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:02 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:02 volumio-1 autossh[24670]: port set to 0, monitoring disabled Oct 26 18:46:02 volumio-1 autossh[24670]: starting ssh (count 1) Oct 26 18:46:02 volumio-1 autossh[24670]: ssh child pid is 24673 Oct 26 18:46:05 volumio-1 volumiossh-tunnel[24669]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:05 volumio-1 autossh[24670]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:05 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:05 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:06 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:06 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 11. Oct 26 18:46:06 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:06 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:06 volumio-1 autossh[24675]: port set to 0, monitoring disabled Oct 26 18:46:06 volumio-1 autossh[24675]: starting ssh (count 1) Oct 26 18:46:06 volumio-1 autossh[24675]: ssh child pid is 24678 Oct 26 18:46:06 volumio-1 volumio[24221]: error: MyVolumio Plugin failed to start in a timely fashion Oct 26 18:46:06 volumio-1 volumio[24221]: [Metrics] CommandRouter: 58s 322.75ms Oct 26 18:46:06 volumio-1 volumio[24221]: info: CoreCommandRouter::volumiosetStartupVolume Oct 26 18:46:06 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:46:06 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:46:06 volumio-1 volumio[24221]: info: CoreCommandRouter::Close All Modals sent Oct 26 18:46:06 volumio-1 volumio[24221]: info: CoreCommandRouter::Close All Modals sent Oct 26 18:46:06 volumio-1 volumio[24221]: info: Cannot play startup sound: Error: Command failed: /usr/bin/aplay -D volumio /volumio/app/startup.wav Oct 26 18:46:06 volumio-1 volumio[24221]: ALSA lib pcm_hw.c:1822:(_snd_pcm_hw_open) Invalid value for card Oct 26 18:46:06 volumio-1 volumio[24221]: aplay: main:828: audio open error: No such device Oct 26 18:46:07 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Oct 26 18:46:07 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Oct 26 18:46:07 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: raat , onStop Oct 26 18:46:07 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Oct 26 18:46:08 volumio-1 volumiossh-tunnel[24674]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:08 volumio-1 autossh[24675]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:08 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:08 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:09 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:09 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 12. Oct 26 18:46:09 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:09 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:09 volumio-1 autossh[24687]: port set to 0, monitoring disabled Oct 26 18:46:09 volumio-1 autossh[24687]: starting ssh (count 1) Oct 26 18:46:09 volumio-1 autossh[24687]: ssh child pid is 24690 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: adding 211f4118-4f19-42e5-b7fd-ed6b8874b1e6 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Found device OfficeJukeBox Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Connecting to remote: 192.168.50.238 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: adding 5524abed-5568-4218-b787-858a6d4c8672 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Found device Volumio-1 Oct 26 18:46:11 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:11 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: adding 7a488e13-c612-41af-897c-9242837d6519 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Found device HeadphoneSystem Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Connecting to remote: 192.168.211.1 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: this is already registered, 211f4118-4f19-42e5-b7fd-ed6b8874b1e6 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Found device OfficeJukeBox Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Connecting to remote: 192.168.211.1 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: this is already registered, 5524abed-5568-4218-b787-858a6d4c8672 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Found device Volumio-1 Oct 26 18:46:11 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:11 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: this is already registered, 7a488e13-c612-41af-897c-9242837d6519 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Found device HeadphoneSystem Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Connecting to remote: 192.168.50.40 Oct 26 18:46:11 volumio-1 go-librespot[24488]: time="2025-10-26T18:46:11-07:00" level=debug msg="new websocket client" Oct 26 18:46:11 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket established Oct 26 18:46:11 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 6 Oct 26 18:46:11 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 7 Oct 26 18:46:11 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8 Oct 26 18:46:11 volumio-1 volumio[24221]: info: Discovery: Connected to remote: 192.168.50.40 Oct 26 18:46:11 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:11 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:12 volumio-1 volumiossh-tunnel[24686]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:12 volumio-1 autossh[24687]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:12 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:12 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:12 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Failed to obtain lounge token with screen Id from stored MDX context (1b5q1pbph7f2qdj38ge0r5r55t): Oct 26 18:46:12 volumio-1 volumio[24221]: (ConnectionError) (YouTube) Connection error in getting lounge token Oct 26 18:46:12 volumio-1 volumio[24221]: Error info: { Oct 26 18:46:12 volumio-1 volumio[24221]: url: 'https://www.youtube.com/api/lounge/pairing/get_lounge_token_batch' Oct 26 18:46:12 volumio-1 volumio[24221]: } Oct 26 18:46:12 volumio-1 volumio[24221]: --->(FetchError) request to https://www.youtube.com/api/lounge/pairing/get_lounge_token_batch failed, reason: connect EHOSTUNREACH 192.168.211.1:443 Oct 26 18:46:12 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:12 volumio-1 volumio[24221]: ConnectionError: (YouTube) Connection error in getting lounge token Oct 26 18:46:12 volumio-1 volumio[24221]: at Session._Session_getLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:435:15) Oct 26 18:46:12 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:12 volumio-1 volumio[24221]: at async Session.begin (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:131:31) Oct 26 18:46:12 volumio-1 volumio[24221]: at async Promise.all (index 0) Oct 26 18:46:12 volumio-1 volumio[24221]: at async YouTubeApp.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:110:13) Oct 26 18:46:12 volumio-1 volumio[24221]: at async YouTubeCastReceiver.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/YouTubeCastReceiver.js:91:13) Oct 26 18:46:12 volumio-1 volumio[24221]: Going to generate fresh screen Id and try again... Oct 26 18:46:12 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Failed to obtain lounge token with screen Id from stored MDX context (ena1mgi35avp0g8cqnu58ghnui): Oct 26 18:46:12 volumio-1 volumio[24221]: (ConnectionError) (YouTube Music) Connection error in getting lounge token Oct 26 18:46:12 volumio-1 volumio[24221]: Error info: { Oct 26 18:46:12 volumio-1 volumio[24221]: url: 'https://www.youtube.com/api/lounge/pairing/get_lounge_token_batch' Oct 26 18:46:12 volumio-1 volumio[24221]: } Oct 26 18:46:12 volumio-1 volumio[24221]: --->(FetchError) request to https://www.youtube.com/api/lounge/pairing/get_lounge_token_batch failed, reason: connect EHOSTUNREACH 192.168.211.1:443 Oct 26 18:46:12 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:12 volumio-1 volumio[24221]: ConnectionError: (YouTube Music) Connection error in getting lounge token Oct 26 18:46:12 volumio-1 volumio[24221]: at Session._Session_getLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:435:15) Oct 26 18:46:12 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:12 volumio-1 volumio[24221]: at async Session.begin (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:131:31) Oct 26 18:46:12 volumio-1 volumio[24221]: at async Promise.all (index 1) Oct 26 18:46:12 volumio-1 volumio[24221]: at async YouTubeApp.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:110:13) Oct 26 18:46:12 volumio-1 volumio[24221]: at async YouTubeCastReceiver.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/YouTubeCastReceiver.js:91:13) Oct 26 18:46:12 volumio-1 volumio[24221]: Going to generate fresh screen Id and try again... Oct 26 18:46:12 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:46:12 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:12 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 13. Oct 26 18:46:12 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:12 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:12 volumio-1 autossh[24707]: port set to 0, monitoring disabled Oct 26 18:46:12 volumio-1 autossh[24707]: starting ssh (count 1) Oct 26 18:46:12 volumio-1 autossh[24707]: ssh child pid is 24710 Oct 26 18:46:13 volumio-1 volumio[24221]: info: BOOT COMPLETED Oct 26 18:46:14 volumio-1 volumio[24221]: info: Getting Spotify volume Oct 26 18:46:14 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9 Oct 26 18:46:14 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:14 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:15 volumio-1 volumiossh-tunnel[24706]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:15 volumio-1 autossh[24707]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:15 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:15 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:15 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:15 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:15 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:15 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:15 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:15 volumio-1 volumio[24221]: } Oct 26 18:46:15 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:15 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:15 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:15 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:15 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:15 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:15 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:15 volumio-1 volumio[24221]: at AsyncTaskQueue.push (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:39:18) Oct 26 18:46:15 volumio-1 volumio[24221]: at /data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:339:67 Oct 26 18:46:15 volumio-1 volumio[24221]: at new Promise () Oct 26 18:46:15 volumio-1 volumio[24221]: at Session.sendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:338:16) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:236:28) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session.begin (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:207:26) Oct 26 18:46:15 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:15 volumio-1 volumio[24221]: at async Promise.all (index 0) Oct 26 18:46:15 volumio-1 volumio[24221]: at async YouTubeApp.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:110:13) Oct 26 18:46:15 volumio-1 volumio[24221]: at async YouTubeCastReceiver.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/YouTubeCastReceiver.js:91:13) Oct 26 18:46:15 volumio-1 volumio[24221]: error: [yt-cast-receiver] Failed to start receiver: Oct 26 18:46:15 volumio-1 volumio[24221]: (AppError) Failed to start YouTubeApp Oct 26 18:46:15 volumio-1 volumio[24221]: --->(SessionError) (YouTube) Failed to establish session Oct 26 18:46:15 volumio-1 volumio[24221]: ------>(ConnectionError) (YouTube) Connection error in generating screen Id Oct 26 18:46:15 volumio-1 volumio[24221]: Error info: { Oct 26 18:46:15 volumio-1 volumio[24221]: url: 'https://www.youtube.com/api/lounge/pairing/generate_screen_id' Oct 26 18:46:15 volumio-1 volumio[24221]: } Oct 26 18:46:15 volumio-1 volumio[24221]: --------->(FetchError) request to https://www.youtube.com/api/lounge/pairing/generate_screen_id failed, reason: connect EHOSTUNREACH 192.168.211.1:443 Oct 26 18:46:15 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:15 volumio-1 volumio[24221]: AppError: Failed to start YouTubeApp Oct 26 18:46:15 volumio-1 volumio[24221]: at YouTubeApp.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:125:19) Oct 26 18:46:15 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:15 volumio-1 volumio[24221]: at async YouTubeCastReceiver.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/YouTubeCastReceiver.js:91:13) Oct 26 18:46:15 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:15 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:15 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:15 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:15 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:15 volumio-1 volumio[24221]: } Oct 26 18:46:15 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:15 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:15 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:15 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:15 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:15 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:15 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:15 volumio-1 volumio[24221]: at AsyncTaskQueue.push (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:39:18) Oct 26 18:46:15 volumio-1 volumio[24221]: at /data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:339:67 Oct 26 18:46:15 volumio-1 volumio[24221]: at new Promise () Oct 26 18:46:15 volumio-1 volumio[24221]: at Session.sendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:338:16) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:236:28) Oct 26 18:46:15 volumio-1 volumio[24221]: at /data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:118:35 Oct 26 18:46:15 volumio-1 volumio[24221]: at Array.forEach () Oct 26 18:46:15 volumio-1 volumio[24221]: at YouTubeApp.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:114:24) Oct 26 18:46:15 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:15 volumio-1 volumio[24221]: at async YouTubeCastReceiver.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/YouTubeCastReceiver.js:91:13) Oct 26 18:46:15 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:15 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:15 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:15 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:15 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:15 volumio-1 volumio[24221]: } Oct 26 18:46:15 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:15 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:15 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:15 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:15 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:15 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:15 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:15 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:15 volumio-1 volumio[24221]: error: [ytcr] Failed to start plugin: Oct 26 18:46:15 volumio-1 volumio[24221]: (AppError) Failed to start YouTubeApp Oct 26 18:46:15 volumio-1 volumio[24221]: --->(SessionError) (YouTube) Failed to establish session Oct 26 18:46:15 volumio-1 volumio[24221]: ------>(ConnectionError) (YouTube) Connection error in generating screen Id Oct 26 18:46:15 volumio-1 volumio[24221]: Error info: { Oct 26 18:46:15 volumio-1 volumio[24221]: url: 'https://www.youtube.com/api/lounge/pairing/generate_screen_id' Oct 26 18:46:15 volumio-1 volumio[24221]: } Oct 26 18:46:15 volumio-1 volumio[24221]: --------->(FetchError) request to https://www.youtube.com/api/lounge/pairing/generate_screen_id failed, reason: connect EHOSTUNREACH 192.168.211.1:443 Oct 26 18:46:15 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:15 volumio-1 volumio[24221]: AppError: Failed to start YouTubeApp Oct 26 18:46:15 volumio-1 volumio[24221]: at YouTubeApp.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:125:19) Oct 26 18:46:15 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:15 volumio-1 volumio[24221]: at async YouTubeCastReceiver.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/YouTubeCastReceiver.js:91:13) Oct 26 18:46:15 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:15 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:15 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:15 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:15 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:15 volumio-1 volumio[24221]: } Oct 26 18:46:15 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:15 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:15 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:15 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:15 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:15 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:15 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:15 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:15 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:15 volumio-1 volumio[24221]: at async /data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:118:21 Oct 26 18:46:15 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:15 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 14. Oct 26 18:46:15 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:15 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:15 volumio-1 autossh[24712]: port set to 0, monitoring disabled Oct 26 18:46:15 volumio-1 autossh[24712]: starting ssh (count 1) Oct 26 18:46:15 volumio-1 autossh[24712]: ssh child pid is 24715 Oct 26 18:46:15 volumio-1 go-librespot[24488]: time="2025-10-26T18:46:15-07:00" level=fatal msg="failed running zeroconf" error="failed getting endpoints from resolver: failed fetching apresolve URL: Get \"https://apresolve.spotify.com/?type=accesspoint&type=dealer&type=spclient\": dial tcp: lookup apresolve.spotify.com: device or resource busy" Oct 26 18:46:15 volumio-1 systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:15 volumio-1 systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'. Oct 26 18:46:15 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Error: socket hang up Oct 26 18:46:15 volumio-1 volumio[24221]: at connResetException (internal/errors.js:607:14) Oct 26 18:46:15 volumio-1 volumio[24221]: at Socket.socketOnEnd (_http_client.js:493:23) Oct 26 18:46:15 volumio-1 volumio[24221]: at Socket.emit (events.js:327:22) Oct 26 18:46:15 volumio-1 volumio[24221]: at endReadableNT (internal/streams/readable.js:1327:12) Oct 26 18:46:15 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:80:21) Oct 26 18:46:15 volumio-1 volumio[24221]: (Use `node --trace-warnings ...` to show where the warning was created) Oct 26 18:46:15 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 6) Oct 26 18:46:15 volumio-1 volumio[24221]: (node:24221) [DEP0018] DeprecationWarning: Unhandled promise rejections are deprecated. In the future, promise rejections that are not handled will terminate the Node.js process with a non-zero exit code. Oct 26 18:46:15 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket closed Oct 26 18:46:17 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:46:18 volumio-1 volumiossh-tunnel[24711]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:18 volumio-1 autossh[24712]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:18 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:18 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:18 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:18 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:18 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:18 volumio-1 volumio[24221]: } Oct 26 18:46:18 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:18 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:18 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:18 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:18 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:18 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:18 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:18 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:18 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:18 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:18 volumio-1 volumio[24221]: at async /data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/YouTubeApp.js:118:21 Oct 26 18:46:18 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:18 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:18 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:18 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:18 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:18 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 8) Oct 26 18:46:18 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:18 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:18 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:18 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:18 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:18 volumio-1 volumio[24221]: } Oct 26 18:46:18 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:18 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:18 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:18 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:18 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:18 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:18 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:18 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:18 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:18 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:18 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:18 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:18 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:18 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 10) Oct 26 18:46:18 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:18 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:18 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:18 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:18 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:18 volumio-1 volumio[24221]: } Oct 26 18:46:18 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:18 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:18 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:18 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:18 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:18 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:18 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:18 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:18 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:18 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:18 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:18 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:18 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:18 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 12) Oct 26 18:46:18 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:18 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:18 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:18 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:18 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:18 volumio-1 volumio[24221]: } Oct 26 18:46:18 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:18 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:18 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:18 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:18 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:18 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:18 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:18 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:18 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:18 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:18 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:18 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:18 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:18 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 14) Oct 26 18:46:18 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:18 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 15. Oct 26 18:46:18 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:18 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:18 volumio-1 autossh[24717]: port set to 0, monitoring disabled Oct 26 18:46:18 volumio-1 autossh[24717]: starting ssh (count 1) Oct 26 18:46:18 volumio-1 autossh[24717]: ssh child pid is 24720 Oct 26 18:46:18 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:18 volumio-1 volumio[24221]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:19 volumio-1 systemd[1]: go-librespot-daemon.service: Service RestartSec=3s expired, scheduling restart. Oct 26 18:46:19 volumio-1 systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 2. Oct 26 18:46:19 volumio-1 systemd[1]: Stopped go-librespot Daemon. Oct 26 18:46:19 volumio-1 systemd[1]: Started go-librespot Daemon. Oct 26 18:46:19 volumio-1 go-librespot[24721]: go-librespot daemon starting... Oct 26 18:46:19 volumio-1 go-librespot[24721]: time="2025-10-26T18:46:19-07:00" level=info msg="running go-librespot 0.4.0" Oct 26 18:46:19 volumio-1 go-librespot[24721]: time="2025-10-26T18:46:19-07:00" level=debug msg="app state loaded" Oct 26 18:46:19 volumio-1 go-librespot[24721]: time="2025-10-26T18:46:19-07:00" level=debug msg="stored credentials not found" Oct 26 18:46:19 volumio-1 go-librespot[24721]: time="2025-10-26T18:46:19-07:00" level=info msg="api server listening on 127.0.0.1:9879" Oct 26 18:46:19 volumio-1 ntpd[770]: error resolving pool 1.debian.pool.ntp.org: System error (-11) Oct 26 18:46:19 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:19 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:19 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:19 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:19 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:19 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:19 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:19 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:20 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:46:20 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:46:20 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:46:20 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:20 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:20 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:46:21 volumio-1 volumiossh-tunnel[24716]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:21 volumio-1 autossh[24717]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:21 volumio-1 go-librespot[24721]: time="2025-10-26T18:46:21-07:00" level=fatal msg="failed running zeroconf" error="failed getting endpoints from resolver: failed fetching apresolve URL: Get \"https://apresolve.spotify.com/?type=accesspoint&type=dealer&type=spclient\": dial tcp 192.168.211.1:443: connect: no route to host" Oct 26 18:46:21 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:21 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:21 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:21 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:21 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:21 volumio-1 volumio[24221]: } Oct 26 18:46:21 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:21 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:21 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:21 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:21 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:21 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:21 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:21 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:21 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:21 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:21 volumio-1 systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:21 volumio-1 systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'. Oct 26 18:46:21 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:21 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:21 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:21 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 16) Oct 26 18:46:21 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:21 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:21 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:21 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:21 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:21 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:21 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:21 volumio-1 volumio[24221]: } Oct 26 18:46:21 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:21 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:21 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:21 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:21 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:21 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:21 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:21 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:21 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:21 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:21 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:21 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:21 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:21 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 18) Oct 26 18:46:21 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:21 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:21 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:21 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:21 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:21 volumio-1 volumio[24221]: } Oct 26 18:46:21 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:21 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:21 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:21 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:21 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:21 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:21 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:21 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:21 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:21 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:21 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:21 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:21 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:21 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 20) Oct 26 18:46:21 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:21 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:21 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:21 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:21 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:21 volumio-1 volumio[24221]: } Oct 26 18:46:21 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:21 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:21 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:21 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:21 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:21 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:21 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:21 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:21 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:21 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:21 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:21 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:21 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:21 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 22) Oct 26 18:46:21 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:21 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:21 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 16. Oct 26 18:46:21 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:21 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:21 volumio-1 autossh[24744]: port set to 0, monitoring disabled Oct 26 18:46:21 volumio-1 autossh[24744]: starting ssh (count 1) Oct 26 18:46:21 volumio-1 autossh[24744]: ssh child pid is 24747 Oct 26 18:46:21 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:22 volumio-1 volumio[24221]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:23 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:46:23 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:24 volumio-1 volumiossh-tunnel[24743]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:24 volumio-1 autossh[24744]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:24 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:24 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:24 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:24 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:24 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:24 volumio-1 volumio[24221]: } Oct 26 18:46:24 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:24 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:24 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:24 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:24 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:24 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:24 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:24 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:24 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:24 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:24 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:24 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:24 volumio-1 systemd[1]: go-librespot-daemon.service: Service RestartSec=3s expired, scheduling restart. Oct 26 18:46:24 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:24 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:24 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:24 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 24) Oct 26 18:46:24 volumio-1 systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 3. Oct 26 18:46:24 volumio-1 systemd[1]: Stopped go-librespot Daemon. Oct 26 18:46:24 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:24 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:24 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:24 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:24 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:24 volumio-1 volumio[24221]: } Oct 26 18:46:24 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:24 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:24 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:24 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:24 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:24 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:24 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:24 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:24 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:24 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:24 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:24 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:24 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:24 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 26) Oct 26 18:46:24 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:24 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:24 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:24 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:24 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:24 volumio-1 volumio[24221]: } Oct 26 18:46:24 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:24 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:24 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:24 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:24 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:24 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:24 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:24 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:24 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:24 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:24 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:24 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:24 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:24 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 28) Oct 26 18:46:24 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:24 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:24 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:24 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:24 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:24 volumio-1 volumio[24221]: } Oct 26 18:46:24 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:24 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:24 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:24 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:24 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:24 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:24 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:24 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:24 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:24 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:24 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:24 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:24 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:24 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 30) Oct 26 18:46:24 volumio-1 systemd[1]: Started go-librespot Daemon. Oct 26 18:46:24 volumio-1 go-librespot[24748]: go-librespot daemon starting... Oct 26 18:46:24 volumio-1 go-librespot[24748]: time="2025-10-26T18:46:24-07:00" level=info msg="running go-librespot 0.4.0" Oct 26 18:46:24 volumio-1 go-librespot[24748]: time="2025-10-26T18:46:24-07:00" level=debug msg="app state loaded" Oct 26 18:46:24 volumio-1 go-librespot[24748]: time="2025-10-26T18:46:24-07:00" level=debug msg="stored credentials not found" Oct 26 18:46:24 volumio-1 go-librespot[24748]: time="2025-10-26T18:46:24-07:00" level=info msg="api server listening on 127.0.0.1:9879" Oct 26 18:46:24 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:24 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 17. Oct 26 18:46:24 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:24 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:24 volumio-1 autossh[24756]: port set to 0, monitoring disabled Oct 26 18:46:24 volumio-1 autossh[24756]: starting ssh (count 1) Oct 26 18:46:24 volumio-1 autossh[24756]: ssh child pid is 24759 Oct 26 18:46:25 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:25 volumio-1 go-librespot[24748]: time="2025-10-26T18:46:25-07:00" level=debug msg="new websocket client" Oct 26 18:46:25 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket established Oct 26 18:46:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:46:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:46:27 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:46:27 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:27 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:46:27 volumio-1 volumiossh-tunnel[24755]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:27 volumio-1 go-librespot[24748]: time="2025-10-26T18:46:27-07:00" level=fatal msg="failed running zeroconf" error="failed getting endpoints from resolver: failed fetching apresolve URL: Get \"https://apresolve.spotify.com/?type=accesspoint&type=dealer&type=spclient\": dial tcp 192.168.211.1:443: connect: no route to host" Oct 26 18:46:27 volumio-1 autossh[24756]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:27 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:27 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:27 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:27 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:27 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:27 volumio-1 volumio[24221]: } Oct 26 18:46:27 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:27 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:27 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:27 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:27 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:27 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:27 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:27 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:27 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:27 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:27 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:27 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:27 volumio-1 systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:27 volumio-1 systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'. Oct 26 18:46:27 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:27 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:27 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:27 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 32) Oct 26 18:46:27 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:27 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:27 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:27 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:27 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:27 volumio-1 volumio[24221]: } Oct 26 18:46:27 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:27 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:27 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:27 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:27 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:27 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:27 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:27 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:27 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:27 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:27 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:27 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:27 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:27 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 34) Oct 26 18:46:27 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:27 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:27 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:27 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:27 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:27 volumio-1 volumio[24221]: } Oct 26 18:46:27 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:27 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:27 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:27 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:27 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:27 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:27 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:27 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:27 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:27 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:27 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:27 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:27 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:27 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 36) Oct 26 18:46:27 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:27 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:27 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:27 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:27 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:27 volumio-1 volumio[24221]: } Oct 26 18:46:27 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:27 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:27 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:27 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:27 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:27 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:27 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:27 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:27 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:27 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:27 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:27 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:27 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:27 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 38) Oct 26 18:46:27 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket closed Oct 26 18:46:27 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:27 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 18. Oct 26 18:46:27 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:27 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:27 volumio-1 autossh[24764]: port set to 0, monitoring disabled Oct 26 18:46:27 volumio-1 autossh[24764]: starting ssh (count 1) Oct 26 18:46:27 volumio-1 autossh[24764]: ssh child pid is 24767 Oct 26 18:46:28 volumio-1 volumio[24221]: info: Getting Spotify volume Oct 26 18:46:28 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:28 volumio-1 volumio[24221]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) Oct 26 18:46:28 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 39) Oct 26 18:46:28 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9 Oct 26 18:46:28 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:28 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:28 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:46:28 volumio-1 ntpd[770]: Soliciting pool server 192.168.211.1 Oct 26 18:46:29 volumio-1 volumio[24221]: verbose: New Socket.io Connection to 192.168.50.25:3000 from 192.168.50.144 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 9 Oct 26 18:46:30 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:30 volumio-1 volumio[24221]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:30 volumio-1 volumiossh-tunnel[24763]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:30 volumio-1 autossh[24764]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:30 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:30 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:30 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:30 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:30 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:30 volumio-1 volumio[24221]: } Oct 26 18:46:30 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:30 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:30 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:30 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:30 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:30 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:30 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:30 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:30 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:30 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:30 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:30 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:30 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:30 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:30 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:30 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 41) Oct 26 18:46:30 volumio-1 systemd[1]: go-librespot-daemon.service: Service RestartSec=3s expired, scheduling restart. Oct 26 18:46:30 volumio-1 systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 4. Oct 26 18:46:30 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:30 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:30 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:30 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:30 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:30 volumio-1 volumio[24221]: } Oct 26 18:46:30 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:30 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:30 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:30 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:30 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:30 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:30 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:30 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:30 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:30 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:30 volumio-1 systemd[1]: Stopped go-librespot Daemon. Oct 26 18:46:30 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:30 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:30 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:30 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 43) Oct 26 18:46:30 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:30 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:30 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:30 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:30 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:30 volumio-1 volumio[24221]: } Oct 26 18:46:30 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:30 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:30 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:30 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:30 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:30 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:30 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:30 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:30 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:30 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:30 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:30 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:30 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:30 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 45) Oct 26 18:46:30 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:30 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:30 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:30 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:30 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:30 volumio-1 volumio[24221]: } Oct 26 18:46:30 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:30 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:30 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:30 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:30 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:30 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:30 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:30 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:30 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:30 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:30 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:30 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:30 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:30 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 47) Oct 26 18:46:30 volumio-1 systemd[1]: Started go-librespot Daemon. Oct 26 18:46:30 volumio-1 go-librespot[24783]: go-librespot daemon starting... Oct 26 18:46:30 volumio-1 go-librespot[24783]: time="2025-10-26T18:46:30-07:00" level=info msg="running go-librespot 0.4.0" Oct 26 18:46:30 volumio-1 go-librespot[24783]: time="2025-10-26T18:46:30-07:00" level=debug msg="app state loaded" Oct 26 18:46:30 volumio-1 go-librespot[24783]: time="2025-10-26T18:46:30-07:00" level=debug msg="stored credentials not found" Oct 26 18:46:30 volumio-1 go-librespot[24783]: time="2025-10-26T18:46:30-07:00" level=info msg="api server listening on 127.0.0.1:9879" Oct 26 18:46:30 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:30 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 19. Oct 26 18:46:30 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:30 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:30 volumio-1 autossh[24792]: port set to 0, monitoring disabled Oct 26 18:46:30 volumio-1 autossh[24792]: starting ssh (count 1) Oct 26 18:46:30 volumio-1 autossh[24792]: ssh child pid is 24795 Oct 26 18:46:32 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:46:32 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 26 18:46:32 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Oct 26 18:46:32 volumio-1 sudo[24799]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Oct 26 18:46:32 volumio-1 sudo[24799]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:32 volumio-1 sudo[24799]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:32 volumio-1 sudo[24806]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:46:32 volumio-1 sudo[24806]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:32 volumio-1 sudo[24806]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:32 volumio-1 sudo[24813]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:46:32 volumio-1 sudo[24813]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:32 volumio-1 sudo[24813]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:32 volumio-1 sudo[24819]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:46:32 volumio-1 sudo[24819]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:32 volumio-1 sudo[24819]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:32 volumio-1 sudo[24825]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 26 18:46:32 volumio-1 sudo[24825]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:32 volumio-1 sudo[24825]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:32 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Oct 26 18:46:32 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Oct 26 18:46:32 volumio-1 sudo[24828]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 26 18:46:32 volumio-1 sudo[24828]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:32 volumio-1 sudo[24828]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:32 volumio-1 sudo[24831]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Oct 26 18:46:32 volumio-1 sudo[24831]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:32 volumio-1 volumio[24221]: info: Cannot call home: Error: Command failed: /usr/bin/curl -X POST --data-binary "device=pi&variante=volumio&version=3.832&uuid=9b588b0cfe1fe2dff2e919361be92e18" http://updates.volumio.org/downloader-v1/track-device Oct 26 18:46:32 volumio-1 volumio[24221]: % Total % Received % Xferd Average Speed Time Time Time Current Oct 26 18:46:32 volumio-1 volumio[24221]: Dload Upload Total Spent Left Speed Oct 26 18:46:32 volumio-1 volumio[24221]: [2.2K blob data] Oct 26 18:46:32 volumio-1 volumio[24221]: retrying in 5 seconds, trial 1 Oct 26 18:46:32 volumio-1 volumio[24221]: info: Volumio Calling Home Oct 26 18:46:33 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:33 volumio-1 go-librespot[24783]: time="2025-10-26T18:46:33-07:00" level=debug msg="new websocket client" Oct 26 18:46:33 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket established Oct 26 18:46:33 volumio-1 volumiossh-tunnel[24791]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:33 volumio-1 go-librespot[24783]: time="2025-10-26T18:46:33-07:00" level=fatal msg="failed running zeroconf" error="failed getting endpoints from resolver: failed fetching apresolve URL: Get \"https://apresolve.spotify.com/?type=accesspoint&type=dealer&type=spclient\": dial tcp 192.168.211.1:443: connect: no route to host" Oct 26 18:46:33 volumio-1 autossh[24792]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:33 volumio-1 systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:33 volumio-1 systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'. Oct 26 18:46:33 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:33 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:33 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:33 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:33 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:33 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:33 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:33 volumio-1 volumio[24221]: } Oct 26 18:46:33 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:33 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:33 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:33 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:33 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:33 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:33 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:33 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:33 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:33 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:33 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:33 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:33 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:33 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 49) Oct 26 18:46:33 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:33 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:33 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:33 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:33 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:33 volumio-1 volumio[24221]: } Oct 26 18:46:33 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:33 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:33 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:33 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:33 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:33 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:33 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:33 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:33 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:33 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:33 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:33 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:33 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:33 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 51) Oct 26 18:46:33 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:33 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:33 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:33 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:33 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:33 volumio-1 volumio[24221]: } Oct 26 18:46:33 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:33 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:33 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:33 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:33 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:33 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:33 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:33 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:33 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:33 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:33 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:33 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:33 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:33 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 53) Oct 26 18:46:33 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:33 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:33 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:33 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:33 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:33 volumio-1 volumio[24221]: } Oct 26 18:46:33 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:33 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:33 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:33 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:33 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:33 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:33 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:33 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:33 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:33 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:33 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:33 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:33 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:33 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 55) Oct 26 18:46:33 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket closed Oct 26 18:46:34 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:34 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 20. Oct 26 18:46:34 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:34 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:34 volumio-1 autossh[24837]: port set to 0, monitoring disabled Oct 26 18:46:34 volumio-1 autossh[24837]: starting ssh (count 1) Oct 26 18:46:34 volumio-1 autossh[24837]: ssh child pid is 24840 Oct 26 18:46:34 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:46:36 volumio-1 volumio[24221]: info: Getting Spotify volume Oct 26 18:46:36 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:36 volumio-1 volumio[24221]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) Oct 26 18:46:36 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 56) Oct 26 18:46:36 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 10 Oct 26 18:46:36 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:36 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:36 volumio-1 sudo[24831]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:36 volumio-1 systemd[1]: go-librespot-daemon.service: Service RestartSec=3s expired, scheduling restart. Oct 26 18:46:36 volumio-1 systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 5. Oct 26 18:46:36 volumio-1 systemd[1]: Stopped go-librespot Daemon. Oct 26 18:46:36 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:36 volumio-1 volumio[24221]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:36 volumio-1 systemd[1]: Started go-librespot Daemon. Oct 26 18:46:36 volumio-1 go-librespot[24841]: go-librespot daemon starting... Oct 26 18:46:36 volumio-1 go-librespot[24841]: time="2025-10-26T18:46:36-07:00" level=info msg="running go-librespot 0.4.0" Oct 26 18:46:36 volumio-1 go-librespot[24841]: time="2025-10-26T18:46:36-07:00" level=debug msg="app state loaded" Oct 26 18:46:36 volumio-1 go-librespot[24841]: time="2025-10-26T18:46:36-07:00" level=debug msg="stored credentials not found" Oct 26 18:46:36 volumio-1 go-librespot[24841]: time="2025-10-26T18:46:36-07:00" level=info msg="api server listening on 127.0.0.1:9879" Oct 26 18:46:36 volumio-1 volumiossh-tunnel[24836]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:36 volumio-1 go-librespot[24841]: time="2025-10-26T18:46:36-07:00" level=fatal msg="failed running zeroconf" error="failed getting endpoints from resolver: failed fetching apresolve URL: Get \"https://apresolve.spotify.com/?type=accesspoint&type=dealer&type=spclient\": dial tcp 192.168.211.1:443: connect: no route to host" Oct 26 18:46:36 volumio-1 autossh[24837]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:36 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:36 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:36 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:36 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:36 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:36 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:36 volumio-1 volumio[24221]: } Oct 26 18:46:36 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:36 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:36 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:36 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:36 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:36 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:36 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:36 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:36 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:36 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:36 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:36 volumio-1 systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:36 volumio-1 systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'. Oct 26 18:46:36 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:36 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:36 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:36 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 58) Oct 26 18:46:36 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:36 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:36 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:36 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:36 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:36 volumio-1 volumio[24221]: } Oct 26 18:46:36 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:36 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:36 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:36 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:36 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:36 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:36 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:36 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:36 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:36 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:36 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:36 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:36 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:36 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 60) Oct 26 18:46:37 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:37 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:37 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:37 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:37 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:37 volumio-1 volumio[24221]: } Oct 26 18:46:37 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:37 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:37 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:37 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:37 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:37 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:37 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:37 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:37 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:37 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:37 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:37 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:37 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:37 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 62) Oct 26 18:46:37 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:37 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:37 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:37 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:37 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:37 volumio-1 volumio[24221]: } Oct 26 18:46:37 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:37 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:37 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:37 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:37 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:37 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:37 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:37 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:37 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:37 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:37 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:37 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:37 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:37 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 64) Oct 26 18:46:37 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:37 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 21. Oct 26 18:46:37 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:37 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:37 volumio-1 autossh[24850]: port set to 0, monitoring disabled Oct 26 18:46:37 volumio-1 autossh[24850]: starting ssh (count 1) Oct 26 18:46:37 volumio-1 autossh[24850]: ssh child pid is 24853 Oct 26 18:46:39 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:39 volumio-1 volumio[24221]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:40 volumio-1 volumiossh-tunnel[24849]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:40 volumio-1 autossh[24850]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:40 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:40 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:40 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:40 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:40 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:40 volumio-1 volumio[24221]: } Oct 26 18:46:40 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:40 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:40 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:40 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:40 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:40 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:40 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:40 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:40 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:40 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:40 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:40 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:40 volumio-1 systemd[1]: go-librespot-daemon.service: Service RestartSec=3s expired, scheduling restart. Oct 26 18:46:40 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:40 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:40 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:40 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 66) Oct 26 18:46:40 volumio-1 systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 6. Oct 26 18:46:40 volumio-1 systemd[1]: Stopped go-librespot Daemon. Oct 26 18:46:40 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:40 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:40 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:40 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:40 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:40 volumio-1 volumio[24221]: } Oct 26 18:46:40 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:40 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:40 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:40 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:40 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:40 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:40 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:40 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:40 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:40 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:40 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:40 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:40 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:40 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 68) Oct 26 18:46:40 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:40 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:40 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:40 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:40 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:40 volumio-1 volumio[24221]: } Oct 26 18:46:40 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:40 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:40 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:40 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:40 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:40 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:40 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:40 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:40 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:40 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:40 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:40 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:40 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:40 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 70) Oct 26 18:46:40 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:40 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:40 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:40 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:40 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:40 volumio-1 volumio[24221]: } Oct 26 18:46:40 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:40 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:40 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:40 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:40 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:40 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:40 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:40 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:40 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:40 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:40 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:40 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:40 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:40 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 72) Oct 26 18:46:40 volumio-1 systemd[1]: Started go-librespot Daemon. Oct 26 18:46:40 volumio-1 go-librespot[24868]: go-librespot daemon starting... Oct 26 18:46:40 volumio-1 go-librespot[24868]: time="2025-10-26T18:46:40-07:00" level=info msg="running go-librespot 0.4.0" Oct 26 18:46:40 volumio-1 go-librespot[24868]: time="2025-10-26T18:46:40-07:00" level=debug msg="app state loaded" Oct 26 18:46:40 volumio-1 go-librespot[24868]: time="2025-10-26T18:46:40-07:00" level=debug msg="stored credentials not found" Oct 26 18:46:40 volumio-1 go-librespot[24868]: time="2025-10-26T18:46:40-07:00" level=info msg="api server listening on 127.0.0.1:9879" Oct 26 18:46:40 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:40 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 22. Oct 26 18:46:40 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:40 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:40 volumio-1 autossh[24876]: port set to 0, monitoring disabled Oct 26 18:46:40 volumio-1 autossh[24876]: starting ssh (count 1) Oct 26 18:46:40 volumio-1 autossh[24876]: ssh child pid is 24879 Oct 26 18:46:42 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:42 volumio-1 go-librespot[24868]: time="2025-10-26T18:46:42-07:00" level=debug msg="new websocket client" Oct 26 18:46:42 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket established Oct 26 18:46:43 volumio-1 volumiossh-tunnel[24875]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:43 volumio-1 autossh[24876]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:43 volumio-1 go-librespot[24868]: time="2025-10-26T18:46:43-07:00" level=fatal msg="failed running zeroconf" error="failed getting endpoints from resolver: failed fetching apresolve URL: Get \"https://apresolve.spotify.com/?type=accesspoint&type=dealer&type=spclient\": dial tcp 192.168.211.1:443: connect: no route to host" Oct 26 18:46:43 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:43 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:43 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:43 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:43 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:43 volumio-1 volumio[24221]: } Oct 26 18:46:43 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:43 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:43 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:43 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:43 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:43 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:43 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:43 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:43 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:43 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:43 volumio-1 systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:43 volumio-1 systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'. Oct 26 18:46:43 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:43 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:43 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:43 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 74) Oct 26 18:46:43 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:43 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:43 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:43 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:43 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:43 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:43 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:43 volumio-1 volumio[24221]: } Oct 26 18:46:43 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:43 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:43 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:43 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:43 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:43 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:43 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:43 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:43 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:43 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:43 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:43 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:43 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:43 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 76) Oct 26 18:46:43 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:43 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:43 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:43 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:43 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:43 volumio-1 volumio[24221]: } Oct 26 18:46:43 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:43 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:43 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:43 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:43 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:43 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:43 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:43 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:43 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:43 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:43 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:43 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:43 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:43 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 78) Oct 26 18:46:43 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:43 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:43 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:43 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:43 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:43 volumio-1 volumio[24221]: } Oct 26 18:46:43 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:43 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:43 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:43 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:43 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:43 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:43 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:43 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:43 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:43 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:43 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:43 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:43 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:43 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 80) Oct 26 18:46:43 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket closed Oct 26 18:46:43 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:43 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 23. Oct 26 18:46:43 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:43 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:43 volumio-1 autossh[24881]: port set to 0, monitoring disabled Oct 26 18:46:43 volumio-1 autossh[24881]: starting ssh (count 1) Oct 26 18:46:43 volumio-1 autossh[24881]: ssh child pid is 24884 Oct 26 18:46:43 volumio-1 volumio[24221]: info: Cannot call home: Error: Command failed: /usr/bin/curl -X POST --data-binary "device=pi&variante=volumio&version=3.832&uuid=9b588b0cfe1fe2dff2e919361be92e18" http://updates.volumio.org/downloader-v1/track-device Oct 26 18:46:43 volumio-1 volumio[24221]: % Total % Received % Xferd Average Speed Time Time Time Current Oct 26 18:46:43 volumio-1 volumio[24221]: Dload Upload Total Spent Left Speed Oct 26 18:46:43 volumio-1 volumio[24221]: [237B blob data] Oct 26 18:46:43 volumio-1 volumio[24221]: curl: (7) Failed to connect to updates.volumio.org port 80: No route to host Oct 26 18:46:43 volumio-1 volumio[24221]: retrying in 5 seconds, trial 2 Oct 26 18:46:43 volumio-1 volumio[24221]: info: Volumio Calling Home Oct 26 18:46:44 volumio-1 volumio[24221]: info: CALLMETHOD: system_controller network saveWiredNet [object Object] Oct 26 18:46:44 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , saveWiredNet Oct 26 18:46:44 volumio-1 sudo[24889]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/network/interfaces Oct 26 18:46:44 volumio-1 sudo[24889]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:44 volumio-1 sudo[24889]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:44 volumio-1 sudo[24891]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/dhcpcd.conf Oct 26 18:46:44 volumio-1 sudo[24891]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:44 volumio-1 sudo[24891]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:44 volumio-1 volumio[24221]: info: Permissions for /etc/network/interfaces set Oct 26 18:46:44 volumio-1 volumio[24221]: info: Restarting Wired Network Oct 26 18:46:44 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , onNetworkingRestart Oct 26 18:46:44 volumio-1 volumio[24221]: info: Discovery: Restarting Advertising due to device name change Oct 26 18:46:44 volumio-1 sudo[24894]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/ip addr flush dev eth0 Oct 26 18:46:44 volumio-1 sudo[24894]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:44 volumio-1 dhcpcd[1079]: eth0: pid 24895 deleted IP address 192.168.50.24/24 Oct 26 18:46:44 volumio-1 dhcpcd[1079]: eth0: deleting route to 192.168.50.0/24 Oct 26 18:46:44 volumio-1 dhcpcd[22148]: eth0: pid 24895 deleted IP address 192.168.50.24/24 Oct 26 18:46:44 volumio-1 dhcpcd[22148]: eth0: deleting route to 192.168.50.0/24 Oct 26 18:46:44 volumio-1 avahi-daemon[596]: Withdrawing address record for 192.168.50.24 on eth0. Oct 26 18:46:44 volumio-1 avahi-daemon[596]: Leaving mDNS multicast group on interface eth0.IPv4 with address 192.168.50.24. Oct 26 18:46:44 volumio-1 avahi-daemon[596]: Interface eth0.IPv4 no longer relevant for mDNS. Oct 26 18:46:44 volumio-1 sudo[24894]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:44 volumio-1 volumio[24221]: info: Discovery: A device disappeared from network Oct 26 18:46:44 volumio-1 volumio[24221]: info: Discovery: A device disappeared from network Oct 26 18:46:44 volumio-1 volumio[24221]: info: Discovery: Device officejukebox disappeared from network Oct 26 18:46:44 volumio-1 sudo[24900]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 down Oct 26 18:46:44 volumio-1 sudo[24900]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:44 volumio-1 volumio[24221]: info: Discovery: A device disappeared from network Oct 26 18:46:44 volumio-1 volumio[24221]: info: Discovery: Device headphonesystem disappeared from network Oct 26 18:46:44 volumio-1 volumio[24221]: info: Discovery: Disconnected from remote: 192.168.50.40 Oct 26 18:46:44 volumio-1 dnsmasq[872]: reading /etc/resolv.conf Oct 26 18:46:44 volumio-1 kernel: bcmgenet fd580000.ethernet eth0: Link is Down Oct 26 18:46:44 volumio-1 dhcpcd[22148]: eth0: probing address 192.168.50.24/24 Oct 26 18:46:44 volumio-1 vtcs[20273]: [2025-10-26 18:46:44.856] [tisoc] [error] [avahiImpl.cpp:113] avahiClientCallback() AVAHI_CLIENT_S_COLLISION/AVAHI_CLIENT_FAILURE Oct 26 18:46:44 volumio-1 avahi-daemon[596]: Host name conflict, retrying with volumio-3 Oct 26 18:46:44 volumio-1 avahi-daemon[596]: Registering new address record for 192.168.50.25 on wlan0.IPv4. Oct 26 18:46:44 volumio-1 dhcpcd[1079]: eth0: probing address 192.168.50.24/24 Oct 26 18:46:44 volumio-1 dhcpcd[22148]: eth0: carrier lost Oct 26 18:46:44 volumio-1 dhcpcd[1079]: eth0: carrier lost Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 192.168.1.1#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 208.67.220.220#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: no servers found in /etc/resolv.conf, will retry Oct 26 18:46:44 volumio-1 sudo[24900]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:44 volumio-1 sudo[24941]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 up Oct 26 18:46:44 volumio-1 sudo[24941]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:44 volumio-1 sudo[24941]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:44 volumio-1 kernel: bcmgenet fd580000.ethernet: configuring instance for external RGMII (RX delay) Oct 26 18:46:44 volumio-1 kernel: bcmgenet fd580000.ethernet eth0: Link is Down Oct 26 18:46:44 volumio-1 dnsmasq[872]: reading /etc/resolv.conf Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 208.67.220.220#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 192.168.1.1#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:44 volumio-1 dnsmasq[872]: using nameserver 208.67.220.220#53 Oct 26 18:46:45 volumio-1 dnsmasq[872]: reading /etc/resolv.conf Oct 26 18:46:45 volumio-1 dnsmasq[872]: using nameserver 192.168.1.1#53 Oct 26 18:46:45 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:45 volumio-1 dnsmasq[872]: using nameserver 192.168.1.1#53 Oct 26 18:46:45 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:45 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:45 volumio-1 dnsmasq[872]: using nameserver 208.67.220.220#53 Oct 26 18:46:45 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:45 volumio-1 dnsmasq[872]: using nameserver 208.67.220.220#53 Oct 26 18:46:45 volumio-1 ifplugd(eth0)[768]: Link beat lost. Oct 26 18:46:45 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:46:45 volumio-1 avahi-daemon[596]: Server startup complete. Host name is volumio-3.local. Local service cookie is 3438533796. Oct 26 18:46:45 volumio-1 volumio[24221]: info: Discovery: A device disappeared from network Oct 26 18:46:45 volumio-1 volumio[24221]: info: Getting Spotify volume Oct 26 18:46:45 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:45 volumio-1 volumio[24221]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) Oct 26 18:46:45 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 81) Oct 26 18:46:45 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8 Oct 26 18:46:45 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:45 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:46 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:46 volumio-1 volumio[24221]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879 Oct 26 18:46:46 volumio-1 volumiossh-tunnel[24880]: ssh: connect to host us2.myvolumio.org port 2222: No route to host Oct 26 18:46:46 volumio-1 autossh[24881]: ssh exited prematurely with status 255; autossh exiting Oct 26 18:46:46 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:46 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:46 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:46 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:46 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:46 volumio-1 volumio[24221]: } Oct 26 18:46:46 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:46 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:46 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:46 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:46 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:46 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:46 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:46 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:46 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:46 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:46:46 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:46 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=exited, status=1/FAILURE Oct 26 18:46:46 volumio-1 systemd[1]: sshtunnel.service: Failed with result 'exit-code'. Oct 26 18:46:46 volumio-1 systemd[1]: go-librespot-daemon.service: Service RestartSec=3s expired, scheduling restart. Oct 26 18:46:46 volumio-1 systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 7. Oct 26 18:46:46 volumio-1 systemd[1]: Stopped go-librespot Daemon. Oct 26 18:46:46 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:46 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:46 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:46:46 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:46 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 83) Oct 26 18:46:46 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:46 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:46 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:46 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:46 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:46 volumio-1 volumio[24221]: } Oct 26 18:46:46 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:46 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:46 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:46 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:46 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:46 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:46 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:46 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:46 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:46 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:46:46 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:46 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:46 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:46 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:46:46 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:46 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 85) Oct 26 18:46:46 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube) Error occurred in SendMessageTask: Oct 26 18:46:46 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:46 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:46 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:46 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:46 volumio-1 volumio[24221]: } Oct 26 18:46:46 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:46 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:46 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:46 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:46 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:46 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:46 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:46 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:46 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:46 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:46:46 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:46 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:46 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:46 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:46:46 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:46 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 87) Oct 26 18:46:46 volumio-1 volumio[24221]: error: [yt-cast-receiver] (YouTube Music) Error occurred in SendMessageTask: Oct 26 18:46:46 volumio-1 volumio[24221]: LoungeScreenDisconnected { Oct 26 18:46:46 volumio-1 volumio[24221]: AID: null, Oct 26 18:46:46 volumio-1 volumio[24221]: name: 'loungeScreenDisconnected', Oct 26 18:46:46 volumio-1 volumio[24221]: payload: {} Oct 26 18:46:46 volumio-1 volumio[24221]: } Oct 26 18:46:46 volumio-1 volumio[24221]: (IncompleteAPIDataError) Missing data required to construct query string from bind params Oct 26 18:46:46 volumio-1 volumio[24221]: Error info: { missing: [ 'loungeIdToken', 'SID', 'gsessionid' ] } Oct 26 18:46:46 volumio-1 volumio[24221]: Stack trace: Oct 26 18:46:46 volumio-1 volumio[24221]: IncompleteAPIDataError: Missing data required to construct query string from bind params Oct 26 18:46:46 volumio-1 volumio[24221]: at BindParams.toQueryString (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/BindParams.js:120:19) Oct 26 18:46:46 volumio-1 volumio[24221]: at Session._Session_doSendMessage (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:492:103) Oct 26 18:46:46 volumio-1 volumio[24221]: at SendMessageTask.run (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:552:71) Oct 26 18:46:46 volumio-1 volumio[24221]: at AsyncTaskQueue.start (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/utils/AsyncTaskQueue.js:51:36) Oct 26 18:46:46 volumio-1 volumio[24221]: at Session.end (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:237:71) Oct 26 18:46:46 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:46:46 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:46 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:46:46 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:46:46 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:46:46 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:46:46 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 89) Oct 26 18:46:46 volumio-1 systemd[1]: Started go-librespot Daemon. Oct 26 18:46:46 volumio-1 go-librespot[25016]: go-librespot daemon starting... Oct 26 18:46:46 volumio-1 go-librespot[25016]: time="2025-10-26T18:46:46-07:00" level=info msg="running go-librespot 0.4.0" Oct 26 18:46:46 volumio-1 ntpd[770]: Deleting interface #26 eth0, 192.168.50.24#123, interface stats: received=0, sent=0, dropped=0, active_time=47 secs Oct 26 18:46:46 volumio-1 go-librespot[25016]: time="2025-10-26T18:46:46-07:00" level=debug msg="app state loaded" Oct 26 18:46:46 volumio-1 go-librespot[25016]: time="2025-10-26T18:46:46-07:00" level=debug msg="stored credentials not found" Oct 26 18:46:46 volumio-1 go-librespot[25016]: time="2025-10-26T18:46:46-07:00" level=info msg="api server listening on 127.0.0.1:9879" Oct 26 18:46:46 volumio-1 systemd[1]: sshtunnel.service: Service RestartSec=100ms expired, scheduling restart. Oct 26 18:46:46 volumio-1 systemd[1]: sshtunnel.service: Scheduled restart job, restart counter is at 24. Oct 26 18:46:46 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:46:46 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:46:46 volumio-1 autossh[25024]: port set to 0, monitoring disabled Oct 26 18:46:46 volumio-1 autossh[25024]: starting ssh (count 1) Oct 26 18:46:46 volumio-1 autossh[25024]: ssh child pid is 25027 Oct 26 18:46:46 volumio-1 avahi-daemon[596]: Service "Volumio-1" (/services/volumio.service) successfully established. Oct 26 18:46:49 volumio-1 dhcpcd[22148]: eth0: carrier acquired Oct 26 18:46:49 volumio-1 dhcpcd[1079]: eth0: carrier acquired Oct 26 18:46:49 volumio-1 dhcpcd[22148]: eth0: confile file changed, expiring leases Oct 26 18:46:49 volumio-1 dhcpcd[1079]: eth0: confile file changed, expiring leases Oct 26 18:46:49 volumio-1 dhcpcd[1079]: eth0: IAID 01:41:5f:1b Oct 26 18:46:49 volumio-1 dhcpcd[22148]: eth0: IAID 01:41:5f:1b Oct 26 18:46:49 volumio-1 kernel: bcmgenet fd580000.ethernet eth0: Link is Up - 1Gbps/Full - flow control rx/tx Oct 26 18:46:49 volumio-1 ifplugd(eth0)[768]: Link beat detected. Oct 26 18:46:49 volumio-1 volumio[24221]: info: Initializing connection to go-librespot Websocket Oct 26 18:46:49 volumio-1 dhcpcd[1079]: eth0: soliciting an IPv6 router Oct 26 18:46:49 volumio-1 volumio[24221]: info: Volumio Network Manager: Network status updated: 2 Oct 26 18:46:49 volumio-1 dhcpcd[22148]: eth0: rebinding lease of 192.168.50.24 Oct 26 18:46:49 volumio-1 dhcpcd[22148]: eth0: soliciting an IPv6 router Oct 26 18:46:49 volumio-1 dhcpcd[22148]: eth0: probing address 192.168.50.24/24 Oct 26 18:46:49 volumio-1 dnsmasq-dhcp[872]: no address range available for DHCP request via wlan0 Oct 26 18:46:49 volumio-1 dhcpcd[1079]: eth0: rebinding lease of 192.168.50.24 Oct 26 18:46:49 volumio-1 dhcpcd[1079]: eth0: probing address 192.168.50.24/24 Oct 26 18:46:49 volumio-1 volumio[24221]: info: Discovery: Started advertising with name: Volumio-1 Oct 26 18:46:49 volumio-1 dnsmasq-dhcp[872]: no address range available for DHCP request via wlan0 Oct 26 18:46:51 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:46:51 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:46:51 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:46:51 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:51 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:51 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:46:54 volumio-1 dhcpcd[1079]: eth0: leased 192.168.50.24 for 86400 seconds Oct 26 18:46:54 volumio-1 dhcpcd[1079]: eth0: adding route to 192.168.50.0/24 Oct 26 18:46:54 volumio-1 dhcpcd[1079]: eth0: adding default route via 192.168.50.1 Oct 26 18:46:54 volumio-1 avahi-daemon[596]: Joining mDNS multicast group on interface eth0.IPv4 with address 192.168.50.24. Oct 26 18:46:54 volumio-1 avahi-daemon[596]: New relevant interface eth0.IPv4 for mDNS. Oct 26 18:46:54 volumio-1 avahi-daemon[596]: Registering new address record for 192.168.50.24 on eth0.IPv4. Oct 26 18:46:54 volumio-1 dnsmasq[872]: reading /etc/resolv.conf Oct 26 18:46:54 volumio-1 dnsmasq[872]: using nameserver 192.168.50.1#53 Oct 26 18:46:54 volumio-1 dnsmasq[872]: using nameserver 192.168.1.1#53 Oct 26 18:46:54 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:54 volumio-1 dnsmasq[872]: using nameserver 208.67.222.222#53 Oct 26 18:46:54 volumio-1 dnsmasq[872]: using nameserver 208.67.220.220#53 Oct 26 18:46:54 volumio-1 dhcpcd[22148]: eth0: leased 192.168.50.24 for 86400 seconds Oct 26 18:46:54 volumio-1 dhcpcd[22148]: eth0: adding route to 192.168.50.0/24 Oct 26 18:46:54 volumio-1 dhcpcd[22148]: eth0: adding default route via 192.168.50.1 Oct 26 18:46:54 volumio-1 dhcpcd[22148]: wlan0: deleting host route to 192.168.1.1 Oct 26 18:46:54 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: upnp , onRestart Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , onNetworkingRestart Oct 26 18:46:55 volumio-1 volumio[24221]: info: Refreshing Cached IP Addresses Oct 26 18:46:55 volumio-1 sudo[25136]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/killall upmpdcli Oct 26 18:46:55 volumio-1 sudo[25136]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25136]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25139]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 26 18:46:55 volumio-1 sudo[25139]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25139]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25142]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 26 18:46:55 volumio-1 sudo[25142]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25142]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25145]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 26 18:46:55 volumio-1 sudo[25145]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25145]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25148]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 26 18:46:55 volumio-1 sudo[25148]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25148]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 volumio[24221]: verbose: New Socket.io Connection to 192.168.50.24 from 192.168.50.165 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64; rv:144.0) Gecko/20100101 Firefox/144.0 Engine version: 3 Transport: polling Total Clients: 7 Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetVisibleSources Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:55 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Oct 26 18:46:55 volumio-1 volumio[24221]: info: Received Get System Info Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:46:55 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:55 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:55 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:55 volumio-1 volumio[24221]: info: Listing playlists Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Oct 26 18:46:55 volumio-1 sudo[25153]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Oct 26 18:46:55 volumio-1 sudo[25153]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25153]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25160]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:46:55 volumio-1 sudo[25160]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25167]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:46:55 volumio-1 sudo[25167]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25160]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25167]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25172]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:46:55 volumio-1 sudo[25172]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25172]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25179]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 26 18:46:55 volumio-1 sudo[25179]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25179]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Oct 26 18:46:55 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Oct 26 18:46:55 volumio-1 sudo[25182]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 26 18:46:55 volumio-1 sudo[25182]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:55 volumio-1 sudo[25182]: pam_unix(sudo:session): session closed for user root Oct 26 18:46:55 volumio-1 sudo[25185]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Oct 26 18:46:55 volumio-1 sudo[25185]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:46:56 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:46:56 volumio-1 ntpd[770]: Listen normally on 27 eth0 192.168.50.24:123 Oct 26 18:46:56 volumio-1 ntpd[770]: 23.186.168.127 local addr 192.168.50.25 -> 192.168.50.24 Oct 26 18:46:56 volumio-1 ntpd[770]: 23.186.168.129 local addr 192.168.50.25 -> 192.168.50.24 Oct 26 18:46:56 volumio-1 ntpd[770]: 204.197.163.71 local addr 192.168.50.25 -> 192.168.50.24 Oct 26 18:46:56 volumio-1 ntpd[770]: 23.142.248.8 local addr 192.168.50.25 -> 192.168.50.24 Oct 26 18:46:56 volumio-1 ntpd[770]: 198.199.14.101 local addr 192.168.50.25 -> 192.168.50.24 Oct 26 18:46:56 volumio-1 ntpd[770]: 142.202.190.19 local addr 192.168.50.25 -> 192.168.50.24 Oct 26 18:46:56 volumio-1 ntpd[770]: new interface(s) found: waking up resolver Oct 26 18:46:56 volumio-1 ntpd[770]: Soliciting pool server 15.204.87.223 Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 26 18:46:57 volumio-1 volumio[24221]: info: Received Get System Info Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:46:57 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:57 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:46:57 volumio-1 ntpd[770]: 23.186.168.129 local addr 192.168.50.24 -> Oct 26 18:46:57 volumio-1 ntpd[770]: Soliciting pool server 23.111.186.186 Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 26 18:46:57 volumio-1 volumio[24221]: info: Received Get System Info Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:46:57 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:57 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:57 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:46:58 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , setMyVolumioToken Oct 26 18:46:58 volumio-1 ntpd[770]: 23.142.248.8 local addr 192.168.50.24 -> Oct 26 18:46:58 volumio-1 ntpd[770]: Soliciting pool server 45.84.199.136 Oct 26 18:46:58 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , setMyVolumioToken Oct 26 18:46:59 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:46:59 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:46:59 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:46:59 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:46:59 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:46:59 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:46:59 volumio-1 ntpd[770]: 23.186.168.127 local addr 192.168.50.24 -> Oct 26 18:46:59 volumio-1 volumio[24221]: info: Volumio Network Manager: Network status updated: 3 Oct 26 18:46:59 volumio-1 ntpd[770]: Soliciting pool server 216.229.0.50 Oct 26 18:47:00 volumio-1 sudo[25185]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:00 volumio-1 ntpd[770]: Soliciting pool server 66.59.198.178 Oct 26 18:47:01 volumio-1 ntpd[770]: Soliciting pool server 72.14.186.59 Oct 26 18:47:01 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:01 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:01 volumio-1 volumio[24221]: verbose: New Socket.io Connection to 192.168.50.25:3000 from 192.168.50.144 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 7 Oct 26 18:47:02 volumio-1 wpa_supplicant[22127]: RRM: Ignoring radio measurement request: Not RRM network Oct 26 18:47:04 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:47:04 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 26 18:47:04 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Oct 26 18:47:04 volumio-1 sudo[25204]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Oct 26 18:47:04 volumio-1 sudo[25204]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:04 volumio-1 sudo[25204]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:04 volumio-1 sudo[25211]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:47:04 volumio-1 sudo[25211]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:04 volumio-1 sudo[25211]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:04 volumio-1 sudo[25219]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:47:04 volumio-1 sudo[25219]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:04 volumio-1 sudo[25219]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:04 volumio-1 sudo[25224]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Oct 26 18:47:04 volumio-1 sudo[25224]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:04 volumio-1 sudo[25224]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:04 volumio-1 sudo[25230]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 26 18:47:04 volumio-1 sudo[25230]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:04 volumio-1 sudo[25230]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:04 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache Oct 26 18:47:04 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks Oct 26 18:47:04 volumio-1 sudo[25233]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 26 18:47:04 volumio-1 sudo[25233]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:04 volumio-1 sudo[25233]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:04 volumio-1 sudo[25236]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Oct 26 18:47:04 volumio-1 sudo[25236]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:05 volumio-1 sudo[25239]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 26 18:47:05 volumio-1 sudo[25239]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:05 volumio-1 sudo[25239]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:05 volumio-1 sudo[25242]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 26 18:47:05 volumio-1 sudo[25242]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:05 volumio-1 sudo[25242]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:05 volumio-1 sudo[25245]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Oct 26 18:47:05 volumio-1 sudo[25245]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:05 volumio-1 sudo[25245]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:05 volumio-1 volumio[24221]: info: Upmpdcli Daemon Started Oct 26 18:47:05 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Oct 26 18:47:05 volumio-1 go-librespot[25016]: time="2025-10-26T18:47:05-07:00" level=debug msg="new websocket client" Oct 26 18:47:05 volumio-1 volumio[24221]: info: Connection to go-librespot Websocket established Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: adding 5524abed-5568-4218-b787-858a6d4c8672 Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: Found device Volumio-1 Oct 26 18:47:05 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:05 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:05 volumio-1 go-librespot[25016]: time="2025-10-26T18:47:05-07:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew1.spotify.com:80]" Oct 26 18:47:05 volumio-1 go-librespot[25016]: time="2025-10-26T18:47:05-07:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443]" Oct 26 18:47:05 volumio-1 go-librespot[25016]: time="2025-10-26T18:47:05-07:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443]" Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: adding 7a488e13-c612-41af-897c-9242837d6519 Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: Found device HeadphoneSystem Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: Connecting to remote: 192.168.50.40 Oct 26 18:47:05 volumio-1 go-librespot[25016]: time="2025-10-26T18:47:05-07:00" level=info msg="zeroconf server listening on port 34625" Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: Connected to remote: 192.168.50.40 Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: adding 211f4118-4f19-42e5-b7fd-ed6b8874b1e6 Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: Found device OfficeJukeBox Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: Connecting to remote: 192.168.50.238 Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: Connected to remote: 192.168.50.238 Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: this is already registered, 5524abed-5568-4218-b787-858a6d4c8672 Oct 26 18:47:05 volumio-1 volumio[24221]: info: Discovery: Found device Volumio-1 Oct 26 18:47:05 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:05 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:06 volumio-1 volumiossh-tunnel[25023]: Warning: Permanently added '[us2.myvolumio.org]:2222,[137.184.235.84]:2222' (RSA) to the list of known hosts. Oct 26 18:47:06 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:47:06 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:47:06 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:47:06 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:47:06 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 90) Oct 26 18:47:06 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:47:06 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:47:06 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:47:06 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:47:06 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 91) Oct 26 18:47:06 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:47:06 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:47:06 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:47:06 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:47:06 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 92) Oct 26 18:47:06 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: TypeError: Cannot read property 'removeAllListeners' of undefined Oct 26 18:47:06 volumio-1 volumio[24221]: at Session._Session_refreshLoungeToken (/data/plugins/music_service/ytcr/node_modules/yt-cast-receiver/dist/cjs/lib/app/Session.js:372:16) Oct 26 18:47:06 volumio-1 volumio[24221]: at runMicrotasks () Oct 26 18:47:06 volumio-1 volumio[24221]: at processTicksAndRejections (internal/process/task_queues.js:93:5) Oct 26 18:47:06 volumio-1 volumio[24221]: (node:24221) UnhandledPromiseRejectionWarning: Unhandled promise rejection. This error originated either by throwing inside of an async function without a catch block, or by rejecting a promise which was not handled with .catch(). To terminate the node process on unhandled promise rejection, use the CLI flag `--unhandled-rejections=strict` (see https://nodejs.org/api/cli.html#cli_unhandled_rejections_mode). (rejection id: 93) Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan premium Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin qobuzconnect to plan superstar Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso Oct 26 18:47:06 volumio-1 volumio[24221]: info: Adding plugin bluetooth to MyMusic Plugins Oct 26 18:47:06 volumio-1 volumio[24221]: info: Adding plugin multiroom to MyMusic Plugins Oct 26 18:47:06 volumio-1 volumio[24221]: info: Adding plugin metavolumio to MyMusic Plugins Oct 26 18:47:06 volumio-1 volumio[24221]: info: Adding plugin cd_controller to MyMusic Plugins Oct 26 18:47:06 volumio-1 volumio[24221]: info: Adding plugin qobuzconnect to MyMusic Plugins Oct 26 18:47:06 volumio-1 volumio[24221]: info: Adding plugin smart_inputs to MyMusic Plugins Oct 26 18:47:06 volumio-1 volumio[24221]: info: Adding plugin tidalconnect to MyMusic Plugins Oct 26 18:47:06 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... Oct 26 18:47:07 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded Oct 26 18:47:07 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio Oct 26 18:47:07 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:07 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:07 volumio-1 volumio[24221]: info: Starting MyVolumio Remote Streaming Endpoints Oct 26 18:47:07 volumio-1 volumio[24221]: info: MyVolumio login type: Token Oct 26 18:47:07 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started Oct 26 18:47:07 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... Oct 26 18:47:07 volumio-1 volumio[24221]: info: Starting Streaming Service Transparent Proxy Oct 26 18:47:08 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Oct 26 18:47:08 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Oct 26 18:47:08 volumio-1 volumio[24221]: info: Streaming services startup Oct 26 18:47:08 volumio-1 volumio[24221]: info: Starting Streaming Daemon Oct 26 18:47:08 volumio-1 sudo[25260]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Oct 26 18:47:08 volumio-1 sudo[25260]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:08 volumio-1 sudo[25260]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:08 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started Oct 26 18:47:08 volumio-1 volumio[24221]: error: Cannot start Volumio Streaming Daemon Oct 26 18:47:08 volumio-1 volumio[24221]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Oct 26 18:47:08 volumio-1 volumio[24221]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Oct 26 18:47:08 volumio-1 volumio[24221]: info: Getting Spotify volume Oct 26 18:47:08 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8 Oct 26 18:47:08 volumio-1 sudo[25236]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:08 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:08 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:08 volumio-1 volumio[24221]: STREAMING PROXY: Starting server on port 3245 Oct 26 18:47:08 volumio-1 volumio[24221]: Node JS runtime: 14 Oct 26 18:47:08 volumio-1 volumio[24221]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN Oct 26 18:47:09 volumio-1 volumio[24221]: info: MyVolumio token set successfully Oct 26 18:47:09 volumio-1 volumio[24221]: info: MYVOLUMIO: Adding device Oct 26 18:47:09 volumio-1 volumio[24221]: info: MYVOLUMIO: Evaluating Server Oct 26 18:47:09 volumio-1 volumio[24221]: info: MyVolumio Plan changed: premium Oct 26 18:47:09 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Subscribed plan changed to premium Oct 26 18:47:09 volumio-1 volumio[24221]: info: Removing browser output: myVolumio user plan is not superstar Oct 26 18:47:09 volumio-1 volumio[24221]: info: Removing audio output: Oct 26 18:47:09 volumio-1 volumio[24221]: info: MYVOLUMIO: Adding device Oct 26 18:47:09 volumio-1 volumio[24221]: info: MYVOLUMIO: Evaluating Server Oct 26 18:47:09 volumio-1 volumio[24221]: info: Remote config written successfully Oct 26 18:47:09 volumio-1 volumio[24221]: info: Starting Tunnel 1 Oct 26 18:47:09 volumio-1 volumio[24221]: info: Starting Tunnel Connection Checker Oct 26 18:47:10 volumio-1 volumio[24221]: info: MYVolumio Device enabled Oct 26 18:47:10 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Device activated, enabling myvolumio plugins... Oct 26 18:47:10 volumio-1 volumio[24221]: info: MyVolumio status changed Oct 26 18:47:10 volumio-1 volumio[24221]: info: Streaming services startup Oct 26 18:47:10 volumio-1 volumio[24221]: info: Starting Streaming Daemon Oct 26 18:47:10 volumio-1 sudo[25314]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Oct 26 18:47:10 volumio-1 volumio[24221]: info: Setting Geolocation for MyVolumio to us2 Oct 26 18:47:10 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:10 volumio-1 sudo[25314]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:10 volumio-1 sudo[25314]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:10 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getHwuuid Oct 26 18:47:10 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "bluetooth"... Oct 26 18:47:10 volumio-1 volumio[24221]: info: [1761529630509] Starting BluetoothController Oct 26 18:47:10 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "multiroom"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Applying required configuration parameters for plugin multiroom Oct 26 18:47:11 volumio-1 sudo[25318]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -rf /tmp/multiroom Oct 26 18:47:11 volumio-1 sudo[25318]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 sudo[25318]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 volumio[24221]: /bin/mkdir: cannot create directory ‘/tmp/hls’: File exists Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: MultiRoom plugin initialized Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: STOPPING SNAPCLIENT Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: Snap server stop Oct 26 18:47:11 volumio-1 sudo[25334]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapclient Oct 26 18:47:11 volumio-1 sudo[25334]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: STOPPING volumioStreaming Oct 26 18:47:11 volumio-1 sudo[25334]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 sudo[25337]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapserver Oct 26 18:47:11 volumio-1 sudo[25337]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 sudo[25340]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioStreaming Oct 26 18:47:11 volumio-1 sudo[25337]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 sudo[25340]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "metavolumio"... Oct 26 18:47:11 volumio-1 sudo[25343]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/* Oct 26 18:47:11 volumio-1 sudo[25343]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 sudo[25343]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 sudo[25340]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "manifestui"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "cd_controller"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "smart_inputs"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "hi_res_audio"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Applying required configuration parameters for plugin hi_res_audio Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "tidal"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "qobuz"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "tidalconnect"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Loading plugin "qobuzconnect"... Oct 26 18:47:11 volumio-1 volumio[24221]: info: Preparing to generate the ALSA configuration file Oct 26 18:47:11 volumio-1 volumio[24221]: info: Updating MyVolumio device info Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Oct 26 18:47:11 volumio-1 volumio[24221]: info: Reading ALSA contributions from plugins. Oct 26 18:47:11 volumio-1 volumio[24221]: info: Setting Geolocation for MyVolumio to us2 Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: Removed streaming files Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: volumioStreaming STOPPED Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: SNAPSERVER STOPPED Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: SNAPCLIENT STOPPED Oct 26 18:47:11 volumio-1 volumio[24221]: error: Cannot start Volumio Streaming Daemon Oct 26 18:47:11 volumio-1 volumio[24221]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service Oct 26 18:47:11 volumio-1 volumio[24221]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found. Oct 26 18:47:11 volumio-1 volumio[24221]: info: Asound.conf file written Oct 26 18:47:11 volumio-1 sudo[25346]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Oct 26 18:47:11 volumio-1 sudo[25346]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 sudo[25346]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 volumio[24221]: info: Output device has changed, restarting MPD Oct 26 18:47:11 volumio-1 sudo[25351]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Oct 26 18:47:11 volumio-1 sudo[25351]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 sudo[25351]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 volumio[24221]: info: Output device has changed, restarting Shairport Sync Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:11 volumio-1 sudo[25354]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 26 18:47:11 volumio-1 sudo[25354]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 systemd[1]: Stopping Music Player Daemon... Oct 26 18:47:11 volumio-1 systemd[1]: mpd.service: Succeeded. Oct 26 18:47:11 volumio-1 systemd[1]: Stopped Music Player Daemon. Oct 26 18:47:11 volumio-1 volumio[24221]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin audio_interface.bluetooth Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Oct 26 18:47:11 volumio-1 systemd[1]: Starting Music Player Daemon... Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin audio_interface.multiroom Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , pushMultiRoomStatus Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output for this device Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding audio output: Oct 26 18:47:11 volumio-1 sudo[25363]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/hciconfig hci0 name Volumio-1 Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding audio output: Oct 26 18:47:11 volumio-1 sudo[25363]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 sudo[25363]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 volumio[24221]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin miscellanea.metavolumio Oct 26 18:47:11 volumio-1 sudo[25359]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 26 18:47:11 volumio-1 sudo[25359]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding METAVOLUMIO REST API Endpoints Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding metavolumio REST Endpoint for plugin: miscellanea/metavolumio Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding getSimilarArtists REST Endpoint for plugin: miscellanea/metavolumio Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding getSimilarAlbums REST Endpoint for plugin: miscellanea/metavolumio Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding getSimilarTracks REST Endpoint for plugin: miscellanea/metavolumio Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin miscellanea.manifestui Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin music_service.cd_controller Oct 26 18:47:11 volumio-1 volumio[24221]: info: Preparing CD Folders Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding CD REST API Endpoints Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding cdPostRip REST Endpoint for plugin: music_service/cd_controller Oct 26 18:47:11 volumio-1 volumio[24221]: info: Starting UDEV Watcher for CD Oct 26 18:47:11 volumio-1 volumio[24221]: info: Detecting CD presence with UDEV Oct 26 18:47:11 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: networkfs , getUdevDevices Oct 26 18:47:11 volumio-1 sudo[25359]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin music_service.smart_inputs Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding inputs REST Endpoints Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding scanAudioInputs REST Endpoint for plugin: music_service/smart_inputs Oct 26 18:47:11 volumio-1 volumio[24221]: info: Scanning Audio Inputs Oct 26 18:47:11 volumio-1 volumio[24221]: info: Checking against Known Cards name Oct 26 18:47:11 volumio-1 volumio[24221]: info: Adding Server instance for streaming Oct 26 18:47:11 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin music_service.hi_res_audio Oct 26 18:47:12 volumio-1 volumio[24221]: error: Hi Res Audio Failed Login: Missing Login Data Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding HIGHRESAUDIO REST API Endpoints Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding getStreamUrlhi_res_audio REST Endpoint for plugin: music_service/hi_res_audio Oct 26 18:47:12 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin music_service.tidal Oct 26 18:47:12 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin music_service.qobuz Oct 26 18:47:12 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin music_service.tidalconnect Oct 26 18:47:12 volumio-1 volumio[24221]: info: [MyVolumio PluginManager] Starting plugin music_service.qobuzconnect Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding qc_getconfig REST Endpoint for plugin: music_service/qobuzconnect Oct 26 18:47:12 volumio-1 sudo[25373]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 26 18:47:12 volumio-1 sudo[25373]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:12 volumio-1 systemd[1]: Stopping Volumio Tidal Connect Service... Oct 26 18:47:12 volumio-1 systemd[1]: vtcs.service: Main process exited, code=killed, status=15/TERM Oct 26 18:47:12 volumio-1 systemd[1]: vtcs.service: Succeeded. Oct 26 18:47:12 volumio-1 systemd[1]: Stopped Volumio Tidal Connect Service. Oct 26 18:47:12 volumio-1 volumio[24221]: info: QobuzConnect: Starting Qobuz Connect socket and service Oct 26 18:47:12 volumio-1 sudo[25373]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:12 volumio-1 sudo[25380]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service Oct 26 18:47:12 volumio-1 sudo[25380]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:12 volumio-1 volumio[24221]: info: QobuzConnect: Opened /tmp/qbz-connect.socket socket, listening for connections Oct 26 18:47:12 volumio-1 volumio[24221]: info: Stopping AccessToken refresher cron Oct 26 18:47:12 volumio-1 sudo[25380]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:12 volumio-1 sudo[25382]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service Oct 26 18:47:12 volumio-1 sudo[25382]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:12 volumio-1 volumio[24221]: info: AccessToken refresher cron started Oct 26 18:47:12 volumio-1 volumio[24221]: info: Stopping AccessToken refresher cron for QOBUZ Oct 26 18:47:12 volumio-1 volumio[24221]: info: AccessToken refresher cron started for QOBUZ Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding TIDAL REST API Endpoints Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding getStreamUrltidal REST Endpoint for plugin: music_service/tidal Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding QOBUZ REST API Endpoints Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding getStreamUrlqobuz REST Endpoint for plugin: music_service/qobuz Oct 26 18:47:12 volumio-1 systemd[1]: Stopping Volumio Qobuz Connect Service... Oct 26 18:47:12 volumio-1 qobuz-connect[20234]: 20251026 18:47:12.178 [20234.20234] INFO SampleApp: Stopping Local configuration server Oct 26 18:47:12 volumio-1 systemd[1]: qobuz-connect.service: Succeeded. Oct 26 18:47:12 volumio-1 systemd[1]: Stopped Volumio Qobuz Connect Service. Oct 26 18:47:12 volumio-1 volumio[24221]: info: MRS: Adding multiroomSync output Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding audio output: Oct 26 18:47:12 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:12 volumio-1 volumio[24221]: info: MRS: Adding multiroomSync output Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding audio output: Oct 26 18:47:12 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:12 volumio-1 volumio[24221]: info: Successfully Added MyVolumio device Oct 26 18:47:12 volumio-1 systemd[1]: Started Volumio Qobuz Connect Service. Oct 26 18:47:12 volumio-1 volumio[24221]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read property 'split' of undefined Oct 26 18:47:12 volumio-1 sudo[25382]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:12 volumio-1 volumio[24221]: info: Bluetooth name changed to Volumio-1 Oct 26 18:47:12 volumio-1 volumio[24221]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read property 'split' of undefined Oct 26 18:47:12 volumio-1 volumio[24221]: info: MPD Permissions set Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: Executing endpoint qc_getconfig Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: qobuzconnect , onGetConfig Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.364 [25384.25384] INFO SampleApp: Started connection to /tmp/qbz-connect.socket UNIX socket Oct 26 18:47:12 volumio-1 volumio[24221]: info: QobuzConnect: Qobuz Connect socket /tmp/qbz-connect.socket connected to client [object Object] Oct 26 18:47:12 volumio-1 volumio[24221]: info: QobuzConnect: QOBUZ Connect daemon connected Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.369 [25384.25384] INFO VolumeManager: [0x1c5c390]: Setting new playback volume: 75 Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.369 [25384.25384] INFO VolumeManager: [0x1c5c390]: Setting new mute state: 0 Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.369 [25384.25384] INFO QobuzConnect: [0x1c5cd60]: Client initialized! Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.369 [25384.25384] INFO SampleApp: Starting Avahi advertising, name: Volumio-1, service name: _qobuz-connect._tcp Oct 26 18:47:12 volumio-1 volumio[24221]: info: Starting Shairport Sync Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.381 [25384.25384] INFO LocalConfigManager: [0x1c5bc70]: Starting Local Configuration server Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.381 [25384.25384] INFO SampleApp: Starting Local configuration server Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.382 [25384.25384] INFO SampleApp: Connected to UNIX socket client 0x1c51f60 Oct 26 18:47:12 volumio-1 sudo[25394]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Oct 26 18:47:12 volumio-1 sudo[25394]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:12 volumio-1 systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Oct 26 18:47:12 volumio-1 systemd[1]: shairport-sync.service: Succeeded. Oct 26 18:47:12 volumio-1 systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Oct 26 18:47:12 volumio-1 systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Oct 26 18:47:12 volumio-1 sudo[25394]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:12 volumio-1 volumio[24221]: info: Shairport-Sync Started Oct 26 18:47:12 volumio-1 volumio[24221]: info: MRS: Found cast device: Chromecast-ba98c5b032ba47a896f5c0c3ed4f5828 Oct 26 18:47:12 volumio-1 volumio[24221]: info: Adding audio output: Oct 26 18:47:12 volumio-1 qobuz-connect[25384]: 20251026 18:47:12.518 [25384.25384] INFO SampleApp: Playback volume changed: 75 Oct 26 18:47:12 volumio-1 volumio[24221]: info: MRS: Found cast device: Chromecast-ba98c5b032ba47a896f5c0c3ed4f5828 Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:12 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:12 volumio-1 volumio[24221]: info: Successfully Added MyVolumio device Oct 26 18:47:12 volumio-1 volumio[24221]: info: Updating MyVolumio device info Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:12 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 26 18:47:12 volumio-1 mpd[25369]: Oct 26 18:47 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Oct 26 18:47:12 volumio-1 systemd[1]: Started Music Player Daemon. Oct 26 18:47:12 volumio-1 sudo[25354]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:12 volumio-1 volumio[24221]: error: updateQueue error: null Oct 26 18:47:12 volumio-1 volumio[24221]: info: Successfully Updated MyVolumio device Oct 26 18:47:13 volumio-1 volumio[24221]: info: Successfully Updated MyVolumio device Oct 26 18:47:13 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Oct 26 18:47:13 volumio-1 volumio[24221]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Oct 26 18:47:13 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Oct 26 18:47:13 volumio-1 volumio[24221]: info: Received Get System Version Oct 26 18:47:13 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Oct 26 18:47:13 volumio-1 volumio[24221]: info: Received Get System Info Oct 26 18:47:13 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:47:13 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:47:13 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:47:13 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:13 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:13 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:47:14 volumio-1 sudo[25403]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumiobt.service Oct 26 18:47:14 volumio-1 sudo[25403]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:14 volumio-1 sudo[25403]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:14 volumio-1 volumio[24221]: info: Volumio BT Module successfully started Oct 26 18:47:15 volumio-1 volumio[24221]: info: TidalConnect service stoped! Oct 26 18:47:15 volumio-1 sudo[25410]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart sshtunnel.service Oct 26 18:47:15 volumio-1 sudo[25410]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:15 volumio-1 systemd[1]: Stopping MyVolumio SSH Tunnel... Oct 26 18:47:15 volumio-1 systemd[1]: sshtunnel.service: Main process exited, code=killed, status=15/TERM Oct 26 18:47:15 volumio-1 autossh[25024]: received signal to exit (15) Oct 26 18:47:15 volumio-1 systemd[1]: sshtunnel.service: Succeeded. Oct 26 18:47:15 volumio-1 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 26 18:47:15 volumio-1 volumio[24221]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 26 18:47:15 volumio-1 volumio[24221]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 26 18:47:15 volumio-1 volumio[24221]: info: Adding tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Oct 26 18:47:15 volumio-1 volumio[24221]: info: Adding tc_connect REST Endpoint for plugin: music_service/tidalconnect Oct 26 18:47:15 volumio-1 sudo[25422]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Oct 26 18:47:15 volumio-1 sudo[25422]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:15 volumio-1 systemd[1]: Started MyVolumio SSH Tunnel. Oct 26 18:47:15 volumio-1 sudo[25410]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:15 volumio-1 volumio[24221]: info: Remote SSH Started Oct 26 18:47:15 volumio-1 autossh[25424]: port set to 0, monitoring disabled Oct 26 18:47:15 volumio-1 autossh[25424]: starting ssh (count 1) Oct 26 18:47:15 volumio-1 autossh[25424]: ssh child pid is 25427 Oct 26 18:47:15 volumio-1 systemd[1]: Started Volumio Tidal Connect Service. Oct 26 18:47:15 volumio-1 sudo[25422]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:15 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 8 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: Executing endpoint tc_getconfig Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onGetConfig Oct 26 18:47:15 volumio-1 vtcs[25428]: STARTING TidalConnect services, version: 1.5.1-beta1 Oct 26 18:47:15 volumio-1 vtcs[25428]: STARTED TidalConnect services. Oct 26 18:47:15 volumio-1 volumio[24221]: info: Executing endpoint tc_connect Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onConnect Oct 26 18:47:15 volumio-1 volumio[24221]: info: Connecting to TidalConnect Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::servicePushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::pushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioPushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output update for this device Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: verbose: STATE SERVICE {"status":"stop","service":"tidalconnect","title":"","artist":"","album":"","albumart":"/albumart","uri":"","icon":"fa fa-spinner","trackType":"tidal","codec":"","seek":0,"duration":0,"samplerate":"44.1 KHz","bitdepth":"16 bit","bitrate":"","channels":2,"random":false,"repeat":false,"repeatSingle":false} Oct 26 18:47:15 volumio-1 volumio[24221]: verbose: CURRENT POSITION 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::syncState stateService stop Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::syncState currentStatus stop Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::pushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioPushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output update for this device Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: No code Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::pushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioPushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output update for this device Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::servicePushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::pushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioPushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output update for this device Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: verbose: STATE SERVICE {"status":"stop","service":"tidalconnect","title":"","artist":"","album":"","albumart":"/albumart","uri":"","icon":"fa fa-spinner","trackType":"tidal","codec":"","seek":0,"duration":0,"samplerate":"44.1 KHz","bitdepth":"16 bit","bitrate":"","channels":2,"random":false,"repeat":false,"repeatSingle":false} Oct 26 18:47:15 volumio-1 volumio[24221]: verbose: CURRENT POSITION 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::syncState stateService stop Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::syncState currentStatus stop Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::pushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioPushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output update for this device Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: No code Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreStateMachine::pushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioPushState Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output update for this device Oct 26 18:47:15 volumio-1 volumio[24221]: info: MRS: Pushing multiroomSync output Oct 26 18:47:15 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:15 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:15 volumio-1 volumiossh-tunnel[25416]: Warning: Permanently added '[us2.myvolumio.org]:2222,[137.184.235.84]:2222' (RSA) to the list of known hosts. Oct 26 18:47:16 volumio-1 volumio[24221]: info: MRS: Getting audio outputs on start Oct 26 18:47:16 volumio-1 volumio[24221]: info: MRS: Requesting all other devices output Oct 26 18:47:18 volumio-1 volumio[24221]: info: TidalConnect service started! Oct 26 18:47:22 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Oct 26 18:47:22 volumio-1 volumio[24221]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9 Oct 26 18:47:22 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:22 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 26 18:47:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam Oct 26 18:47:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam Oct 26 18:47:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject Oct 26 18:47:27 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetBrowseSources Oct 26 18:47:27 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Oct 26 18:47:28 volumio-1 ntpd[770]: Soliciting pool server 139.177.202.26 Oct 26 18:47:28 volumio-1 sudo[25466]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 26 18:47:28 volumio-1 sudo[25466]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:28 volumio-1 sudo[25466]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:28 volumio-1 sudo[25469]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 26 18:47:28 volumio-1 sudo[25469]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:28 volumio-1 sudo[25469]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:28 volumio-1 volumio[24221]: verbose: New Socket.io Connection to 192.168.50.24 from 192.168.50.165 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64; rv:144.0) Gecko/20100101 Firefox/144.0 Engine version: 3 Transport: polling Total Clients: 9 Oct 26 18:47:28 volumio-1 volumio[24221]: verbose: New Socket.io Connection to 192.168.50.25 from 192.168.50.165 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64; rv:144.0) Gecko/20100101 Firefox/144.0 Engine version: 3 Transport: polling Total Clients: 10 Oct 26 18:47:28 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:47:28 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:47:28 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:47:28 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:28 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:28 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:47:29 volumio-1 sudo[25472]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 26 18:47:29 volumio-1 sudo[25472]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:29 volumio-1 sudo[25472]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:29 volumio-1 sudo[25475]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 26 18:47:29 volumio-1 sudo[25475]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 26 18:47:29 volumio-1 sudo[25475]: pam_unix(sudo:session): session closed for user root Oct 26 18:47:29 volumio-1 volumio[24221]: verbose: New Socket.io Connection to 192.168.50.24 from 192.168.50.165 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64; rv:144.0) Gecko/20100101 Firefox/144.0 Engine version: 3 Transport: polling Total Clients: 11 Oct 26 18:47:29 volumio-1 ntpd[770]: Soliciting pool server 66.244.16.123 Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetVisibleSources Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:29 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Oct 26 18:47:29 volumio-1 volumio[24221]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Oct 26 18:47:29 volumio-1 volumio[24221]: info: Received Get System Info Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:47:29 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:29 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:29 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:29 volumio-1 volumio[24221]: info: Listing playlists Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Oct 26 18:47:29 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Oct 26 18:47:30 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:30 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:30 volumio-1 ntpd[770]: Soliciting pool server 23.186.168.130 Oct 26 18:47:30 volumio-1 ntpd[770]: Soliciting pool server 137.110.222.27 Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 26 18:47:31 volumio-1 volumio[24221]: info: Received Get System Info Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:47:31 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:31 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:47:31 volumio-1 ntpd[770]: Soliciting pool server 172.233.177.198 Oct 26 18:47:31 volumio-1 ntpd[770]: Soliciting pool server 45.55.126.202 Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:47:31 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:31 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 26 18:47:31 volumio-1 volumio[24221]: info: Received Get System Info Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 26 18:47:31 volumio-1 volumio[24221]: info: Discovery: Getting this device information Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetState Oct 26 18:47:31 volumio-1 volumio[24221]: info: CorePlayQueue::getTrack 0 Oct 26 18:47:31 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 26 18:47:34 volumio-1 volumio[24221]: verbose: New Socket.io Connection to 192.168.50.25:3000 from 192.168.50.144 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 11 Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:47:35 volumio-1 volumio[24221]: info: Retrieving Cloud Streaming UI Oct 26 18:47:35 volumio-1 volumio[24221]: info: Getting Tidal Cloud Configuration Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:47:35 volumio-1 volumio[24221]: info: Getting Qobuz Cloud Configuration Oct 26 18:47:35 volumio-1 volumio[24221]: info: Asking plugin for UI Config Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:47:35 volumio-1 volumio[24221]: info: Getting Spotify Cloud Configuration Oct 26 18:47:35 volumio-1 volumio[24221]: info: Asking plugin for UI Config Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:47:35 volumio-1 volumio[24221]: info: Saving Spotify Acccount Oct 26 18:47:35 volumio-1 volumio[24221]: info: Got it Oct 26 18:47:35 volumio-1 volumio[24221]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Oct 26 18:47:35 volumio-1 volumio[24221]: info: Got Tidal Cloud Configuration Oct 26 18:47:35 volumio-1 volumio[24221]: info: Got it Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetBrowseSources Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetBrowseSources Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::volumioGetBrowseSources Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 26 18:47:35 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Oct 26 18:47:38 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: networkfs , discoverShares Oct 26 18:47:38 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , browseForService Oct 26 18:47:39 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Oct 26 18:47:39 volumio-1 volumio[24221]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 26 18:47:39 volumio-1 volumio[24221]: info: Executing SMB command: smbclient --no-pass --debuglevel=0 -L officejukebox.local. -m SMB3_11 Oct 26 18:47:39 volumio-1 volumio[24221]: info: Executing SMB command: smbclient --no-pass --debuglevel=0 -L Vanir-NAS.local. -m SMB3_11 Oct 26 18:47:39 volumio-1 volumio[24221]: info: Executing SMB command: smbclient --no-pass --debuglevel=0 -L headphonesystem.local. -m SMB3_11 Oct 26 18:47:40 volumio-1 volumio[24221]: info: Error browsing device Vanir-NAS for shares: Command failed: smbclient --no-pass --debuglevel=0 -L Vanir-NAS.local. -m SMB3_11 Oct 26 18:47:40 volumio-1 volumio[24221]: Unable to initialize messaging context Oct 26 18:47:43 volumio-1 volumio[24221]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 26 18:47:43 volumio-1 volumio[24221]: Error: dns service error: unknown Oct 26 18:47:43 volumio-1 volumio[24221]: at MDNSService.on_resolver_done (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:19:30) Oct 26 18:47:43 volumio-1 volumio[24221]: at SocketWatcher.MDNSService.self.watcher.callback (/volumio/node_modules/mdns/lib/mdns_service.js:18:40) { Oct 26 18:47:43 volumio-1 volumio[24221]: errorCode: -65537 Oct 26 18:47:43 volumio-1 volumio[24221]: } Oct 26 18:47:43 volumio-1 volumio[24221]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 26 18:47:43 volumio-1 sudo[25533]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-10-26 18:46 Oct 26 18:47:43 volumio-1 sudo[25533]: 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="29866754e5f1d7e4d0f581c10d9f22852f6f21db" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="fc4c820ddd3b5fc1a7a6b54ef112273ebd122010" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sat 26 Jul 2025 10:25:36 AM CEST" VOLUMIO_VERSION="3.832" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="cf6e14681b2ecbbdc9a62186b0f3114c"