-- Logs begin at Sun 2025-12-14 01:13:19 CET, end at Tue 2025-12-16 11:41:56 CET. -- Dec 16 11:40:10 g.a.minidspshd volumiologrotate[514]: ls: cannot access '/var/log/samba/log.wb-G.A.': No such file or directory Dec 16 11:40:10 g.a.minidspshd volumiologrotate[514]: ls: cannot access '(MINIDSP_SHD)': No such file or directory Dec 16 11:40:12 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:40:12+01:00" level=trace msg="sent dealer ping" Dec 16 11:40:12 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:40:12+01:00" level=trace msg="received dealer pong" Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 38 Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Prefetching next song Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: [1765881614892] ControllerTidal::prefetch Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Getting stream with soundQuality LOSSLESS Dec 16 11:40:14 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/334928350&soundQuality=LOSSLESS" Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:14 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces system playlist update Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Ignoring MPD Status Update Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/334928350&soundQuality=LOSSLESS" took 5 milliseconds Dec 16 11:40:14 g.a.minidspshd volumio[2454]: STREAMING PROXY: Handling url /?data=tidal://song/334928350&soundQuality=LOSSLESS Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: CoreStateMachine::setConsumeUpdateService mpd Dec 16 11:40:14 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand consume 1 Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:14 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces system playlist update Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Ignoring MPD Status Update Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:14 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces system playlist update Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Ignoring MPD Status Update Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: ------------------------------ 14ms Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: sendMpdCommand consume 1 took 11 milliseconds Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: ------------------------------ 9ms Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: ------------------------------ 6ms Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: Executing endpoint getStreamUrltidal Dec 16 11:40:14 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: tidal , getStreamUrlAPI Dec 16 11:40:15 g.a.minidspshd volumio[2454]: info: getStreamUrl took 508 milliseconds Dec 16 11:40:15 g.a.minidspshd volumio[2454]: STREAMING PROXY: Got real url: http://lgf.audio.tidal.com/mediatracks/CAEaKAgDEiRlOTNiZDJjYTlkOGFmMmZiMGE0ODA4NDNiNjIzMDJmNi5tcDQ/0.flac?token=1765885215~ZjIyNTVjMGJiNGQ1ODE1ODMwYTU5NTkwNjNlMzE2NDZkZjI5MGRjZQ== Dec 16 11:40:15 g.a.minidspshd volumio[2454]: STREAMING PROXY: Response: 200, length: 6500684 Dec 16 11:40:16 g.a.minidspshd volumio[2454]: STREAMING PROXY: Client dropped request, destroying Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:19 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces system playlist update Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Ignoring MPD Status Update Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:19 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces state update: player Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ControllerMpd::getState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand status Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:19 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces system playlist update Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Ignoring MPD Status Update Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:19 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces state update: player Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ControllerMpd::getState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand status Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ------------------------------ 12ms Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: sendMpdCommand status took 9 milliseconds Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ------------------------------ 8ms Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: sendMpdCommand status took 5 milliseconds Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand playlistinfo Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand playlistinfo Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:19 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces system playlist update Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Ignoring MPD Status Update Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Dec 16 11:40:19 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces state update: player Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ControllerMpd::getState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand status Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: sendMpdCommand playlistinfo took 10 milliseconds Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: sendMpdCommand playlistinfo took 8 milliseconds Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ------------------------------ 7ms Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: sendMpdCommand status took 7 milliseconds Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseTrackInfo Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseTrackInfo Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand playlistinfo Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ControllerMpd::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::servicePushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 38 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":140,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"292 Kbps","isStreaming":false,"title":"334928350&soundQuality=LOSSLESS","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/334928350&soundQuality=LOSSLESS","trackType":"tidal"} Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: CURRENT POSITION 38 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState stateService play Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState currentStatus play Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Received an update from plugin. extracting info from payload Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ControllerMpd::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::servicePushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 38 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":140,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"292 Kbps","isStreaming":false,"title":"334928350&soundQuality=LOSSLESS","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/334928350&soundQuality=LOSSLESS","trackType":"tidal"} Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: CURRENT POSITION 38 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState stateService play Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState currentStatus play Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Received an update from plugin. extracting info from payload Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ------------------------------ 71ms Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ------------------------------ 67ms Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: sendMpdCommand playlistinfo took 43 milliseconds Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseTrackInfo Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ControllerMpd::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::servicePushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 38 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":140,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"292 Kbps","isStreaming":false,"title":"334928350&soundQuality=LOSSLESS","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/334928350&soundQuality=LOSSLESS","trackType":"tidal"} Dec 16 11:40:19 g.a.minidspshd volumio[2454]: verbose: CURRENT POSITION 38 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState stateService play Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState currentStatus play Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: Received an update from plugin. extracting info from payload Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: ------------------------------ 81ms Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::startPlaybackTimer Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 16 11:40:19 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:40:19 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:40:42 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:40:42+01:00" level=trace msg="sent dealer ping" Dec 16 11:40:42 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:40:42+01:00" level=trace msg="received dealer pong" Dec 16 11:41:10 g.a.minidspshd volumiologrotate[514]: ls: cannot access '/var/log/samba/log.wb-G.A.': No such file or directory Dec 16 11:41:10 g.a.minidspshd volumiologrotate[514]: ls: cannot access '(MINIDSP_SHD)': No such file or directory Dec 16 11:41:12 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:41:12+01:00" level=trace msg="sent dealer ping" Dec 16 11:41:12 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:41:12+01:00" level=trace msg="received dealer pong" Dec 16 11:41:30 g.a.minidspshd volumio[2454]: verbose: New Socket.io Connection to 192.168.1.28:3000 from 192.168.1.167 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 6 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: appearance , getAvailableLanguages Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getCurrentTimezone Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork Dec 16 11:41:30 g.a.minidspshd sudo[25977]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:30 g.a.minidspshd sudo[25977]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:30 g.a.minidspshd sudo[25977]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0 Dec 16 11:41:30 g.a.minidspshd sudo[25977]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:30 g.a.minidspshd sudo[25977]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:30 g.a.minidspshd sudo[25982]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:30 g.a.minidspshd sudo[25982]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:30 g.a.minidspshd sudo[25982]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 16 11:41:30 g.a.minidspshd sudo[25982]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:30 g.a.minidspshd sudo[25990]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:30 g.a.minidspshd sudo[25990]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:30 g.a.minidspshd sudo[25990]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 16 11:41:30 g.a.minidspshd sudo[25990]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:30 g.a.minidspshd sudo[25982]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:30 g.a.minidspshd sudo[25998]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:30 g.a.minidspshd sudo[25998]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:30 g.a.minidspshd sudo[25998]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0 Dec 16 11:41:30 g.a.minidspshd sudo[25998]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:30 g.a.minidspshd sudo[25990]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:30 g.a.minidspshd sudo[26011]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:30 g.a.minidspshd sudo[26011]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:30 g.a.minidspshd sudo[26011]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 16 11:41:30 g.a.minidspshd sudo[26011]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:30 g.a.minidspshd sudo[26011]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:30 g.a.minidspshd sudo[25998]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:30 g.a.minidspshd sudo[26018]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:30 g.a.minidspshd sudo[26018]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:30 g.a.minidspshd sudo[26018]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 16 11:41:30 g.a.minidspshd sudo[26018]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:30 g.a.minidspshd volumio[2454]: verbose: New Socket.io Connection to 192.168.1.28:3000 from 192.168.1.167 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 7 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 16 11:41:30 g.a.minidspshd sudo[26018]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:30 g.a.minidspshd volumio[2454]: verbose: New Socket.io Connection to 192.168.1.28:3000 from 192.168.1.167 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 7 Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 16 11:41:30 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 16 11:41:31 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 16 11:41:31 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 16 11:41:33 g.a.minidspshd sudo[26023]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:33 g.a.minidspshd sudo[26023]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:33 g.a.minidspshd sudo[26023]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 16 11:41:33 g.a.minidspshd sudo[26023]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:33 g.a.minidspshd sudo[26023]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:33 g.a.minidspshd sudo[26026]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:33 g.a.minidspshd sudo[26026]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:33 g.a.minidspshd sudo[26026]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 16 11:41:33 g.a.minidspshd sudo[26026]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:33 g.a.minidspshd sudo[26026]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:33 g.a.minidspshd volumio[2454]: verbose: New Socket.io Connection to 192.168.1.28 from 192.168.1.167 UA: Mozilla/5.0 (Linux; Android 10; SM-N960F Build/QP1A.190711.020; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/143.0.7499.34 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7 Dec 16 11:41:33 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 16 11:41:34 g.a.minidspshd sudo[26031]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:34 g.a.minidspshd sudo[26031]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:34 g.a.minidspshd sudo[26031]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Dec 16 11:41:34 g.a.minidspshd sudo[26031]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:34 g.a.minidspshd sudo[26031]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:34 g.a.minidspshd sudo[26034]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:34 g.a.minidspshd sudo[26034]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:34 g.a.minidspshd sudo[26034]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Dec 16 11:41:34 g.a.minidspshd sudo[26034]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 16 11:41:34 g.a.minidspshd sudo[26034]: pam_unix(sudo:session): session closed for user root Dec 16 11:41:34 g.a.minidspshd volumio[2454]: verbose: New Socket.io Connection to 192.168.1.28 from 192.168.1.167 UA: Mozilla/5.0 (Linux; Android 10; SM-N960F Build/QP1A.190711.020; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/143.0.7499.34 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 8 Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetVisibleSources Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: inputs , handleBrowseUri Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: Received Get System Info Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: Listing playlists Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 16 11:41:34 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Dec 16 11:41:35 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:35 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:35 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:35 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:35 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:35 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:35 g.a.minidspshd volumio[2454]: verbose: New Socket.io Connection to 192.168.1.28:3000 from 192.168.1.167 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 9 Dec 16 11:41:35 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Dec 16 11:41:35 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetQueue Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CoreStateMachine::getQueue Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getQueue Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: Received Get System Info Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:36 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: Received Get System Info Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioClearQueue Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::ClearQueue Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::setConsumeUpdateService undefined Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::stPlaybackTimer Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::updateTrackBlock Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrackBlock Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::serviceStop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::serviceStop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: [1765881697392] ControllerTidal::stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::setConsumeUpdateService mpd Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ControllerMpd::stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::clearPlayQueue Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::saveQueue Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushQueue Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: Dec 16 11:41:37 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces state update: player Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: sendMpdCommand stop took 72 milliseconds Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ControllerMpd::getState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand status Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: sendMpdCommand status took 4 milliseconds Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand playlistinfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: Dec 16 11:41:37 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces state update: player Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ControllerMpd::getState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand status Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: Dec 16 11:41:37 g.a.minidspshd volumio[2454]: ---------------------------- MPD announces state update: player Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ControllerMpd::getState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand status Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: sendMpdCommand playlistinfo took 17 milliseconds Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: sendMpdCommand status took 13 milliseconds Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: sendMpdCommand status took 9 milliseconds Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseTrackInfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand playlistinfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::sendMpdCommand playlistinfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ControllerMpd::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::servicePushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: 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":"334928350&soundQuality=LOSSLESS","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/334928350&soundQuality=LOSSLESS","trackType":"tidal"} Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: CURRENT POSITION 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState stateService stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState currentStatus stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: No code Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ------------------------------ 66ms Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: sendMpdCommand playlistinfo took 48 milliseconds Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: sendMpdCommand playlistinfo took 49 milliseconds Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseTrackInfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: ControllerMpd::parseTrackInfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ControllerMpd::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::servicePushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: 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":"334928350&soundQuality=LOSSLESS","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/334928350&soundQuality=LOSSLESS","trackType":"tidal"} Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: CURRENT POSITION 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState stateService stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState currentStatus stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: No code Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ControllerMpd::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::servicePushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CorePlayQueue::getTrack 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: 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":"334928350&soundQuality=LOSSLESS","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/334928350&soundQuality=LOSSLESS","trackType":"tidal"} Dec 16 11:41:37 g.a.minidspshd volumio[2454]: verbose: CURRENT POSITION 39 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState stateService stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::syncState currentStatus stop Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: No code Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreStateMachine::pushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioPushState Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ------------------------------ 169ms Dec 16 11:41:37 g.a.minidspshd volumio[2454]: info: ------------------------------ 167ms Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: RECEIVED VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: SPOTIFY VOLUME 84 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: VOLUMIO VOLUME 85 Dec 16 11:41:37 g.a.minidspshd volumio[2454]: SPOTIFY: DELTA VOLUME ENOUGH: false Dec 16 11:41:39 g.a.minidspshd volumio[2454]: info: Executing endpoint metavolumio Dec 16 11:41:39 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 16 11:41:39 g.a.minidspshd volumio[2454]: info: Executing endpoint metavolumio Dec 16 11:41:39 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Dec 16 11:41:42 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:41:42+01:00" level=trace msg="sent dealer ping" Dec 16 11:41:42 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:41:42+01:00" level=trace msg="received dealer pong" Dec 16 11:41:43 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:41:43+01:00" level=trace msg="received accesspoint ping" Dec 16 11:41:43 g.a.minidspshd go-librespot[2670]: time="2025-12-16T11:41:43+01:00" level=trace msg="received accesspoint pong ack" Dec 16 11:41:44 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Dec 16 11:41:47 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Dec 16 11:41:47 g.a.minidspshd volumio[2454]: info: browseTIDALUri took 120 milliseconds Dec 16 11:41:47 g.a.minidspshd volumio[2454]: info: Preload queue cleared Dec 16 11:41:47 g.a.minidspshd volumio[2454]: info: Preload queue cleared Dec 16 11:41:49 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Dec 16 11:41:50 g.a.minidspshd volumio[2454]: info: browseTIDALUri took 1335 milliseconds Dec 16 11:41:50 g.a.minidspshd volumio[2454]: info: Preload queue cleared Dec 16 11:41:50 g.a.minidspshd volumio[2454]: info: Preload queue cleared Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: Received Get System Version Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: Received Get System Info Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: Discovery: Getting this device information Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::volumioGetState Dec 16 11:41:52 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Dec 16 11:41:55 g.a.minidspshd volumio[2454]: Searching all installed plugins Dec 16 11:41:55 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 16 11:41:55 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: webradio , search Dec 16 11:41:55 g.a.minidspshd volumio[2454]: info: CoreCommandRouter::executeOnPlugin: calmradio , search Dec 16 11:41:55 g.a.minidspshd volumio[2454]: info: [1765881715905] ControllerCalmRadio::searchCategories Dec 16 11:41:55 g.a.minidspshd volumio[2454]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 16 11:41:55 g.a.minidspshd volumio[2454]: TypeError: Cannot read property 'cats' of undefined Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at ControllerCalmRadio.searchCategories (/data/plugins/music_service/calmradio/index.js:615:42) Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at ControllerCalmRadio.search (/data/plugins/music_service/calmradio/index.js:665:28) Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at CoreCommandRouter.executeOnPlugin (/volumio/app/index.js:1096:32) Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at CoreMusicLibrary.searchOnPlugin (/volumio/app/musiclibrary.js:668:44) Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at CoreMusicLibrary.search (/volumio/app/musiclibrary.js:455:27) Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:485:44) Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at Socket.emit (events.js:400:28) Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 Dec 16 11:41:55 g.a.minidspshd volumio[2454]: at processTicksAndRejections (internal/process/task_queues.js:77:11) Dec 16 11:41:55 g.a.minidspshd volumio[2454]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 16 11:41:56 g.a.minidspshd sudo[26080]: volumio : unable to resolve host g.a.minidspshd Dec 16 11:41:56 g.a.minidspshd sudo[26080]: volumio : problem with defaults entries ; TTY=unknown ; PWD=/ ; USER=root ; Dec 16 11:41:56 g.a.minidspshd sudo[26080]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-12-16 11:40 Dec 16 11:41:56 g.a.minidspshd sudo[26080]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 10 (buster)" NAME="Debian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="cc50ad4a2058d01de272214eb33827883bd2b7d8" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="8bcc10c3dbcbcb349e9887dc0527d54876b32688" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="minidspshd" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 18 Nov 2025 04:27:40 PM CET" VOLUMIO_VERSION="3.877" VOLUMIO_HARDWARE="nanopineo3" VOLUMIO_DEVICENAME="Nanopi Neo3" VOLUMIO_VENDOR="miniDSP" VOLUMIO_MODEL="SHD" VOLUMIO_VENDOR_MODEL="miniDSP SHD" VOLUMIO_HASH="861d146b0ca5e28d2e157bf87e6b15ea"