May 31 19:38:04 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 31 19:38:04 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken
May 31 19:38:11 volumio volumio[1425]: info: CoreCommandRouter::getUIConfigOnPlugin
May 31 19:38:20 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:20 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:20 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:20 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:20 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:20 volumio systemd[1]: systemd-timedated.service: Deactivated successfully.
May 31 19:38:22 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:23 volumio sudo[2295]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 31 19:38:23 volumio sudo[2295]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:38:23 volumio sudo[2295]: pam_unix(sudo:session): session closed for user root
May 31 19:38:23 volumio sudo[2297]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 31 19:38:23 volumio sudo[2297]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:38:23 volumio sudo[2297]: pam_unix(sudo:session): session closed for user root
May 31 19:38:23 volumio volumio[1425]: verbose: New Socket.io Connection to 192.168.1.24 from 192.168.1.126 UA: Mozilla/5.0 (Linux; Android 15; SM-S926B Build/AP3A.240905.015.A2; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 9
May 31 19:38:23 volumio sudo[2301]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 31 19:38:23 volumio sudo[2301]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:38:23 volumio sudo[2301]: pam_unix(sudo:session): session closed for user root
May 31 19:38:23 volumio sudo[2303]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 31 19:38:23 volumio sudo[2303]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:38:23 volumio sudo[2303]: pam_unix(sudo:session): session closed for user root
May 31 19:38:23 volumio volumio[1425]: verbose: New Socket.io Connection to 192.168.1.24 from 192.168.1.126 UA: Mozilla/5.0 (Linux; Android 15; SM-S926B Build/AP3A.240905.015.A2; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 10
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::volumioGetVisibleSources
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
May 31 19:38:23 volumio volumio[1425]: info: Received Get System Info
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:23 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:23 volumio volumio[1425]: info: Listing playlists
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 31 19:38:23 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
May 31 19:38:25 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
May 31 19:38:25 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 31 19:38:25 volumio volumio[1425]: info: Received Get System Info
May 31 19:38:25 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:25 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:25 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:25 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:25 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:26 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 31 19:38:26 volumio volumio[1425]: info: Received Get System Info
May 31 19:38:26 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:26 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:26 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:26 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:26 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:30 volumio volumio[1425]: info: CoreCommandRouter::volumioGetQueue
May 31 19:38:30 volumio volumio[1425]: info: CoreStateMachine::getQueue
May 31 19:38:30 volumio volumio[1425]: info: CorePlayQueue::getQueue
May 31 19:38:32 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: ytmusic , handleBrowseUri
May 31 19:38:32 volumio volumio[1425]: info: [ytmusic-browse] browseUri: ytmusic
May 31 19:38:32 volumio volumio[1425]: info: Preload queue cleared
May 31 19:38:33 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:35 volumio sudo[2335]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 31 19:38:35 volumio sudo[2335]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:38:35 volumio sudo[2337]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 31 19:38:35 volumio sudo[2337]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:38:35 volumio sudo[2335]: pam_unix(sudo:session): session closed for user root
May 31 19:38:35 volumio sudo[2337]: pam_unix(sudo:session): session closed for user root
May 31 19:38:35 volumio volumio[1425]: verbose: New Socket.io Connection to 192.168.1.24 from 192.168.1.126 UA: Mozilla/5.0 (Linux; Android 15; SM-S926B Build/AP3A.240905.015.A2; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 11
May 31 19:38:35 volumio sudo[2341]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 31 19:38:35 volumio sudo[2341]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:38:35 volumio sudo[2341]: pam_unix(sudo:session): session closed for user root
May 31 19:38:35 volumio sudo[2343]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 31 19:38:35 volumio sudo[2343]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:38:35 volumio sudo[2343]: pam_unix(sudo:session): session closed for user root
May 31 19:38:35 volumio volumio[1425]: verbose: New Socket.io Connection to 192.168.1.24 from 192.168.1.126 UA: Mozilla/5.0 (Linux; Android 15; SM-S926B Build/AP3A.240905.015.A2; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 12
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::volumioGetVisibleSources
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::volumioGetQueue
May 31 19:38:35 volumio volumio[1425]: info: CoreStateMachine::getQueue
May 31 19:38:35 volumio volumio[1425]: info: CorePlayQueue::getQueue
May 31 19:38:35 volumio volumio[1425]: info: Listing playlists
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
May 31 19:38:35 volumio volumio[1425]: info: Received Get System Info
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:35 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
May 31 19:38:35 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 31 19:38:36 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
May 31 19:38:37 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
May 31 19:38:37 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 31 19:38:37 volumio volumio[1425]: info: Received Get System Info
May 31 19:38:37 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:37 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:37 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:37 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:37 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:38 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 31 19:38:38 volumio volumio[1425]: info: Received Get System Info
May 31 19:38:38 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:38 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:38 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:38 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:38 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:40 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: youtube2 , handleBrowseUri
May 31 19:38:40 volumio volumio[1425]: info: [youtube2-browse] browseUri: youtube2
May 31 19:38:40 volumio volumio[1425]: info: [youtube2] InnertubeLoader: creating Innertube instance...
May 31 19:38:43 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 31 19:38:43 volumio volumio[1425]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined
May 31 19:38:43 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates
May 31 19:38:43 volumio volumio[1425]: info: Received Get System Version
May 31 19:38:43 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
May 31 19:38:43 volumio volumio[1425]: info: Received Get System Info
May 31 19:38:43 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:43 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:43 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:43 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:43 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:43 volumio volumio[1425]: info: [youtube2] InnertubeLoader: obtaining po_token by visitorData...
May 31 19:38:43 volumio volumio[1425]: info: [youtube2] InnertubeLoader: obtained po_token (expires in 43200 seconds)
May 31 19:38:43 volumio volumio[1425]: info: [youtube2] InnertubeLoader: re-create Innertube instance with po_token
May 31 19:38:43 volumio volumio[1425]: info: [youtube2] InnertubeLoader: creating Innertube instance with po_token...
May 31 19:38:45 volumio volumio[1425]: info: [youtube2] InnertubeLoader: going to refresh po_token in 43100 seconds
May 31 19:38:45 volumio volumio[1425]: Searching plugin music_service/youtube2
May 31 19:38:45 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: youtube2 , search
May 31 19:38:45 volumio volumio[1425]: info: Preload queue cleared
May 31 19:38:45 volumio volumio[1425]: info: Preload queue cleared
May 31 19:38:45 volumio volumio[1425]: info: Preload queue cleared
May 31 19:38:45 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
May 31 19:38:46 volumio volumio[1425]: [YOUTUBEJS][Text]: Unable to find matching run for command run. Skipping... {
May 31 19:38:46 volumio volumio[1425]: command_run: { startIndex: 0, length: 32, onTap: { innertubeCommand: [Object] } },
May 31 19:38:46 volumio volumio[1425]: input_data: {
May 31 19:38:46 volumio volumio[1425]: content: 'Vasco Rossi - Siamo Soli · 3:59',
May 31 19:38:46 volumio volumio[1425]: commandRuns: [ [Object] ]
May 31 19:38:46 volumio volumio[1425]: },
May 31 19:38:46 volumio volumio[1425]: parsed_runs: [ { text: 'Vasco Rossi - Siamo Soli · 3:59', startIndex: 0 } ]
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: [YOUTUBEJS][Text]: Unable to find matching run for command run. Skipping... {
May 31 19:38:46 volumio volumio[1425]: command_run: { startIndex: 0, length: 62, onTap: { innertubeCommand: [Object] } },
May 31 19:38:46 volumio volumio[1425]: input_data: {
May 31 19:38:46 volumio volumio[1425]: content: 'Vasco Rossi - Manifesto futurista della nuova umanità · 3:57',
May 31 19:38:46 volumio volumio[1425]: commandRuns: [ [Object] ]
May 31 19:38:46 volumio volumio[1425]: },
May 31 19:38:46 volumio volumio[1425]: parsed_runs: [
May 31 19:38:46 volumio volumio[1425]: {
May 31 19:38:46 volumio volumio[1425]: text: 'Vasco Rossi - Manifesto futurista della nuova umanità · 3:57',
May 31 19:38:46 volumio volumio[1425]: startIndex: 0
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: ]
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: [YOUTUBEJS][Text]: Unable to find matching run for command run. Skipping... {
May 31 19:38:46 volumio volumio[1425]: command_run: { startIndex: 0, length: 39, onTap: { innertubeCommand: [Object] } },
May 31 19:38:46 volumio volumio[1425]: input_data: {
May 31 19:38:46 volumio volumio[1425]: content: 'Vasco Rossi - Come Nelle Favole · 4:23',
May 31 19:38:46 volumio volumio[1425]: commandRuns: [ [Object] ]
May 31 19:38:46 volumio volumio[1425]: },
May 31 19:38:46 volumio volumio[1425]: parsed_runs: [ { text: 'Vasco Rossi - Come Nelle Favole · 4:23', startIndex: 0 } ]
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: [YOUTUBEJS][Text]: Unable to find matching run for command run. Skipping... {
May 31 19:38:46 volumio volumio[1425]: command_run: { startIndex: 0, length: 53, onTap: { innertubeCommand: [Object] } },
May 31 19:38:46 volumio volumio[1425]: input_data: {
May 31 19:38:46 volumio volumio[1425]: content: "Vasco Rossi - Una Canzone D'Amore Buttata Via · 5:28",
May 31 19:38:46 volumio volumio[1425]: commandRuns: [ [Object] ]
May 31 19:38:46 volumio volumio[1425]: },
May 31 19:38:46 volumio volumio[1425]: parsed_runs: [
May 31 19:38:46 volumio volumio[1425]: {
May 31 19:38:46 volumio volumio[1425]: text: "Vasco Rossi - Una Canzone D'Amore Buttata Via · 5:28",
May 31 19:38:46 volumio volumio[1425]: startIndex: 0
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: ]
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: [YOUTUBEJS][Text]: Unable to find matching run for command run. Skipping... {
May 31 19:38:46 volumio volumio[1425]: command_run: { startIndex: 0, length: 31, onTap: { innertubeCommand: [Object] } },
May 31 19:38:46 volumio volumio[1425]: input_data: {
May 31 19:38:46 volumio volumio[1425]: content: 'Vasco Rossi - Eh...già · 3:59',
May 31 19:38:46 volumio volumio[1425]: commandRuns: [ [Object] ]
May 31 19:38:46 volumio volumio[1425]: },
May 31 19:38:46 volumio volumio[1425]: parsed_runs: [ { text: 'Vasco Rossi - Eh...già · 3:59', startIndex: 0 } ]
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: [YOUTUBEJS][Text]: Unable to find matching run for command run. Skipping... {
May 31 19:38:46 volumio volumio[1425]: command_run: { startIndex: 0, length: 34, onTap: { innertubeCommand: [Object] } },
May 31 19:38:46 volumio volumio[1425]: input_data: {
May 31 19:38:46 volumio volumio[1425]: content: 'Vasco Rossi - Senza Parole · 4:57',
May 31 19:38:46 volumio volumio[1425]: commandRuns: [ [Object] ]
May 31 19:38:46 volumio volumio[1425]: },
May 31 19:38:46 volumio volumio[1425]: parsed_runs: [ { text: 'Vasco Rossi - Senza Parole · 4:57', startIndex: 0 } ]
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: [YOUTUBEJS][Text]: Unable to find matching run for command run. Skipping... {
May 31 19:38:46 volumio volumio[1425]: command_run: { startIndex: 0, length: 39, onTap: { innertubeCommand: [Object] } },
May 31 19:38:46 volumio volumio[1425]: input_data: {
May 31 19:38:46 volumio volumio[1425]: content: 'Vasco Rossi - Domenica lunatica · 3:54',
May 31 19:38:46 volumio volumio[1425]: commandRuns: [ [Object] ]
May 31 19:38:46 volumio volumio[1425]: },
May 31 19:38:46 volumio volumio[1425]: parsed_runs: [ { text: 'Vasco Rossi - Domenica lunatica · 3:54', startIndex: 0 } ]
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: [YOUTUBEJS][Text]: Unable to find matching run for command run. Skipping... {
May 31 19:38:46 volumio volumio[1425]: command_run: { startIndex: 0, length: 36, onTap: { innertubeCommand: [Object] } },
May 31 19:38:46 volumio volumio[1425]: input_data: {
May 31 19:38:46 volumio volumio[1425]: content: 'Vasco Rossi - Ormai è tardi · 3:26',
May 31 19:38:46 volumio volumio[1425]: commandRuns: [ [Object] ]
May 31 19:38:46 volumio volumio[1425]: },
May 31 19:38:46 volumio volumio[1425]: parsed_runs: [ { text: 'Vasco Rossi - Ormai è tardi · 3:26', startIndex: 0 } ]
May 31 19:38:46 volumio volumio[1425]: }
May 31 19:38:46 volumio volumio[1425]: info: All search sources collected, pushing search results
May 31 19:38:50 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:50 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:50 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:50 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:50 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:38:52 volumio volumio[1425]: info: Preload queue cleared
May 31 19:38:52 volumio volumio[1425]: info: CoreCommandRouter::volumioReplaceandPlayItems
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::ClearQueue
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::stop
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::setConsumeUpdateService undefined
May 31 19:38:52 volumio volumio[1425]: info: CorePlayQueue::clearPlayQueue
May 31 19:38:52 volumio volumio[1425]: info: CorePlayQueue::saveQueue
May 31 19:38:52 volumio volumio[1425]: info: CoreCommandRouter::volumioPushQueue
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::addQueueItems
May 31 19:38:52 volumio volumio[1425]: info: CorePlayQueue::addQueueItems
May 31 19:38:52 volumio volumio[1425]: info: Preload queue cleared
May 31 19:38:52 volumio volumio[1425]: info: Adding Item to queue: youtube2/video@explodeTrackData:o=%7B%22title%22%3A%22Vasco%20Rossi%20-%20Un%20Senso%22%2C%22artist%22%3A%22Vasco%20Rossi%22%2C%22albumart%22%3A%22https%3A%2F%2Fi.ytimg.com%2Fvi%2FStRtFh01XUo%2Fhq720.jpg%3Fsqp%3D-oaymwEcCNAFEJQDSFXyq4qpAw4IARUAAIhCGAFwAcABBg%3D%3D%26rs%3DAOn4CLAhaw5W-RdSDGSUB1XkhE73v165eA%22%2C%22endpoint%22%3A%7B%22type%22%3A%22watch%22%2C%22payload%22%3A%7B%22videoId%22%3A%22StRtFh01XUo%22%2C%22params%22%3A%22qgMFVmFzY2-6AyQSIlBMZkJzcXNVdnNVaUpuSEZYU2VYODcyNzl3SC1SdTByRmK6AxwSGlJERU16cFYwWUgzS0lVQXlVdkhMVTFxRmRRugMUEhJQTEExRjY5MTQ1NTgzOUQxNEa6AyQSIlBMdFpzajEyRXdEeW9MUGxId3lHNFk4dHcwQkRSY0pYcke6AwsIgbel_aGiu7DPAboDCwjajfOm6aCf7-QBugMLCKmQs83fvuPPgwG6AwsI97nG-tXZnZO8AboDCgjs-ubDv-yLtCG6AwoIpZzmoPKVv9svugMKCOGx4eLmr5jLZroDCgiltaqVlI2r93u6AwsIhbub44yj2eOTAboDCgjSu43hmeWioSy6AwoIicb-i9qiucdQugMKCPPxkrq8lNSwKroDCwjf4cXRtMiGm5UBugMLCNu_0Nmzr4aoiQG6AwsIhoeY5M6dyb39AfIDBQ36KYY-ggQCEAE%253D%22%7D%7D%7D
May 31 19:38:52 volumio volumio[1425]: info: Exploding uri youtube2/video@explodeTrackData:o=%7B%22title%22%3A%22Vasco%20Rossi%20-%20Un%20Senso%22%2C%22artist%22%3A%22Vasco%20Rossi%22%2C%22albumart%22%3A%22https%3A%2F%2Fi.ytimg.com%2Fvi%2FStRtFh01XUo%2Fhq720.jpg%3Fsqp%3D-oaymwEcCNAFEJQDSFXyq4qpAw4IARUAAIhCGAFwAcABBg%3D%3D%26rs%3DAOn4CLAhaw5W-RdSDGSUB1XkhE73v165eA%22%2C%22endpoint%22%3A%7B%22type%22%3A%22watch%22%2C%22payload%22%3A%7B%22videoId%22%3A%22StRtFh01XUo%22%2C%22params%22%3A%22qgMFVmFzY2-6AyQSIlBMZkJzcXNVdnNVaUpuSEZYU2VYODcyNzl3SC1SdTByRmK6AxwSGlJERU16cFYwWUgzS0lVQXlVdkhMVTFxRmRRugMUEhJQTEExRjY5MTQ1NTgzOUQxNEa6AyQSIlBMdFpzajEyRXdEeW9MUGxId3lHNFk4dHcwQkRSY0pYcke6AwsIgbel_aGiu7DPAboDCwjajfOm6aCf7-QBugMLCKmQs83fvuPPgwG6AwsI97nG-tXZnZO8AboDCgjs-ubDv-yLtCG6AwoIpZzmoPKVv9svugMKCOGx4eLmr5jLZroDCgiltaqVlI2r93u6AwsIhbub44yj2eOTAboDCgjSu43hmeWioSy6AwoIicb-i9qiucdQugMKCPPxkrq8lNSwKroDCwjf4cXRtMiGm5UBugMLCNu_0Nmzr4aoiQG6AwsIhoeY5M6dyb39AfIDBQ36KYY-ggQCEAE%253D%22%7D%7D%7D in service youtube2
May 31 19:38:52 volumio volumio[1425]: info: [youtube2-browse] explodeUri: youtube2/video@explodeTrackData:o=%7B%22title%22%3A%22Vasco%20Rossi%20-%20Un%20Senso%22%2C%22artist%22%3A%22Vasco%20Rossi%22%2C%22albumart%22%3A%22https%3A%2F%2Fi.ytimg.com%2Fvi%2FStRtFh01XUo%2Fhq720.jpg%3Fsqp%3D-oaymwEcCNAFEJQDSFXyq4qpAw4IARUAAIhCGAFwAcABBg%3D%3D%26rs%3DAOn4CLAhaw5W-RdSDGSUB1XkhE73v165eA%22%2C%22endpoint%22%3A%7B%22type%22%3A%22watch%22%2C%22payload%22%3A%7B%22videoId%22%3A%22StRtFh01XUo%22%2C%22params%22%3A%22qgMFVmFzY2-6AyQSIlBMZkJzcXNVdnNVaUpuSEZYU2VYODcyNzl3SC1SdTByRmK6AxwSGlJERU16cFYwWUgzS0lVQXlVdkhMVTFxRmRRugMUEhJQTEExRjY5MTQ1NTgzOUQxNEa6AyQSIlBMdFpzajEyRXdEeW9MUGxId3lHNFk4dHcwQkRSY0pYcke6AwsIgbel_aGiu7DPAboDCwjajfOm6aCf7-QBugMLCKmQs83fvuPPgwG6AwsI97nG-tXZnZO8AboDCgjs-ubDv-yLtCG6AwoIpZzmoPKVv9svugMKCOGx4eLmr5jLZroDCgiltaqVlI2r93u6AwsIhbub44yj2eOTAboDCgjSu43hmeWioSy6AwoIicb-i9qiucdQugMKCPPxkrq8lNSwKroDCwjf4cXRtMiGm5UBugMLCNu_0Nmzr4aoiQG6AwsIhoeY5M6dyb39AfIDBQ36KYY-ggQCEAE%253D%22%7D%7D%7D
May 31 19:38:52 volumio volumio[1425]: info: CoreCommandRouter::volumioPushQueue
May 31 19:38:52 volumio volumio[1425]: info: CorePlayQueue::saveQueue
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::updateTrackBlock
May 31 19:38:52 volumio volumio[1425]: info: CorePlayQueue::getTrackBlock
May 31 19:38:52 volumio volumio[1425]: info: CoreCommandRouter::volumioPlay
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::play index 0
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::setConsumeUpdateService undefined
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::stop
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::setConsumeUpdateService undefined
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::play index undefined
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::setConsumeUpdateService undefined
May 31 19:38:52 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::startPlaybackTimer
May 31 19:38:52 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:52 volumio volumio[1425]: info: [youtube2-play] clearAddPlayTrack: youtube2/video@endpoint:o=%7B%22type%22%3A%22watch%22%2C%22payload%22%3A%7B%22videoId%22%3A%22StRtFh01XUo%22%2C%22params%22%3A%22qgMFVmFzY2-6AyQSIlBMZkJzcXNVdnNVaUpuSEZYU2VYODcyNzl3SC1SdTByRmK6AxwSGlJERU16cFYwWUgzS0lVQXlVdkhMVTFxRmRRugMUEhJQTEExRjY5MTQ1NTgzOUQxNEa6AyQSIlBMdFpzajEyRXdEeW9MUGxId3lHNFk4dHcwQkRSY0pYcke6AwsIgbel_aGiu7DPAboDCwjajfOm6aCf7-QBugMLCKmQs83fvuPPgwG6AwsI97nG-tXZnZO8AboDCgjs-ubDv-yLtCG6AwoIpZzmoPKVv9svugMKCOGx4eLmr5jLZroDCgiltaqVlI2r93u6AwsIhbub44yj2eOTAboDCgjSu43hmeWioSy6AwoIicb-i9qiucdQugMKCPPxkrq8lNSwKroDCwjf4cXRtMiGm5UBugMLCNu_0Nmzr4aoiQG6AwsIhoeY5M6dyb39AfIDBQ36KYY-ggQCEAE%253D%22%7D%7D@explodeTrackData:o=%7B%22title%22%3A%22Vasco%20Rossi%20-%20Un%20Senso%22%2C%22artist%22%3A%22Vasco%20Rossi%22%2C%22albumart%22%3A%22https%3A%2F%2Fi.ytimg.com%2Fvi%2FStRtFh01XUo%2Fhq720.jpg%3Fsqp%3D-oaymwEcCNAFEJQDSFXyq4qpAw4IARUAAIhCGAFwAcABBg%3D%3D%26rs%3DAOn4CLAhaw5W-RdSDGSUB1XkhE73v165eA%22%2C%22endpoint%22%3A%7B%22type%22%3A%22watch%22%2C%22payload%22%3A%7B%22videoId%22%3A%22StRtFh01XUo%22%2C%22params%22%3A%22qgMFVmFzY2-6AyQSIlBMZkJzcXNVdnNVaUpuSEZYU2VYODcyNzl3SC1SdTByRmK6AxwSGlJERU16cFYwWUgzS0lVQXlVdkhMVTFxRmRRugMUEhJQTEExRjY5MTQ1NTgzOUQxNEa6AyQSIlBMdFpzajEyRXdEeW9MUGxId3lHNFk4dHcwQkRSY0pYcke6AwsIgbel_aGiu7DPAboDCwjajfOm6aCf7-QBugMLCKmQs83fvuPPgwG6AwsI97nG-tXZnZO8AboDCgjs-ubDv-yLtCG6AwoIpZzmoPKVv9svugMKCOGx4eLmr5jLZroDCgiltaqVlI2r93u6AwsIhbub44yj2eOTAboDCgjSu43hmeWioSy6AwoIicb-i9qiucdQugMKCPPxkrq8lNSwKroDCwjf4cXRtMiGm5UBugMLCNu_0Nmzr4aoiQG6AwsIhoeY5M6dyb39AfIDBQ36KYY-ggQCEAE%253D%22%7D%7D%7D
May 31 19:38:52 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:52 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand stop
May 31 19:38:52 volumio volumio[1425]: info: sendMpdCommand stop took 1 milliseconds
May 31 19:38:52 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand clear
May 31 19:38:52 volumio volumio[1425]: info: sendMpdCommand clear took 0 milliseconds
May 31 19:38:52 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand addid "https://rr2---sn-uxaxpu5ap5-ugol.googlevideo.com/videoplayback?expire=1748734732&ei=rD47aO3UB5eezPsPwIbAwQc&ip=79.21.201.71&id=o-AH8eBFDjrifDHDBaauoHr7p8oAcFuJpIavQSV1cRHeX4&itag=251&source=youtube&requiressl=yes&xpc=EgVo2aDSNQ%3D%3D&met=1748713132%2C&mh=n3&mm=31%2C29&mn=sn-uxaxpu5ap5-ugol%2Csn-hpa7zns6&ms=au%2Crdu&mv=m&mvi=2&pl=24&rms=au%2Cau&gcr=it&initcwndbps=1760000&siu=1&bui=AY1jyLNLNrQfJqx77p1xhNevY_4y1rTXy-ui_VhlJw3eGBblHnqzGa7vIxtl40--DohsvPNSyg&spc=l3OVKRfpbnQZoPh1pZN1tnW9xJHlh_w3zV0E4MnLLBV2Yg-YYnMBlbI9BFi0fcMTyHei4uU30hRn3qvt6zc&vprv=1&svpuc=1&mime=audio%2Fwebm&ns=lqpaFcAqAkZOV4FS-FyMIQsQ&rqh=1&gir=yes&clen=3988358&dur=239.541&lmt=1743631940356000&mt=1748712780&fvip=4&keepalive=yes&fexp=51355912&c=WEB&sefc=1&txp=4532534&n=NUbnkj4Rw4pbNA&sparams=expire%2Cei%2Cip%2Cid%2Citag%2Csource%2Crequiressl%2Cxpc%2Cgcr%2Csiu%2Cbui%2Cspc%2Cvprv%2Csvpuc%2Cmime%2Cns%2Crqh%2Cgir%2Cclen%2Cdur%2Clmt&lsparams=met%2Cmh%2Cmm%2Cmn%2Cms%2Cmv%2Cmvi%2Cpl%2Crms%2Cinitcwndbps&lsig=APaTxxMwRAIgVtGd5tlBvffLlhe7ruKlwxqVGsGzk9qIp6g3YcvzoU0CIAQkq31TUmet_vJcDsabVhmJUBsoMd0JL_BFXMZKqyZM&sig=AJfQdSswRAIgEy5pzdUBL8ZCMfBdWVYgvzoxHQeLHiJTBybQzM1c2sQCIBcRQ-ObM14DsHnY-CM1LdYP1wqwFcWGGeUUF7ns0JwX&pot=MpgByJYvp_GzPHnIqvft3LK0ZbziR4vk9csVCpyjKNgLui3k0RxmdVHQkGAWXsQqrMzYHFAJs5ko7AExE7CGlhsRCbFCjP8avuWHCraM3S_mdeik1t8QhCau_8Y5K0upQxv7xqX5NkdPljaUZi6EaYwga2drTS5VEj_BaL5O4TZWInlGgjuRkBHugYbou-Jnn9KZgBUFu8h4KQU%3D&cver=2.20250222.10.00&t.YouTube"
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info: sendMpdCommand addid "https://rr2---sn-uxaxpu5ap5-ugol.googlevideo.com/videoplayback?expire=1748734732&ei=rD47aO3UB5eezPsPwIbAwQc&ip=79.21.201.71&id=o-AH8eBFDjrifDHDBaauoHr7p8oAcFuJpIavQSV1cRHeX4&itag=251&source=youtube&requiressl=yes&xpc=EgVo2aDSNQ%3D%3D&met=1748713132%2C&mh=n3&mm=31%2C29&mn=sn-uxaxpu5ap5-ugol%2Csn-hpa7zns6&ms=au%2Crdu&mv=m&mvi=2&pl=24&rms=au%2Cau&gcr=it&initcwndbps=1760000&siu=1&bui=AY1jyLNLNrQfJqx77p1xhNevY_4y1rTXy-ui_VhlJw3eGBblHnqzGa7vIxtl40--DohsvPNSyg&spc=l3OVKRfpbnQZoPh1pZN1tnW9xJHlh_w3zV0E4MnLLBV2Yg-YYnMBlbI9BFi0fcMTyHei4uU30hRn3qvt6zc&vprv=1&svpuc=1&mime=audio%2Fwebm&ns=lqpaFcAqAkZOV4FS-FyMIQsQ&rqh=1&gir=yes&clen=3988358&dur=239.541&lmt=1743631940356000&mt=1748712780&fvip=4&keepalive=yes&fexp=51355912&c=WEB&sefc=1&txp=4532534&n=NUbnkj4Rw4pbNA&sparams=expire%2Cei%2Cip%2Cid%2Citag%2Csource%2Crequiressl%2Cxpc%2Cgcr%2Csiu%2Cbui%2Cspc%2Cvprv%2Csvpuc%2Cmime%2Cns%2Crqh%2Cgir%2Cclen%2Cdur%2Clmt&lsparams=met%2Cmh%2Cmm%2Cmn%2Cms%2Cmv%2Cmvi%2Cpl%2Crms%2Cinitcwndbps&lsig=APaTxxMwRAIgVtGd5tlBvffLlhe7ruKlwxqVGsGzk9qIp6g3YcvzoU0CIAQkq31TUmet_vJcDsabVhmJUBsoMd0JL_BFXMZKqyZM&sig=AJfQdSswRAIgEy5pzdUBL8ZCMfBdWVYgvzoxHQeLHiJTBybQzM1c2sQCIBcRQ-ObM14DsHnY-CM1LdYP1wqwFcWGGeUUF7ns0JwX&pot=MpgByJYvp_GzPHnIqvft3LK0ZbziR4vk9csVCpyjKNgLui3k0RxmdVHQkGAWXsQqrMzYHFAJs5ko7AExE7CGlhsRCbFCjP8avuWHCraM3S_mdeik1t8QhCau_8Y5K0upQxv7xqX5NkdPljaUZi6EaYwga2drTS5VEj_BaL5O4TZWInlGgjuRkBHugYbou-Jnn9KZgBUFu8h4KQU%3D&cver=2.20250222.10.00&t.YouTube" took 3 milliseconds
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 3ms
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 2ms
May 31 19:38:52 volumio volumio[1425]: verbose: MPD COMMAND [object Object]
May 31 19:38:52 volumio volumio[1425]: verbose: MPD COMMAND [object Object]
May 31 19:38:52 volumio volumio[1425]: verbose: MPD COMMAND [object Object]
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 3ms
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 3ms
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 2ms
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 2ms
May 31 19:38:52 volumio volumio[1425]: info: CoreStateMachine::setConsumeUpdateService mpd
May 31 19:38:52 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand play
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info:
May 31 19:38:52 volumio volumio[1425]: ---------------------------- MPD announces system playlist update
May 31 19:38:52 volumio volumio[1425]: info: Ignoring MPD Status Update
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 2ms
May 31 19:38:52 volumio volumio[1425]: info: sendMpdCommand play took 1 milliseconds
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 1ms
May 31 19:38:52 volumio volumio[1425]: info: ------------------------------ 2ms
May 31 19:38:53 volumio volumio[1425]: info:
May 31 19:38:53 volumio volumio[1425]: ---------------------------- MPD announces state update: player
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::getState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand status
May 31 19:38:53 volumio volumio[1425]: info:
May 31 19:38:53 volumio volumio[1425]: ---------------------------- MPD announces state update: player
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::getState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand status
May 31 19:38:53 volumio volumio[1425]: info:
May 31 19:38:53 volumio volumio[1425]: ---------------------------- MPD announces state update: player
May 31 19:38:53 volumio volumio[1425]: info:
May 31 19:38:53 volumio volumio[1425]: ---------------------------- MPD announces state update: player
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::getState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand status
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand clearerror
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand status took 4 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::getState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand status
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 31 19:38:53 volumio volumio[1425]: info:
May 31 19:38:53 volumio volumio[1425]: ---------------------------- MPD announces state update: player
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::getState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand status
May 31 19:38:53 volumio volumio[1425]: info:
May 31 19:38:53 volumio volumio[1425]: ---------------------------- MPD announces state update: player
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::getState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand status
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand clearerror
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand status took 10 milliseconds
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand clearerror
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand status took 9 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand clearerror took 7 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand status took 7 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand playlistinfo took 6 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand status took 5 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand status took 5 milliseconds
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseTrackInfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseState
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::servicePushState
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:53 volumio volumio[1425]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Vasco Rossi - Un Senso","artist":"VascoRossiVEVO","album":"YouTube","uri":"https://rr2---sn-uxaxpu5ap5-ugol.googlevideo.com/videoplayback?expire=1748734732&ei=rD47aO3UB5eezPsPwIbAwQc&ip=79.21.201.71&id=o-AH8eBFDjrifDHDBaauoHr7p8oAcFuJpIavQSV1cRHeX4&itag=251&source=youtube&requiressl=yes&xpc=EgVo2aDSNQ%3D%3D&met=1748713132%2C&mh=n3&mm=31%2C29&mn=sn-uxaxpu5ap5-ugol%2Csn-hpa7zns6&ms=au%2Crdu&mv=m&mvi=2&pl=24&rms=au%2Cau&gcr=it&initcwndbps=1760000&siu=1&bui=AY1jyLNLNrQfJqx77p1xhNevY_4y1rTXy-ui_VhlJw3eGBblHnqzGa7vIxtl40--DohsvPNSyg&spc=l3OVKRfpbnQZoPh1pZN1tnW9xJHlh_w3zV0E4MnLLBV2Yg-YYnMBlbI9BFi0fcMTyHei4uU30hRn3qvt6zc&vprv=1&svpuc=1&mime=audio%2Fwebm&ns=lqpaFcAqAkZOV4FS-FyMIQsQ&rqh=1&gir=yes&clen=3988358&dur=239.541&lmt=1743631940356000&mt=1748712780&fvip=4&keepalive=yes&fexp=51355912&c=WEB&sefc=1&txp=4532534&n=NUbnkj4Rw4pbNA&sparams=expire%2Cei%2Cip%2Cid%2Citag%2Csource%2Crequiressl%2Cxpc%2Cgcr%2Csiu%2Cbui%2Cspc%2Cvprv%2Csvpuc%2Cmime%2Cns%2Crqh%2Cgir%2Cclen%2Cdur%2Clmt&lsparams=met%2Cmh%2Cmm%2Cmn%2Cms%2Cmv%2Cmvi%2Cpl%2Crms%2Cinitcwndbps&lsig=APaTxxMwRAIgVtGd5tlBvffLlhe7ruKlwxqVGsGzk9qIp6g3YcvzoU0CIAQkq31TUmet_vJcDsabVhmJUBsoMd0JL_BFXMZKqyZM&sig=AJfQdSswRAIgEy5pzdUBL8ZCMfBdWVYgvzoxHQeLHiJTBybQzM1c2sQCIBcRQ-ObM14DsHnY-CM1LdYP1wqwFcWGGeUUF7ns0JwX&pot=MpgByJYvp_GzPHnIqvft3LK0ZbziR4vk9csVCpyjKNgLui3k0RxmdVHQkGAWXsQqrMzYHFAJs5ko7AExE7CGlhsRCbFCjP8avuWHCraM3S_mdeik1t8QhCau_8Y5K0upQxv7xqX5NkdPljaUZi6EaYwga2drTS5VEj_BaL5O4TZWInlGgjuRkBHugYbou-Jnn9KZgBUFu8h4KQU%3D&cver=2.20250222.10.00&t.YouTube","trackType":"YouTube"}
May 31 19:38:53 volumio volumio[1425]: verbose: CURRENT POSITION 0
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState stateService stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState currentStatus stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: No code
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: ------------------------------ 35ms
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand clearerror took 32 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand clearerror took 32 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand playlistinfo took 29 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand playlistinfo took 28 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand playlistinfo took 28 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand playlistinfo took 28 milliseconds
May 31 19:38:53 volumio volumio[1425]: info: sendMpdCommand playlistinfo took 29 milliseconds
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseTrackInfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseTrackInfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseTrackInfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseTrackInfo
May 31 19:38:53 volumio volumio[1425]: verbose: ControllerMpd::parseTrackInfo
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::servicePushState
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:53 volumio volumio[1425]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Vasco Rossi - Un Senso","artist":"VascoRossiVEVO","album":"YouTube","uri":"https://rr2---sn-uxaxpu5ap5-ugol.googlevideo.com/videoplayback?expire=1748734732&ei=rD47aO3UB5eezPsPwIbAwQc&ip=79.21.201.71&id=o-AH8eBFDjrifDHDBaauoHr7p8oAcFuJpIavQSV1cRHeX4&itag=251&source=youtube&requiressl=yes&xpc=EgVo2aDSNQ%3D%3D&met=1748713132%2C&mh=n3&mm=31%2C29&mn=sn-uxaxpu5ap5-ugol%2Csn-hpa7zns6&ms=au%2Crdu&mv=m&mvi=2&pl=24&rms=au%2Cau&gcr=it&initcwndbps=1760000&siu=1&bui=AY1jyLNLNrQfJqx77p1xhNevY_4y1rTXy-ui_VhlJw3eGBblHnqzGa7vIxtl40--DohsvPNSyg&spc=l3OVKRfpbnQZoPh1pZN1tnW9xJHlh_w3zV0E4MnLLBV2Yg-YYnMBlbI9BFi0fcMTyHei4uU30hRn3qvt6zc&vprv=1&svpuc=1&mime=audio%2Fwebm&ns=lqpaFcAqAkZOV4FS-FyMIQsQ&rqh=1&gir=yes&clen=3988358&dur=239.541&lmt=1743631940356000&mt=1748712780&fvip=4&keepalive=yes&fexp=51355912&c=WEB&sefc=1&txp=4532534&n=NUbnkj4Rw4pbNA&sparams=expire%2Cei%2Cip%2Cid%2Citag%2Csource%2Crequiressl%2Cxpc%2Cgcr%2Csiu%2Cbui%2Cspc%2Cvprv%2Csvpuc%2Cmime%2Cns%2Crqh%2Cgir%2Cclen%2Cdur%2Clmt&lsparams=met%2Cmh%2Cmm%2Cmn%2Cms%2Cmv%2Cmvi%2Cpl%2Crms%2Cinitcwndbps&lsig=APaTxxMwRAIgVtGd5tlBvffLlhe7ruKlwxqVGsGzk9qIp6g3YcvzoU0CIAQkq31TUmet_vJcDsabVhmJUBsoMd0JL_BFXMZKqyZM&sig=AJfQdSswRAIgEy5pzdUBL8ZCMfBdWVYgvzoxHQeLHiJTBybQzM1c2sQCIBcRQ-ObM14DsHnY-CM1LdYP1wqwFcWGGeUUF7ns0JwX&pot=MpgByJYvp_GzPHnIqvft3LK0ZbziR4vk9csVCpyjKNgLui3k0RxmdVHQkGAWXsQqrMzYHFAJs5ko7AExE7CGlhsRCbFCjP8avuWHCraM3S_mdeik1t8QhCau_8Y5K0upQxv7xqX5NkdPljaUZi6EaYwga2drTS5VEj_BaL5O4TZWInlGgjuRkBHugYbou-Jnn9KZgBUFu8h4KQU%3D&cver=2.20250222.10.00&t.YouTube","trackType":"YouTube"}
May 31 19:38:53 volumio volumio[1425]: verbose: CURRENT POSITION 0
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState stateService stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState currentStatus stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: No code
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::servicePushState
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:53 volumio volumio[1425]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Vasco Rossi - Un Senso","artist":"VascoRossiVEVO","album":"YouTube","uri":"https://rr2---sn-uxaxpu5ap5-ugol.googlevideo.com/videoplayback?expire=1748734732&ei=rD47aO3UB5eezPsPwIbAwQc&ip=79.21.201.71&id=o-AH8eBFDjrifDHDBaauoHr7p8oAcFuJpIavQSV1cRHeX4&itag=251&source=youtube&requiressl=yes&xpc=EgVo2aDSNQ%3D%3D&met=1748713132%2C&mh=n3&mm=31%2C29&mn=sn-uxaxpu5ap5-ugol%2Csn-hpa7zns6&ms=au%2Crdu&mv=m&mvi=2&pl=24&rms=au%2Cau&gcr=it&initcwndbps=1760000&siu=1&bui=AY1jyLNLNrQfJqx77p1xhNevY_4y1rTXy-ui_VhlJw3eGBblHnqzGa7vIxtl40--DohsvPNSyg&spc=l3OVKRfpbnQZoPh1pZN1tnW9xJHlh_w3zV0E4MnLLBV2Yg-YYnMBlbI9BFi0fcMTyHei4uU30hRn3qvt6zc&vprv=1&svpuc=1&mime=audio%2Fwebm&ns=lqpaFcAqAkZOV4FS-FyMIQsQ&rqh=1&gir=yes&clen=3988358&dur=239.541&lmt=1743631940356000&mt=1748712780&fvip=4&keepalive=yes&fexp=51355912&c=WEB&sefc=1&txp=4532534&n=NUbnkj4Rw4pbNA&sparams=expire%2Cei%2Cip%2Cid%2Citag%2Csource%2Crequiressl%2Cxpc%2Cgcr%2Csiu%2Cbui%2Cspc%2Cvprv%2Csvpuc%2Cmime%2Cns%2Crqh%2Cgir%2Cclen%2Cdur%2Clmt&lsparams=met%2Cmh%2Cmm%2Cmn%2Cms%2Cmv%2Cmvi%2Cpl%2Crms%2Cinitcwndbps&lsig=APaTxxMwRAIgVtGd5tlBvffLlhe7ruKlwxqVGsGzk9qIp6g3YcvzoU0CIAQkq31TUmet_vJcDsabVhmJUBsoMd0JL_BFXMZKqyZM&sig=AJfQdSswRAIgEy5pzdUBL8ZCMfBdWVYgvzoxHQeLHiJTBybQzM1c2sQCIBcRQ-ObM14DsHnY-CM1LdYP1wqwFcWGGeUUF7ns0JwX&pot=MpgByJYvp_GzPHnIqvft3LK0ZbziR4vk9csVCpyjKNgLui3k0RxmdVHQkGAWXsQqrMzYHFAJs5ko7AExE7CGlhsRCbFCjP8avuWHCraM3S_mdeik1t8QhCau_8Y5K0upQxv7xqX5NkdPljaUZi6EaYwga2drTS5VEj_BaL5O4TZWInlGgjuRkBHugYbou-Jnn9KZgBUFu8h4KQU%3D&cver=2.20250222.10.00&t.YouTube","trackType":"YouTube"}
May 31 19:38:53 volumio volumio[1425]: verbose: CURRENT POSITION 0
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState stateService stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState currentStatus stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: No code
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::servicePushState
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:53 volumio volumio[1425]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Vasco Rossi - Un Senso","artist":"VascoRossiVEVO","album":"YouTube","uri":"https://rr2---sn-uxaxpu5ap5-ugol.googlevideo.com/videoplayback?expire=1748734732&ei=rD47aO3UB5eezPsPwIbAwQc&ip=79.21.201.71&id=o-AH8eBFDjrifDHDBaauoHr7p8oAcFuJpIavQSV1cRHeX4&itag=251&source=youtube&requiressl=yes&xpc=EgVo2aDSNQ%3D%3D&met=1748713132%2C&mh=n3&mm=31%2C29&mn=sn-uxaxpu5ap5-ugol%2Csn-hpa7zns6&ms=au%2Crdu&mv=m&mvi=2&pl=24&rms=au%2Cau&gcr=it&initcwndbps=1760000&siu=1&bui=AY1jyLNLNrQfJqx77p1xhNevY_4y1rTXy-ui_VhlJw3eGBblHnqzGa7vIxtl40--DohsvPNSyg&spc=l3OVKRfpbnQZoPh1pZN1tnW9xJHlh_w3zV0E4MnLLBV2Yg-YYnMBlbI9BFi0fcMTyHei4uU30hRn3qvt6zc&vprv=1&svpuc=1&mime=audio%2Fwebm&ns=lqpaFcAqAkZOV4FS-FyMIQsQ&rqh=1&gir=yes&clen=3988358&dur=239.541&lmt=1743631940356000&mt=1748712780&fvip=4&keepalive=yes&fexp=51355912&c=WEB&sefc=1&txp=4532534&n=NUbnkj4Rw4pbNA&sparams=expire%2Cei%2Cip%2Cid%2Citag%2Csource%2Crequiressl%2Cxpc%2Cgcr%2Csiu%2Cbui%2Cspc%2Cvprv%2Csvpuc%2Cmime%2Cns%2Crqh%2Cgir%2Cclen%2Cdur%2Clmt&lsparams=met%2Cmh%2Cmm%2Cmn%2Cms%2Cmv%2Cmvi%2Cpl%2Crms%2Cinitcwndbps&lsig=APaTxxMwRAIgVtGd5tlBvffLlhe7ruKlwxqVGsGzk9qIp6g3YcvzoU0CIAQkq31TUmet_vJcDsabVhmJUBsoMd0JL_BFXMZKqyZM&sig=AJfQdSswRAIgEy5pzdUBL8ZCMfBdWVYgvzoxHQeLHiJTBybQzM1c2sQCIBcRQ-ObM14DsHnY-CM1LdYP1wqwFcWGGeUUF7ns0JwX&pot=MpgByJYvp_GzPHnIqvft3LK0ZbziR4vk9csVCpyjKNgLui3k0RxmdVHQkGAWXsQqrMzYHFAJs5ko7AExE7CGlhsRCbFCjP8avuWHCraM3S_mdeik1t8QhCau_8Y5K0upQxv7xqX5NkdPljaUZi6EaYwga2drTS5VEj_BaL5O4TZWInlGgjuRkBHugYbou-Jnn9KZgBUFu8h4KQU%3D&cver=2.20250222.10.00&t.YouTube","trackType":"YouTube"}
May 31 19:38:53 volumio volumio[1425]: verbose: CURRENT POSITION 0
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState stateService stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState currentStatus stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: No code
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::servicePushState
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:53 volumio volumio[1425]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Vasco Rossi - Un Senso","artist":"VascoRossiVEVO","album":"YouTube","uri":"https://rr2---sn-uxaxpu5ap5-ugol.googlevideo.com/videoplayback?expire=1748734732&ei=rD47aO3UB5eezPsPwIbAwQc&ip=79.21.201.71&id=o-AH8eBFDjrifDHDBaauoHr7p8oAcFuJpIavQSV1cRHeX4&itag=251&source=youtube&requiressl=yes&xpc=EgVo2aDSNQ%3D%3D&met=1748713132%2C&mh=n3&mm=31%2C29&mn=sn-uxaxpu5ap5-ugol%2Csn-hpa7zns6&ms=au%2Crdu&mv=m&mvi=2&pl=24&rms=au%2Cau&gcr=it&initcwndbps=1760000&siu=1&bui=AY1jyLNLNrQfJqx77p1xhNevY_4y1rTXy-ui_VhlJw3eGBblHnqzGa7vIxtl40--DohsvPNSyg&spc=l3OVKRfpbnQZoPh1pZN1tnW9xJHlh_w3zV0E4MnLLBV2Yg-YYnMBlbI9BFi0fcMTyHei4uU30hRn3qvt6zc&vprv=1&svpuc=1&mime=audio%2Fwebm&ns=lqpaFcAqAkZOV4FS-FyMIQsQ&rqh=1&gir=yes&clen=3988358&dur=239.541&lmt=1743631940356000&mt=1748712780&fvip=4&keepalive=yes&fexp=51355912&c=WEB&sefc=1&txp=4532534&n=NUbnkj4Rw4pbNA&sparams=expire%2Cei%2Cip%2Cid%2Citag%2Csource%2Crequiressl%2Cxpc%2Cgcr%2Csiu%2Cbui%2Cspc%2Cvprv%2Csvpuc%2Cmime%2Cns%2Crqh%2Cgir%2Cclen%2Cdur%2Clmt&lsparams=met%2Cmh%2Cmm%2Cmn%2Cms%2Cmv%2Cmvi%2Cpl%2Crms%2Cinitcwndbps&lsig=APaTxxMwRAIgVtGd5tlBvffLlhe7ruKlwxqVGsGzk9qIp6g3YcvzoU0CIAQkq31TUmet_vJcDsabVhmJUBsoMd0JL_BFXMZKqyZM&sig=AJfQdSswRAIgEy5pzdUBL8ZCMfBdWVYgvzoxHQeLHiJTBybQzM1c2sQCIBcRQ-ObM14DsHnY-CM1LdYP1wqwFcWGGeUUF7ns0JwX&pot=MpgByJYvp_GzPHnIqvft3LK0ZbziR4vk9csVCpyjKNgLui3k0RxmdVHQkGAWXsQqrMzYHFAJs5ko7AExE7CGlhsRCbFCjP8avuWHCraM3S_mdeik1t8QhCau_8Y5K0upQxv7xqX5NkdPljaUZi6EaYwga2drTS5VEj_BaL5O4TZWInlGgjuRkBHugYbou-Jnn9KZgBUFu8h4KQU%3D&cver=2.20250222.10.00&t.YouTube","trackType":"YouTube"}
May 31 19:38:53 volumio volumio[1425]: verbose: CURRENT POSITION 0
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState stateService stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState currentStatus stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: No code
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: ControllerMpd::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::servicePushState
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: CorePlayQueue::getTrack 0
May 31 19:38:53 volumio volumio[1425]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Vasco Rossi - Un Senso","artist":"VascoRossiVEVO","album":"YouTube","uri":"https://rr2---sn-uxaxpu5ap5-ugol.googlevideo.com/videoplayback?expire=1748734732&ei=rD47aO3UB5eezPsPwIbAwQc&ip=79.21.201.71&id=o-AH8eBFDjrifDHDBaauoHr7p8oAcFuJpIavQSV1cRHeX4&itag=251&source=youtube&requiressl=yes&xpc=EgVo2aDSNQ%3D%3D&met=1748713132%2C&mh=n3&mm=31%2C29&mn=sn-uxaxpu5ap5-ugol%2Csn-hpa7zns6&ms=au%2Crdu&mv=m&mvi=2&pl=24&rms=au%2Cau&gcr=it&initcwndbps=1760000&siu=1&bui=AY1jyLNLNrQfJqx77p1xhNevY_4y1rTXy-ui_VhlJw3eGBblHnqzGa7vIxtl40--DohsvPNSyg&spc=l3OVKRfpbnQZoPh1pZN1tnW9xJHlh_w3zV0E4MnLLBV2Yg-YYnMBlbI9BFi0fcMTyHei4uU30hRn3qvt6zc&vprv=1&svpuc=1&mime=audio%2Fwebm&ns=lqpaFcAqAkZOV4FS-FyMIQsQ&rqh=1&gir=yes&clen=3988358&dur=239.541&lmt=1743631940356000&mt=1748712780&fvip=4&keepalive=yes&fexp=51355912&c=WEB&sefc=1&txp=4532534&n=NUbnkj4Rw4pbNA&sparams=expire%2Cei%2Cip%2Cid%2Citag%2Csource%2Crequiressl%2Cxpc%2Cgcr%2Csiu%2Cbui%2Cspc%2Cvprv%2Csvpuc%2Cmime%2Cns%2Crqh%2Cgir%2Cclen%2Cdur%2Clmt&lsparams=met%2Cmh%2Cmm%2Cmn%2Cms%2Cmv%2Cmvi%2Cpl%2Crms%2Cinitcwndbps&lsig=APaTxxMwRAIgVtGd5tlBvffLlhe7ruKlwxqVGsGzk9qIp6g3YcvzoU0CIAQkq31TUmet_vJcDsabVhmJUBsoMd0JL_BFXMZKqyZM&sig=AJfQdSswRAIgEy5pzdUBL8ZCMfBdWVYgvzoxHQeLHiJTBybQzM1c2sQCIBcRQ-ObM14DsHnY-CM1LdYP1wqwFcWGGeUUF7ns0JwX&pot=MpgByJYvp_GzPHnIqvft3LK0ZbziR4vk9csVCpyjKNgLui3k0RxmdVHQkGAWXsQqrMzYHFAJs5ko7AExE7CGlhsRCbFCjP8avuWHCraM3S_mdeik1t8QhCau_8Y5K0upQxv7xqX5NkdPljaUZi6EaYwga2drTS5VEj_BaL5O4TZWInlGgjuRkBHugYbou-Jnn9KZgBUFu8h4KQU%3D&cver=2.20250222.10.00&t.YouTube","trackType":"YouTube"}
May 31 19:38:53 volumio volumio[1425]: verbose: CURRENT POSITION 0
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState stateService stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::syncState currentStatus stop
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: No code
May 31 19:38:53 volumio volumio[1425]: info: CoreStateMachine::pushState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioPushState
May 31 19:38:53 volumio volumio[1425]: info: ------------------------------ 112ms
May 31 19:38:53 volumio volumio[1425]: info: ------------------------------ 112ms
May 31 19:38:53 volumio volumio[1425]: info: ------------------------------ 112ms
May 31 19:38:53 volumio volumio[1425]: info: ------------------------------ 107ms
May 31 19:38:53 volumio volumio[1425]: info: ------------------------------ 107ms
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 31 19:38:53 volumio volumio[1425]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates
May 31 19:38:53 volumio volumio[1425]: info: Received Get System Version
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
May 31 19:38:53 volumio volumio[1425]: info: Received Get System Info
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:38:53 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:38:53 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:39:03 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:39:03 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:39:03 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:39:03 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:03 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:39:03 volumio volumio[1425]: verbose: New Socket.io Connection to 192.168.1.24:3000 from 192.168.1.126 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 8
May 31 19:39:03 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:03 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
May 31 19:39:03 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
May 31 19:39:05 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:05 volumio volumio[1425]: verbose: New Socket.io Connection to 192.168.1.24:3000 from 192.168.1.126 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 9
May 31 19:39:05 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:05 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
May 31 19:39:05 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
May 31 19:39:05 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:06 volumio sudo[2394]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 31 19:39:06 volumio sudo[2394]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:39:06 volumio sudo[2394]: pam_unix(sudo:session): session closed for user root
May 31 19:39:06 volumio sudo[2396]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 31 19:39:06 volumio sudo[2396]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:39:06 volumio sudo[2396]: pam_unix(sudo:session): session closed for user root
May 31 19:39:06 volumio volumio[1425]: verbose: New Socket.io Connection to 192.168.1.24 from 192.168.1.126 UA: Mozilla/5.0 (Linux; Android 15; SM-S926B Build/AP3A.240905.015.A2; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 10
May 31 19:39:06 volumio sudo[2400]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 31 19:39:06 volumio sudo[2400]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:39:06 volumio sudo[2400]: pam_unix(sudo:session): session closed for user root
May 31 19:39:06 volumio sudo[2402]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 31 19:39:06 volumio sudo[2402]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
May 31 19:39:06 volumio sudo[2402]: pam_unix(sudo:session): session closed for user root
May 31 19:39:06 volumio volumio[1425]: verbose: New Socket.io Connection to 192.168.1.24 from 192.168.1.126 UA: Mozilla/5.0 (Linux; Android 15; SM-S926B Build/AP3A.240905.015.A2; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.125 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 11
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::volumioGetVisibleSources
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::volumioGetQueue
May 31 19:39:06 volumio volumio[1425]: info: CoreStateMachine::getQueue
May 31 19:39:06 volumio volumio[1425]: info: CorePlayQueue::getQueue
May 31 19:39:06 volumio volumio[1425]: info: Listing playlists
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
May 31 19:39:06 volumio volumio[1425]: info: Received Get System Info
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:39:06 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 31 19:39:06 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 31 19:39:08 volumio volumio[1425]: info: Received Get System Info
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:39:08 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 31 19:39:08 volumio volumio[1425]: info: Received Get System Info
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 31 19:39:08 volumio volumio[1425]: info: Discovery: Getting this device information
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::volumioGetState
May 31 19:39:08 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 31 19:39:13 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: webradio , handleBrowseUri
May 31 19:39:13 volumio volumio[1425]: info: Preload queue cleared
May 31 19:39:16 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
May 31 19:39:17 volumio volumio[1425]: Searching plugin music_service/webradio
May 31 19:39:17 volumio volumio[1425]: info: CoreCommandRouter::executeOnPlugin: webradio , search
May 31 19:39:17 volumio volumio[1425]: Use XMLElement.setAttribute instead
May 31 19:39:17 volumio volumio[1425]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 31 19:39:17 volumio volumio[1425]: TypeError: children[i].attr(...).value is not a function
May 31 19:39:17 volumio volumio[1425]: at /volumio/app/plugins/music_service/webradio/index.js:956:46
May 31 19:39:17 volumio volumio[1425]: at process.processTicksAndRejections (node:internal/process/task_queues:95:5)
May 31 19:39:17 volumio volumio[1425]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 31 19:39:17 volumio systemd[1]: Starting setdatetime-helper.timer.service - Volumio Time Sync Watchdog Service...
May 31 19:39:17 volumio dbus-daemon[1004]: [system] Activating via systemd: service name='org.freedesktop.timedate1' unit='dbus-org.freedesktop.timedate1.service' requested by ':1.32' (uid=0 pid=2432 comm="timedatectl show --property=NTPSynchronized --valu")
May 31 19:39:17 volumio systemd[1]: Starting systemd-timedated.service - Time & Date Service...
May 31 19:39:17 volumio dbus-daemon[1004]: [system] Successfully activated service 'org.freedesktop.timedate1'
May 31 19:39:17 volumio systemd[1]: Started systemd-timedated.service - Time & Date Service.
May 31 19:39:17 volumio setdatetime-helper.sh[2420]: Time is already synchronized.
May 31 19:39:17 volumio systemd[1]: setdatetime-helper.timer.service: Deactivated successfully.
May 31 19:39:17 volumio systemd[1]: Finished setdatetime-helper.timer.service - Volumio Time Sync Watchdog Service.
May 31 19:39:17 volumio sudo[2438]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2025-05-31 19:38'
May 31 19:39:17 volumio sudo[2438]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
PRETTY_NAME="Raspbian GNU/Linux 12 (bookworm)"
NAME="Raspbian GNU/Linux"
VERSION_ID="12"
VERSION="12 (bookworm)"
VERSION_CODENAME=bookworm
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="fd567ba9bc0dc34c0403e2d5b72a0f46467d1983"
VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6"
VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a"
VOLUMIO_BE_VERSION="35e4a13c94df42ebab19fd6178d6be47190c244d"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Fri May 23 08:02:06 UTC 2025"
VOLUMIO_VERSION="0.069"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="76fa67e30b28261e1dc7c3a89e610b9e"