Apr 14 18:04:13 rpi5-bt volumio[1343]: ------------------------------------ BT MESSAGE: [dbus-next] Playback state changed: false from 04:BD:BF:CC:E5:22
Apr 14 18:04:13 rpi5-bt volumio[1343]: ------------------------------------ BT MESSAGE: Received pause signal, scheduling idle check
Apr 14 18:04:13 rpi5-bt volumio[1343]: info: CoreCommandRouter::servicePushState
Apr 14 18:04:13 rpi5-bt volumio[1343]: info: CoreStateMachine::pushState
Apr 14 18:04:13 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 18:04:13 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioPushState
Apr 14 18:04:13 rpi5-bt volumio[1343]: info: MRS: Pushing multiroomSync output update for this device
Apr 14 18:04:13 rpi5-bt volumio[1343]: info: MRS: Pushing multiroomSync output
Apr 14 18:04:16 rpi5-bt bluealsa[972]: bluez.c:1480: Signal: org.freedesktop.DBus.Properties.PropertiesChanged(): org.bluez.MediaTransport1: State
Apr 14 18:04:16 rpi5-bt bluealsa[972]: ../src/ba-transport-pcm.c:307: Closing BT socket duplicate [15]: 16
Apr 14 18:04:16 rpi5-bt bluealsa[972]: ../src/ba-transport.c:381: Closing A2DP transport: 15
Apr 14 18:04:16 rpi5-bt bluealsa[972]: ../src/ba-transport-pcm.c:257: Exiting IO thread [ba-a2dp-sbc]: A2DP Sink (SBC)
Apr 14 18:04:16 rpi5-bt volumio[1343]: ------------------------------------ BT MESSAGE: bluealsa-aplay stderr: bluealsa-aplay: [12061] D: aplay.c:643: BT device marked as inactive: 04:BD:BF:CC:E5:22
Apr 14 18:04:21 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 14 18:04:21 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 14 18:04:21 rpi5-bt volumio[1343]: info: Discovery: Getting this device information
Apr 14 18:04:21 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetState
Apr 14 18:04:21 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Retrieving Cloud Streaming UI
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Getting Tidal Cloud Configuration
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Getting Qobuz Cloud Configuration
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Asking plugin for UI Config
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Getting Spotify Cloud Configuration
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Asking plugin for UI Config
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Saving Spotify Acccount
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Got it
Apr 14 18:04:27 rpi5-bt volumio[1343]: error: Could not retrieve Spotify Config from plugin Spotify: no section found
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Got Tidal Cloud Configuration
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: Got it
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::getUIConfigOnPlugin
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetBrowseSources
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetBrowseSources
Apr 14 18:04:27 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetBrowseSources
Apr 14 18:04:28 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 18:04:28 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares
Apr 14 18:04:28 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 14 18:04:28 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 14 18:04:28 rpi5-bt volumio[1343]: info: Discovery: Getting this device information
Apr 14 18:04:28 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetState
Apr 14 18:04:28 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 14 18:04:32 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 18:04:36 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 18:04:40 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 18:04:40 rpi5-bt volumio[1343]: info: CALLMETHOD: miscellanea my_music updateMusicLibrarySupersearchSources [object Object]
Apr 14 18:04:40 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: my_music , updateMusicLibrarySupersearchSources
Apr 14 18:04:41 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetBrowseSources
Apr 14 18:04:41 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetBrowseSources
Apr 14 18:04:41 rpi5-bt volumio[1343]: info: CoreCommandRouter::updateGlobalSearchableBrowseSources
Apr 14 18:04:44 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 18:04:48 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 18:04:49 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetState
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: Executing endpoint metavolumio
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: Executing endpoint metavolumio
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: Executing endpoint metavolumio
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: Discovery: Getting this device information
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetState
Apr 14 18:04:51 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 14 18:04:55 rpi5-bt volumio[1343]: error: Failed request for metavolumio API
Apr 14 18:04:58 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Apr 14 18:04:58 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Apr 14 18:04:58 rpi5-bt volumio[1343]: info: Discovery: Getting this device information
Apr 14 18:04:58 rpi5-bt volumio[1343]: info: CoreCommandRouter::volumioGetState
Apr 14 18:04:58 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Apr 14 18:04:59 rpi5-bt volumio[1343]: Searching all installed plugins
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: , search
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: mpd , search
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , search
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: last_100 , search
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: Error : CoreCommandRouter::executeOnPlugin: No method [search] in plugin last_100
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: webradio , search
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: tidal , search
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: CoreCommandRouter::executeOnPlugin: qobuz , search
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: searchTIDALUri took 412 milliseconds
Apr 14 18:04:59 rpi5-bt volumio[1343]: info: search took 413 milliseconds
Apr 14 18:04:59 rpi5-bt volumio[1343]: Use XMLElement.setAttribute instead
Apr 14 18:04:59 rpi5-bt volumio[1343]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Apr 14 18:04:59 rpi5-bt volumio[1343]: TypeError: children[i].attr(...).value is not a function
Apr 14 18:04:59 rpi5-bt volumio[1343]: at /volumio/app/plugins/music_service/webradio/index.js:956:46
Apr 14 18:04:59 rpi5-bt volumio[1343]: at process.processTicksAndRejections (node:internal/process/task_queues:95:5)
Apr 14 18:04:59 rpi5-bt volumio[1343]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Apr 14 18:05:00 rpi5-bt sudo[12415]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2025-04-14 18:04'
Apr 14 18:05:00 rpi5-bt sudo[12415]: 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="8a3b6fcf0dbd7d42207332f6d209906dd2daab56"
VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6"
VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a"
VOLUMIO_BE_VERSION="e32c2c71ae78852844c70357816bdd871c155ab8"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Sat Apr 12 14:26:54 UTC 2025"
VOLUMIO_VERSION="0.054"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="25d223077b0ad14151d6c5b08157bae8"