-- Logs begin at Thu 2024-07-18 14:35:42 JST, end at Thu 2024-07-18 14:38:06 JST. -- Jul 18 14:37:00 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::getUIConfigOnPlugin Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::getUIConfigOnPlugin Jul 18 14:37:01 volumio volumio[1042]: info: Retrieving Cloud Streaming UI Jul 18 14:37:01 volumio volumio[1042]: info: Getting Tidal Cloud Configuration Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::getUIConfigOnPlugin Jul 18 14:37:01 volumio volumio[1042]: info: Getting Qobuz Cloud Configuration Jul 18 14:37:01 volumio volumio[1042]: info: Asking plugin for UI Config Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::getUIConfigOnPlugin Jul 18 14:37:01 volumio volumio[1042]: info: Getting Spotify Cloud Configuration Jul 18 14:37:01 volumio volumio[1042]: info: Asking plugin for UI Config Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::getUIConfigOnPlugin Jul 18 14:37:01 volumio volumio[1042]: info: Saving Spotify Acccount Jul 18 14:37:01 volumio volumio[1042]: info: Got Tidal Cloud Configuration Jul 18 14:37:01 volumio volumio[1042]: info: Got it Jul 18 14:37:01 volumio volumio[1042]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::getUIConfigOnPlugin Jul 18 14:37:01 volumio volumio[1042]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::volumioGetBrowseSources Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::volumioGetBrowseSources Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::volumioGetBrowseSources Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:01 volumio mpd[2554]: exception: No database Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Jul 18 14:37:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Jul 18 14:37:05 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:05 volumio mpd[2554]: exception: No database Jul 18 14:37:05 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Jul 18 14:37:05 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jul 18 14:37:05 volumio volumio-remote-updater[776]: No test mode Jul 18 14:37:05 volumio volumio-remote-updater[776]: No alpha test mode Jul 18 14:37:05 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Jul 18 14:37:05 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Jul 18 14:37:05 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jul 18 14:37:05 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Jul 18 14:37:06 volumio volumio-remote-updater[776]: No test mode Jul 18 14:37:06 volumio volumio-remote-updater[776]: No alpha test mode Jul 18 14:37:06 volumio volumio[1042]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} Jul 18 14:37:06 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Jul 18 14:37:06 volumio volumio[1042]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} Jul 18 14:37:06 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Jul 18 14:37:07 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: updater_comm , clearUpdateSchedule Jul 18 14:37:07 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jul 18 14:37:07 volumio systemd[1]: systemd-timedated.service: Succeeded. Jul 18 14:37:07 volumio volumio-remote-updater[776]: No test mode Jul 18 14:37:07 volumio volumio-remote-updater[776]: No alpha test mode Jul 18 14:37:07 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled Jul 18 14:37:07 volumio volumio[1042]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} Jul 18 14:37:07 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::Close All Modals sent Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: appearance , setTOSAccepted Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jul 18 14:37:08 volumio volumio[1042]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Jul 18 14:37:08 volumio volumio[1042]: info: Received Get System Version Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jul 18 14:37:08 volumio volumio[1042]: info: Received Get System Info Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jul 18 14:37:08 volumio volumio[1042]: info: Discovery: Getting this device information Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::volumioGetState Jul 18 14:37:08 volumio volumio[1042]: info: CorePlayQueue::getTrack 0 Jul 18 14:37:08 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jul 18 14:37:09 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:09 volumio mpd[2554]: exception: No database Jul 18 14:37:10 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jul 18 14:37:10 volumio volumio[1042]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Jul 18 14:37:10 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Jul 18 14:37:10 volumio volumio[1042]: info: Received Get System Version Jul 18 14:37:10 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jul 18 14:37:10 volumio volumio[1042]: info: Received Get System Info Jul 18 14:37:10 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jul 18 14:37:10 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jul 18 14:37:10 volumio volumio[1042]: info: Discovery: Getting this device information Jul 18 14:37:10 volumio volumio[1042]: info: CoreCommandRouter::volumioGetState Jul 18 14:37:10 volumio volumio[1042]: info: CorePlayQueue::getTrack 0 Jul 18 14:37:10 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jul 18 14:37:11 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: networkfs , discoverShares Jul 18 14:37:11 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , browseForService Jul 18 14:37:13 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:13 volumio mpd[2554]: exception: No database Jul 18 14:37:17 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:17 volumio mpd[2554]: exception: No database Jul 18 14:37:21 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:21 volumio mpd[2554]: exception: No database Jul 18 14:37:25 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:25 volumio mpd[2554]: exception: No database Jul 18 14:37:29 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:29 volumio mpd[2554]: exception: No database Jul 18 14:37:33 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:33 volumio mpd[2554]: exception: No database Jul 18 14:37:37 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:37 volumio mpd[2554]: exception: No database Jul 18 14:37:41 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:41 volumio mpd[2554]: exception: No database Jul 18 14:37:45 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:45 volumio mpd[2554]: exception: No database Jul 18 14:37:49 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:49 volumio mpd[2554]: exception: No database Jul 18 14:37:53 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:53 volumio mpd[2554]: exception: No database Jul 18 14:37:54 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: networkfs , addShare Jul 18 14:37:54 volumio volumio[1042]: info: Adding a new share Jul 18 14:37:54 volumio volumio[1042]: info: No correspondence found in configuration for share music1 on IP 192.168.10.129 Jul 18 14:37:54 volumio sudo[2798]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o username=shinoryo,password=susumu0327,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.10.129/music1 /mnt/NAS/music1 Jul 18 14:37:54 volumio sudo[2798]: pam_unix(sudo:session): session opened for user root by (uid=0) Jul 18 14:37:54 volumio kernel: FS-Cache: Loaded Jul 18 14:37:54 volumio kernel: Key type dns_resolver registered Jul 18 14:37:54 volumio kernel: Key type cifs.spnego registered Jul 18 14:37:54 volumio kernel: Key type cifs.idmap registered Jul 18 14:37:54 volumio kernel: CIFS: No dialect specified on mount. Default has changed to a more secure dialect, SMB2.1 or later (e.g. SMB3.1.1), from CIFS (SMB1). To use the less secure SMB1 dialect to access old servers which do not support SMB3.1.1 (or even SMB3 or SMB2.1) specify vers=1.0 on mount. Jul 18 14:37:54 volumio kernel: CIFS: Attempting to mount //192.168.10.129/music1 Jul 18 14:37:54 volumio sudo[2798]: pam_unix(sudo:session): session closed for user root Jul 18 14:37:54 volumio volumio[1042]: info: [1721281074857] Database scan error: Error: Command failed: /usr/bin/mpc update Jul 18 14:37:54 volumio volumio[1042]: MPD error: No database Jul 18 14:37:55 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Jul 18 14:37:57 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:37:57 volumio mpd[2554]: exception: No database Jul 18 14:38:01 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:38:01 volumio mpd[2554]: exception: No database Jul 18 14:38:02 volumio volumio[1042]: info: Disabling MyMusic plugin upnp Jul 18 14:38:02 volumio sudo[2825]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop upmpdcli.service Jul 18 14:38:02 volumio sudo[2825]: pam_unix(sudo:session): session opened for user root by (uid=0) Jul 18 14:38:02 volumio volumio[1042]: error: Upnp client error: Error: This socket has been ended by the other party Jul 18 14:38:02 volumio systemd[1]: Stopping UPnP Renderer front-end to MPD... Jul 18 14:38:04 volumio volumio[1042]: info: Disabling MyMusic plugin airplay_emulation Jul 18 14:38:04 volumio volumio[1042]: info: CoreCommandRouter::volumioRemoveToBrowseSourcesShairport-Sync Jul 18 14:38:04 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Jul 18 14:38:04 volumio volumio[1042]: info: Disabling plugin airplay_emulation Jul 18 14:38:04 volumio volumio[1042]: info: Done. Jul 18 14:38:04 volumio sudo[2828]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop shairport-sync Jul 18 14:38:04 volumio sudo[2828]: pam_unix(sudo:session): session opened for user root by (uid=0) Jul 18 14:38:04 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jul 18 14:38:04 volumio systemd[1]: shairport-sync.service: Succeeded. Jul 18 14:38:04 volumio systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jul 18 14:38:04 volumio sudo[2828]: pam_unix(sudo:session): session closed for user root Jul 18 14:38:04 volumio volumio[1042]: info: Shairport-Sync Stopped Jul 18 14:38:05 volumio volumio[1042]: info: Disabling MyMusic plugin upnp Jul 18 14:38:05 volumio sudo[2831]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop upmpdcli.service Jul 18 14:38:05 volumio sudo[2831]: pam_unix(sudo:session): session opened for user root by (uid=0) Jul 18 14:38:05 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Jul 18 14:38:05 volumio mpd[2554]: exception: No database Jul 18 14:38:06 volumio volumio[1042]: info: Enabling MyMusic plugin upnp Jul 18 14:38:06 volumio volumio[1042]: info: Enabling plugin upnp Jul 18 14:38:06 volumio volumio[1042]: info: Loading plugin "upnp"... Jul 18 14:38:06 volumio volumio[1042]: info: [1721281086352] Starting Upmpd Daemon Jul 18 14:38:06 volumio volumio[1042]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Jul 18 14:38:06 volumio volumio[1042]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jul 18 14:38:06 volumio volumio[1042]: Error: listen EADDRINUSE: address already in use :::6599 Jul 18 14:38:06 volumio volumio[1042]: at Server.setupListenHandle [as _listen2] (net.js:1331:16) Jul 18 14:38:06 volumio volumio[1042]: at listenInCluster (net.js:1379:12) Jul 18 14:38:06 volumio volumio[1042]: at Server.listen (net.js:1465:7) Jul 18 14:38:06 volumio volumio[1042]: at UpnpInterface.onVolumioStart (/volumio/app/plugins/audio_interface/upnp/index.js:78:17) Jul 18 14:38:06 volumio volumio[1042]: at PluginManager.loadCorePlugin (/volumio/app/pluginmanager.js:255:38) Jul 18 14:38:06 volumio volumio[1042]: at Promise._successFn (/volumio/app/pluginmanager.js:1855:19) Jul 18 14:38:06 volumio volumio[1042]: at nextTickCallback (/volumio/node_modules/kew/kew.js:47:28) Jul 18 14:38:06 volumio volumio[1042]: at processTicksAndRejections (internal/process/task_queues.js:77:11) { Jul 18 14:38:06 volumio volumio[1042]: code: 'EADDRINUSE', Jul 18 14:38:06 volumio volumio[1042]: errno: -98, Jul 18 14:38:06 volumio volumio[1042]: syscall: 'listen', Jul 18 14:38:06 volumio volumio[1042]: address: '::', Jul 18 14:38:06 volumio volumio[1042]: port: 6599 Jul 18 14:38:06 volumio volumio[1042]: } Jul 18 14:38:06 volumio volumio[1042]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jul 18 14:38:06 volumio sudo[2842]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-07-18 14:37 Jul 18 14:38:06 volumio sudo[2842]: 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="4b122b2365bb8c09786cd63b50d1ea6db780eb4e" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="49f98390f2d84c6549f33dc85b694fbd99e4c720" VOLUMIO_ARCH="x64" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 04 Jun 2024 09:13:11 PM CEST" VOLUMIO_VERSION="3.703" VOLUMIO_HARDWARE="x86_amd64" VOLUMIO_DEVICENAME="x86_64" VOLUMIO_HASH="ac782621640fcc70c07e91a81b6d958b"