-- Logs begin at Fri 2024-10-18 17:21:19 AEDT, end at Fri 2024-11-29 18:23:35 AEDT. --
Nov 29 18:22:00 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Nov 29 18:22:00 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Nov 29 18:22:03 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Nov 29 18:22:03 spotipi volumio[845]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 9
Nov 29 18:22:03 spotipi volumio[845]: info: CoreCommandRouter::volumioGetState
Nov 29 18:22:03 spotipi volumio[845]: info: CorePlayQueue::getTrack 0
Nov 29 18:22:08 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Nov 29 18:22:08 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Nov 29 18:22:08 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam
Nov 29 18:22:08 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam
Nov 29 18:22:08 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject
Nov 29 18:22:08 spotipi volumio[845]: info: CoreCommandRouter::volumioGetBrowseSources
Nov 29 18:22:08 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Nov 29 18:22:15 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken
Nov 29 18:22:21 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Nov 29 18:22:21 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Nov 29 18:22:21 spotipi volumio[845]: info: Discovery: Getting this device information
Nov 29 18:22:21 spotipi volumio[845]: info: CoreCommandRouter::volumioGetState
Nov 29 18:22:21 spotipi volumio[845]: info: CorePlayQueue::getTrack 0
Nov 29 18:22:21 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Nov 29 18:22:21 spotipi volumio[845]: info: Downloading plugin at https://plugins.volumio.workers.dev/pluginsv2/download/now_playing/0.7.3/volumio/buster/armhf
Nov 29 18:22:24 spotipi volumio[845]: info: END DOWNLOAD: https://plugins.volumio.workers.dev/pluginsv2/download/now_playing/0.7.3/volumio/buster/armhf
Nov 29 18:22:24 spotipi volumio[845]: info: Folder /tmp/plugins removed
Nov 29 18:22:25 spotipi volumio[845]: info: Check plugin dependencies
Nov 29 18:22:25 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Nov 29 18:22:25 spotipi volumio[845]: info: Checking if plugin already exists
Nov 29 18:22:25 spotipi volumio[845]: info: Rename folder
Nov 29 18:22:25 spotipi volumio[845]: info: Folder /tmp/downloaded_plugin.zip removed
Nov 29 18:22:25 spotipi volumio[845]: info: Move to category
Nov 29 18:22:27 spotipi volumio[845]: info: Checking if install.sh is present
Nov 29 18:22:27 spotipi volumio[845]: info: Executing install.sh
Nov 29 18:22:27 spotipi sudo[1958]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/sh /data/plugins/user_interface/now_playing/install.sh
Nov 29 18:22:27 spotipi sudo[1958]: pam_unix(sudo:session): session opened for user root by (uid=0)
Nov 29 18:22:27 spotipi volumio[845]: info: Installing geo-tz node dependency
Nov 29 18:22:47 spotipi ntpd[793]: Soliciting pool server 220.158.215.21
Nov 29 18:22:48 spotipi ntpd[793]: Soliciting pool server 220.158.215.20
Nov 29 18:22:49 spotipi ntpd[793]: Soliciting pool server 2001:df6:6e80:e203::123
Nov 29 18:22:49 spotipi ntpd[793]: Soliciting pool server 180.150.8.191
Nov 29 18:22:50 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Nov 29 18:22:50 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Nov 29 18:22:50 spotipi volumio[845]: info: Discovery: Getting this device information
Nov 29 18:22:50 spotipi volumio[845]: info: CoreCommandRouter::volumioGetState
Nov 29 18:22:50 spotipi volumio[845]: info: CorePlayQueue::getTrack 0
Nov 29 18:22:50 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Nov 29 18:22:51 spotipi volumio[845]: info: + geo-tz@8.1.2
Nov 29 18:22:51 spotipi volumio[845]: info: added 29 packages from 33 contributors and audited 353 packages in 21.928s
Nov 29 18:22:51 spotipi volumio[845]: info:
Nov 29 18:22:51 spotipi volumio[845]: info: 21 packages are looking for funding
Nov 29 18:22:51 spotipi volumio[845]: info: run `npm fund` for details
Nov 29 18:22:51 spotipi volumio[845]: info:
Nov 29 18:22:51 spotipi volumio[845]: info: found 11 vulnerabilities (5 low, 3 moderate, 3 high)
Nov 29 18:22:51 spotipi volumio[845]: info: run `npm audit fix` to fix them, or `npm audit` for details
Nov 29 18:22:51 spotipi volumio[845]: info: Creating user directories (if not exist)
Nov 29 18:22:51 spotipi sudo[1958]: pam_unix(sudo:session): session closed for user root
Nov 29 18:22:51 spotipi volumio[845]: info: Now Playing plugin installed
Nov 29 18:22:51 spotipi volumio[845]: Plugin install end detected on script
Nov 29 18:22:51 spotipi volumio[845]: info: Install script completed
Nov 29 18:22:51 spotipi volumio[845]: info: Adding reference to registry
Nov 29 18:22:51 spotipi volumio[845]: info: Done installing plugin.
Nov 29 18:22:51 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Nov 29 18:22:51 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken
Nov 29 18:22:51 spotipi volumio[845]: info: Folder /tmp/plugins removed
Nov 29 18:22:51 spotipi volumio[845]: info: Folder /tmp/downloaded_plugin.zip removed
Nov 29 18:22:51 spotipi volumio[845]: info: Folder /data/temp removed
Nov 29 18:23:10 spotipi volumio[845]: info: Enabling plugin now_playing
Nov 29 18:23:10 spotipi volumio[845]: info: Loading plugin "now_playing"...
Nov 29 18:23:10 spotipi volumio[845]: error: !!!! WARNING !!!!
Nov 29 18:23:10 spotipi volumio[845]: error: The plugin user_interface/now_playing failed to load, setting it to stopped. Error: Error [ERR_REQUIRE_ESM]: Must use import to load ES Module: /data/plugins/user_interface/now_playing/node_modules/point-in-polygon-hao/dist/pointInPolygon.mjs
Nov 29 18:23:10 spotipi volumio[845]: error: Stack trace: Error [ERR_REQUIRE_ESM]: Must use import to load ES Module: /data/plugins/user_interface/now_playing/node_modules/point-in-polygon-hao/dist/pointInPolygon.mjs
Nov 29 18:23:10 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:926:11)
Nov 29 18:23:10 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:10 spotipi volumio[845]: at Module.require (internal/modules/cjs/loader.js:952:19)
Nov 29 18:23:10 spotipi volumio[845]: at require (internal/modules/cjs/helpers.js:88:18)
Nov 29 18:23:10 spotipi volumio[845]: at Object. (/data/plugins/user_interface/now_playing/node_modules/@turf/boolean-point-in-polygon/dist/cjs/index.cjs:2:26)
Nov 29 18:23:10 spotipi volumio[845]: at Module._compile (internal/modules/cjs/loader.js:1063:30)
Nov 29 18:23:10 spotipi volumio[845]: at Object.Module._extensions..js (internal/modules/cjs/loader.js:1092:10)
Nov 29 18:23:10 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:928:32)
Nov 29 18:23:10 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:10 spotipi volumio[845]: at Module.require (internal/modules/cjs/loader.js:952:19)
Nov 29 18:23:10 spotipi volumio[845]: at require (internal/modules/cjs/helpers.js:88:18)
Nov 29 18:23:10 spotipi volumio[845]: at Object. (/data/plugins/user_interface/now_playing/node_modules/geo-tz/dist/find-1970.js:1:61)
Nov 29 18:23:10 spotipi volumio[845]: at Module._compile (internal/modules/cjs/loader.js:1063:30)
Nov 29 18:23:10 spotipi volumio[845]: at Object.Module._extensions..js (internal/modules/cjs/loader.js:1092:10)
Nov 29 18:23:10 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:928:32)
Nov 29 18:23:10 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:10 spotipi volumio[845]: error: !!!! WARNING !!!!
Nov 29 18:23:10 spotipi volumio[845]: info: Done.
Nov 29 18:23:20 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Nov 29 18:23:20 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Nov 29 18:23:20 spotipi volumio[845]: info: Discovery: Getting this device information
Nov 29 18:23:20 spotipi volumio[845]: info: CoreCommandRouter::volumioGetState
Nov 29 18:23:20 spotipi volumio[845]: info: CorePlayQueue::getTrack 0
Nov 29 18:23:20 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Nov 29 18:23:21 spotipi volumio[845]: info: Enabling plugin now_playing
Nov 29 18:23:21 spotipi volumio[845]: info: Loading plugin "now_playing"...
Nov 29 18:23:21 spotipi volumio[845]: error: !!!! WARNING !!!!
Nov 29 18:23:21 spotipi volumio[845]: error: The plugin user_interface/now_playing failed to load, setting it to stopped. Error: Error [ERR_REQUIRE_ESM]: Must use import to load ES Module: /data/plugins/user_interface/now_playing/node_modules/point-in-polygon-hao/dist/pointInPolygon.mjs
Nov 29 18:23:21 spotipi volumio[845]: error: Stack trace: Error [ERR_REQUIRE_ESM]: Must use import to load ES Module: /data/plugins/user_interface/now_playing/node_modules/point-in-polygon-hao/dist/pointInPolygon.mjs
Nov 29 18:23:21 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:926:11)
Nov 29 18:23:21 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:21 spotipi volumio[845]: at Module.require (internal/modules/cjs/loader.js:952:19)
Nov 29 18:23:21 spotipi volumio[845]: at require (internal/modules/cjs/helpers.js:88:18)
Nov 29 18:23:21 spotipi volumio[845]: at Object. (/data/plugins/user_interface/now_playing/node_modules/@turf/boolean-point-in-polygon/dist/cjs/index.cjs:2:26)
Nov 29 18:23:21 spotipi volumio[845]: at Module._compile (internal/modules/cjs/loader.js:1063:30)
Nov 29 18:23:21 spotipi volumio[845]: at Object.Module._extensions..js (internal/modules/cjs/loader.js:1092:10)
Nov 29 18:23:21 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:928:32)
Nov 29 18:23:21 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:21 spotipi volumio[845]: at Module.require (internal/modules/cjs/loader.js:952:19)
Nov 29 18:23:21 spotipi volumio[845]: at require (internal/modules/cjs/helpers.js:88:18)
Nov 29 18:23:21 spotipi volumio[845]: at Object. (/data/plugins/user_interface/now_playing/node_modules/geo-tz/dist/find-1970.js:1:61)
Nov 29 18:23:21 spotipi volumio[845]: at Module._compile (internal/modules/cjs/loader.js:1063:30)
Nov 29 18:23:21 spotipi volumio[845]: at Object.Module._extensions..js (internal/modules/cjs/loader.js:1092:10)
Nov 29 18:23:21 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:928:32)
Nov 29 18:23:21 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:21 spotipi volumio[845]: error: !!!! WARNING !!!!
Nov 29 18:23:21 spotipi volumio[845]: info: Error: TypeError: Cannot read property 'printToastMessage' of null
Nov 29 18:23:24 spotipi volumio[845]: info: Enabling plugin now_playing
Nov 29 18:23:24 spotipi volumio[845]: info: Loading plugin "now_playing"...
Nov 29 18:23:24 spotipi volumio[845]: error: !!!! WARNING !!!!
Nov 29 18:23:24 spotipi volumio[845]: error: The plugin user_interface/now_playing failed to load, setting it to stopped. Error: Error [ERR_REQUIRE_ESM]: Must use import to load ES Module: /data/plugins/user_interface/now_playing/node_modules/point-in-polygon-hao/dist/pointInPolygon.mjs
Nov 29 18:23:24 spotipi volumio[845]: error: Stack trace: Error [ERR_REQUIRE_ESM]: Must use import to load ES Module: /data/plugins/user_interface/now_playing/node_modules/point-in-polygon-hao/dist/pointInPolygon.mjs
Nov 29 18:23:24 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:926:11)
Nov 29 18:23:24 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:24 spotipi volumio[845]: at Module.require (internal/modules/cjs/loader.js:952:19)
Nov 29 18:23:24 spotipi volumio[845]: at require (internal/modules/cjs/helpers.js:88:18)
Nov 29 18:23:24 spotipi volumio[845]: at Object. (/data/plugins/user_interface/now_playing/node_modules/@turf/boolean-point-in-polygon/dist/cjs/index.cjs:2:26)
Nov 29 18:23:24 spotipi volumio[845]: at Module._compile (internal/modules/cjs/loader.js:1063:30)
Nov 29 18:23:24 spotipi volumio[845]: at Object.Module._extensions..js (internal/modules/cjs/loader.js:1092:10)
Nov 29 18:23:24 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:928:32)
Nov 29 18:23:24 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:24 spotipi volumio[845]: at Module.require (internal/modules/cjs/loader.js:952:19)
Nov 29 18:23:24 spotipi volumio[845]: at require (internal/modules/cjs/helpers.js:88:18)
Nov 29 18:23:24 spotipi volumio[845]: at Object. (/data/plugins/user_interface/now_playing/node_modules/geo-tz/dist/find-1970.js:1:61)
Nov 29 18:23:24 spotipi volumio[845]: at Module._compile (internal/modules/cjs/loader.js:1063:30)
Nov 29 18:23:24 spotipi volumio[845]: at Object.Module._extensions..js (internal/modules/cjs/loader.js:1092:10)
Nov 29 18:23:24 spotipi volumio[845]: at Module.load (internal/modules/cjs/loader.js:928:32)
Nov 29 18:23:24 spotipi volumio[845]: at Function.Module._load (internal/modules/cjs/loader.js:769:14)
Nov 29 18:23:24 spotipi volumio[845]: error: !!!! WARNING !!!!
Nov 29 18:23:24 spotipi volumio[845]: info: Error: TypeError: Cannot read property 'printToastMessage' of null
Nov 29 18:23:25 spotipi volumio[845]: info: CoreCommandRouter::getUIConfigOnPlugin
Nov 29 18:23:28 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Nov 29 18:23:28 spotipi volumio[845]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken
Nov 29 18:23:35 spotipi volumio[845]: info: Downloading plugin at https://plugins.volumio.workers.dev/pluginsv2/downloadLatestStable/touch_display/volumio/buster/armhf
Nov 29 18:23:35 spotipi volumio[845]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Nov 29 18:23:35 spotipi volumio[845]: TypeError: Cannot read property 'broadcastMessage' of null
Nov 29 18:23:35 spotipi volumio[845]: at /volumio/app/index.js:1515:32
Nov 29 18:23:35 spotipi volumio[845]: at fastMap (/volumio/node_modules/fast.js/array/map.js:21:17)
Nov 29 18:23:35 spotipi volumio[845]: at Function.fastMap [as map] (/volumio/node_modules/fast.js/map.js:18:12)
Nov 29 18:23:35 spotipi volumio[845]: at CoreCommandRouter.broadcastMessage (/volumio/app/index.js:1513:13)
Nov 29 18:23:35 spotipi volumio[845]: at PluginManager.pushMessage (/volumio/app/pluginmanager.js:1594:20)
Nov 29 18:23:35 spotipi volumio[845]: at PluginManager.updatePlugin (/volumio/app/pluginmanager.js:938:8)
Nov 29 18:23:35 spotipi volumio[845]: at CoreCommandRouter.updatePlugin (/volumio/app/index.js:1448:22)
Nov 29 18:23:35 spotipi volumio[845]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:1221:45)
Nov 29 18:23:35 spotipi volumio[845]: at Socket.emit (events.js:315:20)
Nov 29 18:23:35 spotipi volumio[845]: at /volumio/node_modules/socket.io/lib/socket.js:528:12
Nov 29 18:23:35 spotipi volumio[845]: at processTicksAndRejections (internal/process/task_queues.js:75:11)
Nov 29 18:23:35 spotipi volumio[845]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Nov 29 18:23:35 spotipi sudo[2082]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-11-29 18:22
Nov 29 18:23:35 spotipi sudo[2082]: pam_unix(sudo:session): session opened for user root by (uid=0)
PRETTY_NAME="Raspbian GNU/Linux 10 (buster)"
NAME="Raspbian GNU/Linux"
VERSION_ID="10"
VERSION="10 (buster)"
VERSION_CODENAME=buster
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="bba9e3185e150dd0995f9a49355b34fc6218d5a2"
VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6"
VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a"
VOLUMIO_BE_VERSION="8aa57e3ae5b742ea1069404608336a9884ccfb4e"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Tue 17 Sep 2024 05:01:09 PM CEST"
VOLUMIO_VERSION="3.757"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="e0a6dc7e914e3fb93cbf2123f2f73eac"