-- Logs begin at Thu 2024-10-03 22:06:53 CEST, end at Thu 2024-10-03 22:14:09 CEST. -- Oct 03 22:13:07 volumio go-librespot[1483]: time="2024-10-03T22:13:07+02:00" level=debug msg="fetched chunk 7/24, size: 524288" uri="spotify:track:6tbcEkO5stbgWQxeGRUYqI" Oct 03 22:13:18 volumio go-librespot[1483]: time="2024-10-03T22:13:18+02:00" level=debug msg="handling pause player command from 51c819875d0010c112d05cc2fec9e46981b3aa40" Oct 03 22:13:18 volumio go-librespot[1483]: time="2024-10-03T22:13:18+02:00" level=debug msg="pause track at 66190ms" Oct 03 22:13:18 volumio go-librespot[1483]: time="2024-10-03T22:13:18+02:00" level=debug msg="put connect state because PLAYER_STATE_CHANGED" Oct 03 22:13:18 volumio go-librespot[1483]: time="2024-10-03T22:13:18+02:00" level=debug msg="sending successful reply for dealer request" Oct 03 22:13:18 volumio go-librespot[1483]: time="2024-10-03T22:13:18+02:00" level=debug msg="put connect state because PLAYER_STATE_CHANGED" Oct 03 22:13:18 volumio go-librespot[1483]: time="2024-10-03T22:13:18+02:00" level=trace msg="emitting websocket event: paused" Oct 03 22:13:18 volumio volumio[905]: SPOTIFY: received: {"type":"paused","data":{"uri":"spotify:track:6tbcEkO5stbgWQxeGRUYqI","play_origin":"collection-songs"}} Oct 03 22:13:18 volumio volumio[905]: SPOTIFY: PUSH STATE SPOTIFY Oct 03 22:13:18 volumio volumio[905]: SPOTIFY: {"status":"pause","service":"spop","title":"Valse in C-Sharp Minor, Op. 64 No. 2","artist":"Eugen Cicero","album":"Swinging the Classics On MPS","albumart":"https://i.scdn.co/image/ab67616d00001e021762f104487bef51070c2429","uri":"spotify:track:6tbcEkO5stbgWQxeGRUYqI","trackType":"spotify","seek":66136,"duration":339,"samplerate":"44.1 KHz","bitdepth":"16 bit","bitrate":"320 kbps","codec":"ogg","channels":2,"random":null,"repeat":null,"repeatSingle":null,"stream":false,"repeatMode":"all"} Oct 03 22:13:18 volumio volumio[905]: info: CoreCommandRouter::servicePushState Oct 03 22:13:18 volumio volumio[905]: info: CoreStateMachine::pushState Oct 03 22:13:18 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 03 22:13:18 volumio volumio[905]: info: CoreCommandRouter::volumioPushState Oct 03 22:13:18 volumio volumio[905]: SPOTIFY: RECEIVED VOLUMIO VOLUME 75 Oct 03 22:13:56 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 03 22:13:56 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 03 22:13:56 volumio volumio[905]: info: Discovery: Getting this device information Oct 03 22:13:56 volumio volumio[905]: info: CoreCommandRouter::volumioGetState Oct 03 22:13:56 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 03 22:13:56 volumio volumio[905]: verbose: New Socket.io Connection to 192.168.1.143:3000 from 192.168.1.20 UA: Dart/3.4 (dart:io) Engine version: 3 Transport: websocket Total Clients: 7 Oct 03 22:13:56 volumio volumio[905]: info: CoreCommandRouter::volumioGetState Oct 03 22:13:56 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Oct 03 22:13:56 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Oct 03 22:14:00 volumio sudo[2514]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 03 22:14:00 volumio sudo[2514]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 03 22:14:00 volumio sudo[2514]: pam_unix(sudo:session): session closed for user root Oct 03 22:14:00 volumio sudo[2517]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 03 22:14:00 volumio sudo[2517]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 03 22:14:00 volumio sudo[2517]: pam_unix(sudo:session): session closed for user root Oct 03 22:14:00 volumio volumio[905]: verbose: New Socket.io Connection to 192.168.1.143 from 192.168.1.20 UA: Mozilla/5.0 (Linux; Android 10; CLT-L29 Build/HUAWEICLT-L29; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/129.0.6668.70 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 8 Oct 03 22:14:00 volumio sudo[2522]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 03 22:14:00 volumio sudo[2522]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 03 22:14:00 volumio sudo[2522]: pam_unix(sudo:session): session closed for user root Oct 03 22:14:00 volumio sudo[2525]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 03 22:14:00 volumio sudo[2525]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 03 22:14:00 volumio sudo[2525]: pam_unix(sudo:session): session closed for user root Oct 03 22:14:00 volumio volumio[905]: verbose: New Socket.io Connection to 192.168.1.143 from 192.168.1.20 UA: Mozilla/5.0 (Linux; Android 10; CLT-L29 Build/HUAWEICLT-L29; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/129.0.6668.70 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 9 Oct 03 22:14:00 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::volumioGetVisibleSources Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::volumioGetState Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Oct 03 22:14:01 volumio volumio[905]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Oct 03 22:14:01 volumio volumio[905]: info: Received Get System Info Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 03 22:14:01 volumio volumio[905]: info: Discovery: Getting this device information Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::volumioGetState Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::volumioGetState Oct 03 22:14:01 volumio volumio[905]: info: Listing playlists Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 03 22:14:01 volumio volumio[905]: info: Discovery: Getting this device information Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::volumioGetState Oct 03 22:14:01 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 03 22:14:02 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 03 22:14:02 volumio volumio[905]: info: Received Get System Info Oct 03 22:14:02 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 03 22:14:02 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 03 22:14:02 volumio volumio[905]: info: Discovery: Getting this device information Oct 03 22:14:02 volumio volumio[905]: info: CoreCommandRouter::volumioGetState Oct 03 22:14:02 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 03 22:14:02 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 03 22:14:04 volumio volumio[905]: info: Received Get System Info Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 03 22:14:04 volumio volumio[905]: info: Discovery: Getting this device information Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::volumioGetState Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 03 22:14:04 volumio volumio[905]: info: Retrieving Cloud Streaming UI Oct 03 22:14:04 volumio volumio[905]: info: Getting Tidal Cloud Configuration Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 03 22:14:04 volumio volumio[905]: info: Getting Qobuz Cloud Configuration Oct 03 22:14:04 volumio volumio[905]: info: Asking plugin for UI Config Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 03 22:14:04 volumio volumio[905]: info: Getting Spotify Cloud Configuration Oct 03 22:14:04 volumio volumio[905]: info: Asking plugin for UI Config Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 03 22:14:04 volumio volumio[905]: info: Saving Spotify Acccount Oct 03 22:14:04 volumio volumio[905]: info: Got it Oct 03 22:14:04 volumio volumio[905]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Oct 03 22:14:04 volumio volumio[905]: info: Got Tidal Cloud Configuration Oct 03 22:14:04 volumio volumio[905]: info: Got it Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::volumioGetBrowseSources Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::volumioGetBrowseSources Oct 03 22:14:04 volumio volumio[905]: info: CoreCommandRouter::volumioGetBrowseSources Oct 03 22:14:05 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 03 22:14:05 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Oct 03 22:14:07 volumio volumio[905]: info: Disabling MyMusic plugin upnp Oct 03 22:14:07 volumio sudo[2531]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop upmpdcli.service Oct 03 22:14:07 volumio sudo[2531]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 03 22:14:07 volumio systemd[1]: Stopping UPnP Renderer front-end to MPD... Oct 03 22:14:07 volumio volumio[905]: error: Upnp client error: Error: This socket has been ended by the other party Oct 03 22:14:09 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 03 22:14:09 volumio volumio[905]: info: Enabling MyMusic plugin upnp Oct 03 22:14:09 volumio volumio[905]: info: Enabling plugin upnp Oct 03 22:14:09 volumio volumio[905]: info: Loading plugin "upnp"... Oct 03 22:14:09 volumio volumio[905]: info: [1727986449546] Starting Upmpd Daemon Oct 03 22:14:09 volumio volumio[905]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Oct 03 22:14:09 volumio volumio[905]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 03 22:14:09 volumio volumio[905]: Error: listen EADDRINUSE: address already in use :::6599 Oct 03 22:14:09 volumio volumio[905]: at Server.setupListenHandle [as _listen2] (net.js:1331:16) Oct 03 22:14:09 volumio volumio[905]: at listenInCluster (net.js:1379:12) Oct 03 22:14:09 volumio volumio[905]: at Server.listen (net.js:1465:7) Oct 03 22:14:09 volumio volumio[905]: at UpnpInterface.onVolumioStart (/volumio/app/plugins/audio_interface/upnp/index.js:78:17) Oct 03 22:14:09 volumio volumio[905]: at PluginManager.loadCorePlugin (/volumio/app/pluginmanager.js:255:38) Oct 03 22:14:09 volumio volumio[905]: at Promise._successFn (/volumio/app/pluginmanager.js:1855:19) Oct 03 22:14:09 volumio volumio[905]: at nextTickCallback (/volumio/node_modules/kew/kew.js:47:28) Oct 03 22:14:09 volumio volumio[905]: at processTicksAndRejections (internal/process/task_queues.js:77:11) { Oct 03 22:14:09 volumio volumio[905]: code: 'EADDRINUSE', Oct 03 22:14:09 volumio volumio[905]: errno: -98, Oct 03 22:14:09 volumio volumio[905]: syscall: 'listen', Oct 03 22:14:09 volumio volumio[905]: address: '::', Oct 03 22:14:09 volumio volumio[905]: port: 6599 Oct 03 22:14:09 volumio volumio[905]: } Oct 03 22:14:09 volumio volumio[905]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 03 22:14:09 volumio sudo[2542]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-10-03 22:13 Oct 03 22:14:09 volumio sudo[2542]: 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="bba9e3185e150dd0995f9a49355b34fc6218d5a2" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="8aa57e3ae5b742ea1069404608336a9884ccfb4e" VOLUMIO_ARCH="x64" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 17 Sep 2024 05:33:09 PM CEST" VOLUMIO_VERSION="3.757" VOLUMIO_HARDWARE="x86_amd64" VOLUMIO_DEVICENAME="x86_64" VOLUMIO_HASH="ee834e1c2a28de3c5d8c48611ecf1167"