BusKill / buskill-app

BusKill's main CLI/GUI app for arming/disarming/configuring the BusKill laptop kill cord
https://www.buskill.in
GNU General Public License v3.0
154 stars 22 forks source link

Screen Doesn't Lock on Linux (Linux Mint Cinnamon Desktop Environment) #64

Closed maltfield closed 1 year ago

maltfield commented 1 year ago

@goldfishlaser discovered a bug in the BusKill app where the screen does not lock when armed and the BusKill cable is removed.

This was found to be present on both v0.4.0 and v0.6.0 of the BusKill app.

On reviewing the debug log, it appears that the app never attempts to lock the screen because -- though it does see the usb hotplug event -- it doesn't think it's a usb drive being removed.

21:29:44,634 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:29:44,634 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f452f10e490>|
21:29:44,634 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
21:29:44,634 packages.buskill DEBUG event:|1|
21:29:44,634 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|

The above log says that the HOTPLUG_EVENT_DEVICE_LEFT enumerator has a value of 2.

But the event that's logged when the usb drive is removed (DEVICE_LEFT) is actually a 1. It should be a 2.

System Information

I haven't been able to reproduce this bug, but it was was discovered on an Acer laptop:

Manufacturer: Acer
Product Name: Predator G3-571
Version: V1.14

The laptop is running Linux Mint 20.3 Cinnamon 5.2.7 w/ kernel 5.4.0-144-generic

Debug log says it's libusb1 v3.0.0.

18:49:46,622 packages.buskill DEBUG usb1.version:|3.0.0|

Here's the libusb versions installed from apt

ii libgusb2:amd64 0.3.4-0.1 amd64 GLib wrapper around libusb1
ii libhidapi-libusb0:amd64 0.9.0+dfsg-1 amd64 Multi-Platform library for communication with HID devices (libusb backend)
ii libusb-0.1-4:amd64 2:0.1.12-32 amd64 userspace USB programming library
ii libusb-1.0-0:amd64 2:1.0.23-2build1 amd64 userspace USB programming library
ii libusb-1.0-0-dev:amd64 2:1.0.23-2build1 amd64 userspace USB programming library development files
ii libusb-1.0-doc 2:1.0.23-2build1 all documentation for userspace USB programming
ii libusb-dev 2:0.1.12-32 amd64 userspace USB programming library development files
ii libusbmuxd6:amd64 2.0.1-2 amd64 USB multiplexor daemon for iPhone and iPod Touch devices - library
ii libusbredirparser1:amd64 0.8.0-1ubuntu0.1 amd64 Parser for the usbredir protocol (runtime)
maltfield commented 1 year ago

Relevant code for the above debug log output is here:

maltfield commented 1 year ago

@goldfishlaser can you please provide the versions of libusb you have installed by posting the output of this command?

sudo dpkg -l | grep -i libusb
maltfield commented 1 year ago

In future builds, I may want to play with the parameters passed to context.hotplugRegisterCallback() when registering the hotplugCallbackNix() callback function.

Currently I'm not specifying any parameters, but the above link lists several parameters that affect how the callback is registered and what's passed to it.

I couldn't find the online docs for the libusb1 python module that we're using (and, indeed, it's just a dumb binding for the libusb C package -- whoose docs are linked-to above), but I found you can generate it locally using pydoc on a buskill dev system as follows:

sudo su -
sudo apt-get install git
git clone https://github.com/BusKill/buskill-app.git
cd buskill-app/
build/linux/debianWrapper.sh
/tmp/kivy_appdir/opt/python3.7/bin/python3.7 -m pydoc libusb1
maltfield commented 1 year ago

@goldfishlaser can you please try to execute this build on your machine?

I specifically want to see the following output from the debug log:

  1. usb1.__version__:|???|
  2. everything after the most-recent called hotplugCallbackNix() line
goldfishlaser commented 1 year ago

ii libgusb2:amd64 0.3.4-0.1 amd64 GLib wrapper around libusb1 ii libhidapi-libusb0:amd64 0.9.0+dfsg-1 amd64 Multi-Platform library for communication with HID devices (libusb backend) ii libusb-0.1-4:amd64 2:0.1.12-32 amd64 userspace USB programming library ii libusb-1.0-0:amd64 2:1.0.23-2build1 amd64 userspace USB programming library ii libusb-1.0-0-dev:amd64 2:1.0.23-2build1 amd64 userspace USB programming library development files ii libusb-1.0-doc 2:1.0.23-2build1 all documentation for userspace USB programming ii libusb-dev 2:0.1.12-32 amd64 userspace USB programming library development files ii libusbmuxd6:amd64 2.0.1-2 amd64 USB multiplexor daemon for iPhone and iPod Touch devices - library ii libusbredirparser1:amd64 0.8.0-1ubuntu0.1 amd64 Parser for the usbredir protocol (runtime)

goldfishlaser commented 1 year ago

a bit more than you asked for:

18:50:01,915 packages.buskill DEBUG DEBUG: called hotplugCallbackNix() 18:50:01,915 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f5ca4dc3550>| 18:50:01,915 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002| 18:50:01,915 packages.buskill DEBUG event:|1| 18:50:01,915 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1| 18:50:01,915 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2| 18:50:08,995 packages.buskill DEBUG DEBUG: called hotplugCallbackNix() 18:50:08,995 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f5ca4dc3550>| 18:50:08,995 packages.buskill DEBUG device:|Bus 001 Device 123: ID ffff:5678| 18:50:08,995 packages.buskill DEBUG event:|2| 18:50:08,995 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1| 18:50:08,995 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2| 18:50:08,995 packages.buskill INFO INFO: Detected USB removal event 18:50:08,995 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f5ca289edd0>> 18:50:08,995 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now 18:50:08,996 packages.buskill DEBUG INFO: Attempting to execute xdg-screensaver lock 18:50:09,19 packages.buskill DEBUG DEBUG: subprocess returncode|0| 18:50:09,19 packages.buskill DEBUG DEBUG: subprocess stdout|| 18:50:09,20 packages.buskill DEBUG DEBUG: subprocess stderr|| 18:50:12,337 packages.buskill DEBUG DEBUG: called hotplugCallbackNix() 18:50:12,338 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f5ca4dc3550>| 18:50:12,338 packages.buskill DEBUG device:|Bus 001 Device 124: ID ffff:5678| 18:50:12,338 packages.buskill DEBUG event:|1| 18:50:12,339 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1| 18:50:12,339 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2| 18:50:18,885 buskill_gui DEBUG DEBUG: User switched to 'DebugLog' screen

maltfield commented 1 year ago

@goldfishlaser So the log above shows three events:

One

18:50:01,915 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:50:01,915 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f5ca4dc3550>|
18:50:01,915 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
18:50:01,915 packages.buskill DEBUG event:|1|
18:50:01,915 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:50:01,915 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|

This ^ one says that a device was inserted

Two

18:50:08,995 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:50:08,995 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f5ca4dc3550>|
18:50:08,995 packages.buskill DEBUG device:|Bus 001 Device 123: ID ffff:5678|
18:50:08,995 packages.buskill DEBUG event:|2|
18:50:08,995 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:50:08,995 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
18:50:08,995 packages.buskill INFO INFO: Detected USB removal event
18:50:08,995 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f5ca289edd0>>
18:50:08,995 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
18:50:08,996 packages.buskill DEBUG INFO: Attempting to execute xdg-screensaver lock
18:50:09,19 packages.buskill DEBUG DEBUG: subprocess returncode|0|
18:50:09,19 packages.buskill DEBUG DEBUG: subprocess stdout||
18:50:09,20 packages.buskill DEBUG DEBUG: subprocess stderr||

This ^ one says that a USB drive was removed, and that it was successfully able to lock your screen. I'm confused. Did your screen not lock on this one?

If not, can you tell me what happens if you execute this in a terminal?

xdg-screensaver lock

Three

18:50:12,337 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:50:12,338 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f5ca4dc3550>|
18:50:12,338 packages.buskill DEBUG device:|Bus 001 Device 124: ID ffff:5678|
18:50:12,338 packages.buskill DEBUG event:|1|
18:50:12,339 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:50:12,339 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|

This ^ one says that a USB drive was inserted (again)

maltfield commented 1 year ago

@goldfishlaser can you please also include the output of the log higher up that has this line?

usb1.__version__:|???|
goldfishlaser commented 1 year ago

Two - "This ^ one says that a USB drive was removed, and that it was successfully able to lock your screen. I'm confused. Did your screen not lock on this one?"

My screen did not lock

Three - Result of xdg-screensaver lock

When I ran that command nothing happened.

Further log output

18:49:46,387 root INFO buskill version {'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''} 18:49:46,622 packages.buskill DEBUG usb1.version:|3.0.0| 18:49:46,671 kivy INFO [Logger ] Record log in /home/goldishlaser/.kivy/logs/kivy_23-03-22_0.txt 18:49:46,671 kivy INFO [Kivy ] v1.11.1 18:49:46,671 kivy INFO [Kivy ] Installed at "/tmp/.mount_buskili93AtU/opt/python3.7/lib/python3.7/site-packages/kivy/init.py" 18:49:46,671 kivy INFO [Python ] v3.7.8 (default, Jul 4 2020, 10:00:57) [GCC 9.3.1 20200408 (Red Hat 9.3.1-2)] 18:49:46,671 kivy INFO [Python ] Interpreter at "/BUSKILL"

maltfield commented 1 year ago

ok so there's two separate issues here:

  1. removing a usb drive is sometimes called a usb insertion and
  2. xdg-screensaver lock does nothing on Linux Mint 20.3 Cinnamon 5.2.7
maltfield commented 1 year ago

@goldfishlaser can you report if running this from your command line causes your screen to lock?

cinnamon-screensaver-command --lock

source: https://forums.linuxmint.com/viewtopic.php?t=307131

maltfield commented 1 year ago

Adding additional buskill log info with system information

19:35:33,340 root INFO ===============================================================================
19:35:33,340 root INFO INFO: Writing to log file '/tmp/buskill.log'
19:35:33,340 root DEBUG BUSKILL_VERSION|{'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}|
19:35:33,340 root DEBUG os.environ|environ({'PYTHONHOME': '/tmp/.mount_buskilvF5fck/opt/python3.7', 'SHELL': '/bin/bash', 'SESSION_MANAGER': 'local/goldishlaser-Predator-G3-571:@/tmp/.ICE-unix/1216,unix/goldishlaser-Predator-G3-571:/tmp/.ICE-unix/1216', 'QT_ACCESSIBILITY': '1', 'XDG_CONFIG_DIRS': '/etc/xdg/xdg-cinnamon:/etc/xdg', 'XDG_SESSION_PATH': '/org/freedesktop/DisplayManager/Session0', 'GNOME_DESKTOP_SESSION_ID': 'this-is-deprecated', 'TK_LIBRARY': '/tmp/.mount_buskilvF5fck/usr/share/tcltk/tk8.5', 'LANGUAGE': 'en_US', 'MANDATORY_PATH': '/usr/share/gconf/cinnamon.mandatory.path', 'TKPATH': '/tmp/.mount_buskilvF5fck/usr/share/tcltk/tk8.5', 'SSH_AUTH_SOCK': '/run/user/1000/keyring/ssh', 'ARGV0': '/home/goldishlaser/Downloads/BUSKILL 2/buskill-.AppImage', 'CINNAMON_VERSION': '5.2.7', 'DESKTOP_SESSION': 'cinnamon', 'SSH_AGENT_PID': '1286', 'GTK_MODULES': 'gail:atk-bridge', 'XDG_SEAT': 'seat0', 'PWD': '/home/goldishlaser/Downloads/BUSKILL 2', 'XDG_SESSION_DESKTOP': 'cinnamon', 'LOGNAME': 'goldishlaser', 'QT_QPA_PLATFORMTHEME': 'qt5ct', 'XDG_SESSION_TYPE': 'x11', 'GPG_AGENT_INFO': '/run/user/1000/gnupg/S.gpg-agent:0:1', 'XAUTHORITY': '/home/goldishlaser/.Xauthority', 'XDG_GREETER_DATA_DIR': '/var/lib/lightdm-data/goldishlaser', 'GJS_DEBUG_TOPICS': 'JS ERROR;JS LOG', 'GDM_LANG': 'en_US', 'INSIDE_NEMO_PYTHON': '', 'HOME': '/home/goldishlaser', 'LANG': 'en_US.UTF-8', 'XDG_CURRENT_DESKTOP': 'X-Cinnamon', 'XDG_SEAT_PATH': '/org/freedesktop/DisplayManager/Seat0', 'APPDIR': '/tmp/.mount_buskilvF5fck', 'GJS_DEBUG_OUTPUT': 'stderr', 'XDG_SESSION_CLASS': 'user', 'GTK_OVERLAY_SCROLLING': '1', 'DEFAULTS_PATH': '/usr/share/gconf/cinnamon.default.path', 'USER': 'goldishlaser', 'OWD': '/home/goldishlaser/Downloads/BUSKILL 2', 'DISPLAY': ':0', 'SHLVL': '1', 'XDG_VTNR': '7', 'XDG_SESSION_ID': 'c2', 'APPIMAGE': '/home/goldishlaser/Downloads/BUSKILL 2/buskill-.AppImage', 'XDG_RUNTIME_DIR': '/run/user/1000', 'TCL_LIBRARY': '/tmp/.mount_buskilvF5fck/usr/share/tcltk/tcl8.5', 'GTK3_MODULE
S': 'xapp-gtk3-module', 'XDG_DATA_DIRS': '/usr/share/cinnamon:/usr/share/gnome:/home/goldishlaser/.local/share/flatpak/exports/share:/var/lib/flatpak/exports/share:/usr/local/share:/usr/share', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin', 'GDMSESSION': 'cinnamon', 'DBUS_SESSION_BUS_ADDRESS': 'unix:path=/run/user/1000/bus', 'GIO_LAUNCHED_DESKTOP_FILE_PID': '1250092', 'GIO_LAUNCHED_DESKTOP_FILE': '/usr/share/applications/nemo.desktop'})|
19:35:33,340 root DEBUG sys.argv|['/tmp/.mount_buskilvF5fck/opt/src/main.py']|
19:35:33,341 root DEBUG sys.builtin_modules_names|('_abc', '_ast', '_codecs', '_collections', '_functools', '_imp', '_io', '_locale', '_operator', '_signal', '_sre', '_stat', '_string', '_symtable', '_thread', '_tracemalloc', '_warnings', '_weakref', 'atexit', 'builtins', 'errno', 'faulthandler', 'gc', 'itertools', 'marshal', 'posix', 'pwd', 'sys', 'time', 'xxsubtype', 'zipimport')|
19:35:33,341 root DEBUG sys.executable|/BUSKILL|
19:35:33,341 root DEBUG sys.path|['/tmp/.mount_buskilvF5fck/opt/src', '/tmp/.mount_buskilvF5fck/opt/python3.7/lib/python37.zip', '/tmp/.mount_buskilvF5fck/opt/python3.7/lib/python3.7', '/tmp/.mount_buskilvF5fck/opt/python3.7/lib/python3.7/lib-dynload', '/tmp/.mount_buskilvF5fck/opt/python3.7/lib/python3.7/site-packages']|
19:35:33,341 root DEBUG sys.prefix|/tmp/.mount_buskilvF5fck/opt/python3.7|
19:35:33,341 root DEBUG sys.version|3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]|
19:35:33,341 root DEBUG sys.api_version|1013|
19:35:33,341 root DEBUG sys.version_info|sys.version_info(major=3, minor=7, micro=8, releaselevel='final', serial=0)|
19:35:33,341 root DEBUG __name__|__main__|
19:35:33,341 root DEBUG sys.platform|linux|
19:35:33,341 root DEBUG platform.platform()|Linux-5.4.0-144-generic-x86_64-with-debian-bullseye-sid|
19:35:33,341 root DEBUG platform.system()|Linux|
19:35:33,341 root DEBUG platform.release()|5.4.0-144-generic|
19:35:33,342 root DEBUG platform.version()|#161-Ubuntu SMP Fri Feb 3 14:49:04 UTC 2023|
19:35:33,342 root DEBUG platform.machine()|x86_64|
19:35:33,342 root DEBUG NAME="Linux Mint"
VERSION="20.3 (Una)"
ID=linuxmint
ID_LIKE=ubuntu
PRETTY_NAME="Linux Mint 20.3"
VERSION_ID="20.3"
HOME_URL="https://www.linuxmint.com/"
SUPPORT_URL="https://forums.linuxmint.com/"
BUG_REPORT_URL="http://linuxmint-troubleshooting-guide.readthedocs.io/en/latest/"
PRIVACY_POLICY_URL="https://www.linuxmint.com/"
VERSION_CODENAME=una
UBUNTU_CODENAME=focal

19:35:33,342 root INFO buskill version {'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}
19:35:33,577 packages.buskill DEBUG usb1.__version__:|3.0.0|
maltfield commented 1 year ago

out-of-band I confirmed with goldfishlaser that the following screen does lock the screen

cinnamon-screensaver-command --lock

TODO: add the above command as a second async background task to execute with the existing trigger, and test to see if that fixes this issue

maltfield commented 1 year ago

@goldfishlaser can you please try the latest build to see if it locks your screen 100% of the time now? If not, can you please post the log, starting with the most-recent run (that's delimited by the line INFO ===============================================================================)

goldfishlaser commented 1 year ago

It does not lock my screen 100% of the time, but it also doesn't lock it 0% of the time.... I thought you were trying a cinnamon-screensaver-command --lock command though and I don't see it. I'm pretty sure I am using the latest build?

19:43:29,328 root INFO ===============================================================================
19:43:29,328 root INFO INFO: Writing to log file '/tmp/buskill.log'
19:43:29,328 root DEBUG BUSKILL_VERSION|{'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}|
19:43:29,328 root DEBUG os.environ|environ({'PYTHONHOME': '/tmp/.mount_buskilY452eC/opt/python3.7', 'SHELL': '/bin/bash', 'SESSION_MANAGER': 'local/goldishlaser-Predator-G3-571:@/tmp/.ICE-unix/1191,unix/goldishlaser-Predator-G3-571:/tmp/.ICE-unix/1191', 'QT_ACCESSIBILITY': '1', 'XDG_CONFIG_DIRS': '/etc/xdg/xdg-cinnamon:/etc/xdg', 'XDG_SESSION_PATH': '/org/freedesktop/DisplayManager/Session0', 'GNOME_DESKTOP_SESSION_ID': 'this-is-deprecated', 'TK_LIBRARY': '/tmp/.mount_buskilY452eC/usr/share/tcltk/tk8.5', 'LANGUAGE': 'en_US', 'MANDATORY_PATH': '/usr/share/gconf/cinnamon.mandatory.path', 'TKPATH': '/tmp/.mount_buskilY452eC/usr/share/tcltk/tk8.5', 'SSH_AUTH_SOCK': '/run/user/1000/keyring/ssh', 'ARGV0': '/home/goldishlaser/Downloads/BUSKILL 2/buskill-.AppImage', 'CINNAMON_VERSION': '5.2.7', 'DESKTOP_SESSION': 'cinnamon', 'SSH_AGENT_PID': '1261', 'GTK_MODULES': 'gail:atk-bridge', 'XDG_SEAT': 'seat0', 'PWD': '/home/goldishlaser/Downloads/BUSKILL 2', 'XDG_SESSION_DESKTOP': 'cinnamon', 'LOGNAME': 'goldishlaser', 'QT_QPA_PLATFORMTHEME': 'qt5ct', 'XDG_SESSION_TYPE': 'x11', 'GPG_AGENT_INFO': '/run/user/1000/gnupg/S.gpg-agent:0:1', 'XAUTHORITY': '/home/goldishlaser/.Xauthority', 'XDG_GREETER_DATA_DIR': '/var/lib/lightdm-data/goldishlaser', 'GJS_DEBUG_TOPICS': 'JS ERROR;JS LOG', 'GDM_LANG': 'en_US', 'INSIDE_NEMO_PYTHON': '', 'HOME': '/home/goldishlaser', 'LANG': 'en_US.UTF-8', 'XDG_CURRENT_DESKTOP': 'X-Cinnamon', 'XDG_SEAT_PATH': '/org/freedesktop/DisplayManager/Seat0', 'APPDIR': '/tmp/.mount_buskilY452eC', 'GJS_DEBUG_OUTPUT': 'stderr', 'XDG_SESSION_CLASS': 'user', 'GTK_OVERLAY_SCROLLING': '1', 'DEFAULTS_PATH': '/usr/share/gconf/cinnamon.default.path', 'USER': 'goldishlaser', 'OWD': '/home/goldishlaser/Downloads/BUSKILL 2', 'DISPLAY': ':0', 'SHLVL': '1', 'XDG_VTNR': '7', 'XDG_SESSION_ID': 'c2', 'APPIMAGE': '/home/goldishlaser/Downloads/BUSKILL 2/buskill-.AppImage', 'XDG_RUNTIME_DIR': '/run/user/1000', 'TCL_LIBRARY': '/tmp/.mount_buskilY452eC/usr/share/tcltk/tcl8.5', 'GTK3_MODULES': 'xapp-gtk3-module', 'XDG_DATA_DIRS': '/usr/share/cinnamon:/usr/share/gnome:/home/goldishlaser/.local/share/flatpak/exports/share:/var/lib/flatpak/exports/share:/usr/local/share:/usr/share', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin', 'GDMSESSION': 'cinnamon', 'DBUS_SESSION_BUS_ADDRESS': 'unix:path=/run/user/1000/bus', 'GIO_LAUNCHED_DESKTOP_FILE_PID': '4370', 'GIO_LAUNCHED_DESKTOP_FILE': '/usr/share/applications/nemo.desktop'})|
19:43:29,328 root DEBUG sys.argv|['/tmp/.mount_buskilY452eC/opt/src/main.py']|
19:43:29,328 root DEBUG sys.builtin_modules_names|('_abc', '_ast', '_codecs', '_collections', '_functools', '_imp', '_io', '_locale', '_operator', '_signal', '_sre', '_stat', '_string', '_symtable', '_thread', '_tracemalloc', '_warnings', '_weakref', 'atexit', 'builtins', 'errno', 'faulthandler', 'gc', 'itertools', 'marshal', 'posix', 'pwd', 'sys', 'time', 'xxsubtype', 'zipimport')|
19:43:29,328 root DEBUG sys.executable|/BUSKILL|
19:43:29,328 root DEBUG sys.path|['/tmp/.mount_buskilY452eC/opt/src', '/tmp/.mount_buskilY452eC/opt/python3.7/lib/python37.zip', '/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7', '/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/lib-dynload', '/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/site-packages']|
19:43:29,328 root DEBUG sys.prefix|/tmp/.mount_buskilY452eC/opt/python3.7|
19:43:29,328 root DEBUG sys.version|3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]|
19:43:29,328 root DEBUG sys.api_version|1013|
19:43:29,328 root DEBUG sys.version_info|sys.version_info(major=3, minor=7, micro=8, releaselevel='final', serial=0)|
19:43:29,328 root DEBUG __name__|__main__|
19:43:29,328 root DEBUG sys.platform|linux|
19:43:29,329 root DEBUG platform.platform()|Linux-5.4.0-144-generic-x86_64-with-debian-bullseye-sid|
19:43:29,329 root DEBUG platform.system()|Linux|
19:43:29,329 root DEBUG platform.release()|5.4.0-144-generic|
19:43:29,329 root DEBUG platform.version()|#161-Ubuntu SMP Fri Feb 3 14:49:04 UTC 2023|
19:43:29,329 root DEBUG platform.machine()|x86_64|
19:43:29,329 root DEBUG NAME="Linux Mint"
VERSION="20.3 (Una)"
ID=linuxmint
ID_LIKE=ubuntu
PRETTY_NAME="Linux Mint 20.3"
VERSION_ID="20.3"
HOME_URL="https://www.linuxmint.com/"
SUPPORT_URL="https://forums.linuxmint.com/"
BUG_REPORT_URL="http://linuxmint-troubleshooting-guide.readthedocs.io/en/latest/"
PRIVACY_POLICY_URL="https://www.linuxmint.com/"
VERSION_CODENAME=una
UBUNTU_CODENAME=focal

19:43:29,329 root INFO buskill version {'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}
19:43:29,515 packages.buskill DEBUG usb1.__version__:|3.0.0|
19:43:29,551 kivy INFO [Logger      ] Record log in /home/goldishlaser/.kivy/logs/kivy_23-03-22_3.txt
19:43:29,550 kivy INFO [Kivy        ] v1.11.1
19:43:29,551 kivy INFO [Kivy        ] Installed at "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/site-packages/kivy/__init__.py"
19:43:29,551 kivy INFO [Python      ] v3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]
19:43:29,551 kivy INFO [Python      ] Interpreter at "/BUSKILL"
19:43:29,590 kivy INFO [Factory     ] 184 symbols loaded
19:43:29,702 kivy INFO [Image       ] Providers: img_tex, img_dds, img_sdl2, img_gif (img_pil, img_ffpyplayer ignored)
19:43:29,879 kivy INFO [Window      ] Provider: sdl2(['window_egl_rpi'] ignored)
19:43:30,90 kivy INFO [GL          ] Using the "OpenGL" graphics system
19:43:30,90 kivy INFO [GL          ] Backend used <sdl2>
19:43:30,90 kivy INFO [GL          ] OpenGL version <b'4.6 (Compatibility Profile) Mesa 21.2.6'>
19:43:30,90 kivy INFO [GL          ] OpenGL vendor <b'Intel'>
19:43:30,90 kivy INFO [GL          ] OpenGL renderer <b'Mesa Intel(R) HD Graphics 630 (KBL GT2)'>
19:43:30,91 kivy INFO [GL          ] OpenGL parsed version: 4, 6
19:43:30,91 kivy INFO [GL          ] Shading version <b'4.60'>
19:43:30,91 kivy INFO [GL          ] Texture max size <16384>
19:43:30,91 kivy INFO [GL          ] Texture max units <32>
19:43:30,110 kivy INFO [Window      ] auto add sdl2 input provider
19:43:30,113 kivy INFO [Window      ] virtual keyboard not allowed, single mode, not docked
19:43:30,143 kivy INFO [Clipboard   ] Provider: sdl2(['clipboard_xclip', 'clipboard_xsel', 'clipboard_dbusklipper', 'clipboard_gtk3'] ignored)
19:43:30,151 kivy CRITICAL [Cutbuffer   ] Unable to find any valuable Cutbuffer provider. Please enable debug logging (e.g. add -d if running from the command line, or change the log level in the config) and re-run your app to identify potential causes
xclip - FileNotFoundError: [Errno 2] No such file or directory: 'xclip': 'xclip'
  File "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xclip.py", line 17, in <module>
    p = subprocess.Popen(['xclip', '-version'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

xsel - FileNotFoundError: [Errno 2] No such file or directory: 'xsel': 'xsel'
  File "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xsel.py", line 16, in <module>
    p = subprocess.Popen(['xsel'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilY452eC/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

19:43:30,172 kivy INFO [Text        ] Provider: sdl2
19:43:30,196 packages.buskill DEBUG DEBUG: EXECUTED_AS_SCRIPT:|False|
DEBUG: EXE_PATH:|/BUSKILL|
DEBUG: EXE_DIR:|/|
DEBUG: EXE_FILE:|BUSKILL|
DEBUG: APP_DIR:|/|
DEBUG: APPS_DIR:|/|
DEBUG: SRC_DIR:|/tmp/.mount_buskilY452eC/opt/src|
DEBUG: os.environ['PATH']:|/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin:/:/|

19:43:30,196 packages.buskill DEBUG DEBUG: Unable to write to '/'; skipping.
    [Errno 13] Permission denied: '/tmp0yl5fk6n'

19:43:30,196 packages.buskill DEBUG DEBUG: Unable to write to '/'; skipping.
    [Errno 13] Permission denied: '/tmpsgl18s05'

19:43:30,196 packages.buskill INFO INFO: using DATA_DIR:|/home/goldishlaser/.buskill|
19:43:30,271 kivy INFO [GL          ] NPOT texture support is available
19:43:30,797 kivy INFO [ProbeSysfs  ] device match: /dev/input/event15
19:43:30,797 kivy INFO [MTD         ] Read event from </dev/input/event15>
19:43:30,798 kivy INFO [Base        ] Start application main loop
19:43:30,799 kivy WARNING [MTD         ] Unable to open device "/dev/input/event15". Please ensure you have the appropriate permissions.
19:43:30,843 kivy INFO [GL          ] Unpack subimage support is available
19:43:32,927 packages.buskill DEBUG DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7f1684d46f50>>()
19:43:32,937 packages.buskill INFO INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
19:43:32,941 kivy WARNING stderr: [INFO/Process-1] child process calling self.run()
19:43:32,963 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:32,963 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:32,963 packages.buskill DEBUG device:|Bus 002 Device 001: ID 1d6b:0003|
19:43:32,963 packages.buskill DEBUG event:|1|
19:43:32,963 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:32,964 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:32,964 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:32,964 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:32,964 packages.buskill DEBUG device:|Bus 001 Device 005: ID 0408:a060|
19:43:32,964 packages.buskill DEBUG event:|1|
19:43:32,965 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:32,965 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:32,965 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:32,965 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:32,965 packages.buskill DEBUG device:|Bus 001 Device 004: ID 04ca:3016|
19:43:32,965 packages.buskill DEBUG event:|1|
19:43:32,965 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:32,965 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:32,966 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:32,966 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:32,966 packages.buskill DEBUG device:|Bus 001 Device 003: ID 30fa:0400|
19:43:32,966 packages.buskill DEBUG event:|1|
19:43:32,966 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:32,966 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:32,967 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:32,967 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:32,967 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
19:43:32,967 packages.buskill DEBUG event:|1|
19:43:32,967 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:32,967 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:32,968 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:32,968 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:32,968 packages.buskill DEBUG device:|Bus 001 Device 007: ID ffff:5678|
19:43:32,968 packages.buskill DEBUG event:|1|
19:43:32,968 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:32,968 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:32,969 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:32,969 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:32,969 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
19:43:32,969 packages.buskill DEBUG event:|1|
19:43:32,969 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:32,969 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:36,180 buskill_gui DEBUG DEBUG: User switched to 'DebugLog' screen
19:43:43,995 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:43,995 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:43,995 packages.buskill DEBUG device:|Bus 001 Device 007: ID ffff:5678|
19:43:43,995 packages.buskill DEBUG event:|2|
19:43:43,995 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:43,995 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:43,995 packages.buskill INFO INFO: Detected USB removal event
19:43:43,995 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
19:43:43,995 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
19:43:43,995 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
19:43:44,15 packages.buskill DEBUG DEBUG: subprocess returncode|0|
19:43:44,15 packages.buskill DEBUG DEBUG: subprocess stdout||
19:43:44,15 packages.buskill DEBUG DEBUG: subprocess stderr||
19:43:46,580 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:43:46,581 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:43:46,581 packages.buskill DEBUG device:|Bus 001 Device 008: ID ffff:5678|
19:43:46,582 packages.buskill DEBUG event:|1|
19:43:46,582 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:43:46,582 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:43:52,615 buskill_gui DEBUG DEBUG: User switched to 'DebugLog' screen
19:43:53,663 buskill_gui DEBUG DEBUG: User copied contents of 'DebugLog' to clipboard
19:48:46,440 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:48:46,440 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:48:46,440 packages.buskill DEBUG device:|Bus 001 Device 008: ID ffff:5678|
19:48:46,440 packages.buskill DEBUG event:|2|
19:48:46,440 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:48:46,440 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:48:46,440 packages.buskill INFO INFO: Detected USB removal event
19:48:46,440 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
19:48:46,440 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
19:48:46,441 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
19:48:46,460 packages.buskill DEBUG DEBUG: subprocess returncode|0|
19:48:46,461 packages.buskill DEBUG DEBUG: subprocess stdout||
19:48:46,461 packages.buskill DEBUG DEBUG: subprocess stderr||
19:49:01,718 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:49:01,718 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:49:01,718 packages.buskill DEBUG device:|Bus 001 Device 009: ID ffff:5678|
19:49:01,718 packages.buskill DEBUG event:|1|
19:49:01,718 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:49:01,718 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:49:37,692 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:49:37,693 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:49:37,693 packages.buskill DEBUG device:|Bus 001 Device 009: ID ffff:5678|
19:49:37,693 packages.buskill DEBUG event:|2|
19:49:37,693 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:49:37,693 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:49:37,693 packages.buskill INFO INFO: Detected USB removal event
19:49:37,693 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
19:49:37,693 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
19:49:37,693 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
19:49:37,720 packages.buskill DEBUG DEBUG: subprocess returncode|0|
19:49:37,721 packages.buskill DEBUG DEBUG: subprocess stdout||
19:49:37,721 packages.buskill DEBUG DEBUG: subprocess stderr||
19:49:41,267 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:49:41,267 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:49:41,267 packages.buskill DEBUG device:|Bus 001 Device 010: ID ffff:5678|
19:49:41,267 packages.buskill DEBUG event:|1|
19:49:41,267 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:49:41,268 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:51:09,223 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:51:09,223 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:51:09,223 packages.buskill DEBUG device:|Bus 001 Device 010: ID ffff:5678|
19:51:09,224 packages.buskill DEBUG event:|2|
19:51:09,224 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:51:09,224 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
19:51:09,224 packages.buskill INFO INFO: Detected USB removal event
19:51:09,224 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
19:51:09,224 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
19:51:09,224 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
19:51:09,256 packages.buskill DEBUG DEBUG: subprocess returncode|0|
19:51:09,256 packages.buskill DEBUG DEBUG: subprocess stdout||
19:51:09,256 packages.buskill DEBUG DEBUG: subprocess stderr||
19:51:11,328 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
19:51:11,328 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
19:51:11,328 packages.buskill DEBUG device:|Bus 001 Device 011: ID ffff:5678|
19:51:11,328 packages.buskill DEBUG event:|1|
19:51:11,328 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
19:51:11,329 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:04:55,934 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:04:55,935 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:04:55,935 packages.buskill DEBUG device:|Bus 001 Device 011: ID ffff:5678|
20:04:55,935 packages.buskill DEBUG event:|2|
20:04:55,935 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:04:55,935 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:04:55,935 packages.buskill INFO INFO: Detected USB removal event
20:04:55,935 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
20:04:55,935 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:04:55,935 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:04:55,969 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:04:55,970 packages.buskill DEBUG DEBUG: subprocess stdout||
20:04:55,970 packages.buskill DEBUG DEBUG: subprocess stderr||
20:05:21,792 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:05:21,792 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:05:21,792 packages.buskill DEBUG device:|Bus 001 Device 012: ID ffff:5678|
20:05:21,793 packages.buskill DEBUG event:|1|
20:05:21,793 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:05:21,794 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:08:35,618 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:08:35,618 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:08:35,618 packages.buskill DEBUG device:|Bus 001 Device 012: ID ffff:5678|
20:08:35,618 packages.buskill DEBUG event:|2|
20:08:35,618 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:08:35,618 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:08:35,618 packages.buskill INFO INFO: Detected USB removal event
20:08:35,618 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
20:08:35,618 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:08:35,618 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:08:35,644 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:08:35,644 packages.buskill DEBUG DEBUG: subprocess stdout||
20:08:35,645 packages.buskill DEBUG DEBUG: subprocess stderr||
20:08:40,351 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:08:40,351 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:08:40,351 packages.buskill DEBUG device:|Bus 001 Device 013: ID ffff:5678|
20:08:40,351 packages.buskill DEBUG event:|1|
20:08:40,351 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:08:40,351 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:08:47,904 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:08:47,904 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:08:47,904 packages.buskill DEBUG device:|Bus 001 Device 013: ID ffff:5678|
20:08:47,904 packages.buskill DEBUG event:|2|
20:08:47,904 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:08:47,904 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:08:47,904 packages.buskill INFO INFO: Detected USB removal event
20:08:47,904 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
20:08:47,904 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:08:47,904 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:08:47,941 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:08:47,941 packages.buskill DEBUG DEBUG: subprocess stdout||
20:08:47,941 packages.buskill DEBUG DEBUG: subprocess stderr||
20:08:49,803 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:08:49,803 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:08:49,803 packages.buskill DEBUG device:|Bus 001 Device 014: ID ffff:5678|
20:08:49,803 packages.buskill DEBUG event:|1|
20:08:49,803 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:08:49,804 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:18:23,63 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:18:23,63 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:18:23,64 packages.buskill DEBUG device:|Bus 001 Device 014: ID ffff:5678|
20:18:23,64 packages.buskill DEBUG event:|2|
20:18:23,64 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:18:23,64 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:18:23,64 packages.buskill INFO INFO: Detected USB removal event
20:18:23,64 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
20:18:23,64 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:18:23,64 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:18:23,87 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:18:23,87 packages.buskill DEBUG DEBUG: subprocess stdout||
20:18:23,87 packages.buskill DEBUG DEBUG: subprocess stderr||
20:18:23,683 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:18:23,683 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:18:23,683 packages.buskill DEBUG device:|Bus 001 Device 015: ID ffff:5678|
20:18:23,684 packages.buskill DEBUG event:|1|
20:18:23,684 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:18:23,684 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:19:19,414 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:19:19,414 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:19:19,414 packages.buskill DEBUG device:|Bus 001 Device 015: ID ffff:5678|
20:19:19,414 packages.buskill DEBUG event:|2|
20:19:19,414 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:19:19,414 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:19:19,415 packages.buskill INFO INFO: Detected USB removal event
20:19:19,415 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
20:19:19,415 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:19:19,415 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:19:19,435 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:19:19,435 packages.buskill DEBUG DEBUG: subprocess stdout||
20:19:19,436 packages.buskill DEBUG DEBUG: subprocess stderr||
20:19:25,754 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:19:25,755 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:19:25,755 packages.buskill DEBUG device:|Bus 001 Device 016: ID ffff:5678|
20:19:25,755 packages.buskill DEBUG event:|1|
20:19:25,756 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:19:25,756 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:20:06,759 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:20:06,759 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:20:06,759 packages.buskill DEBUG device:|Bus 001 Device 016: ID ffff:5678|
20:20:06,759 packages.buskill DEBUG event:|2|
20:20:06,759 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:20:06,759 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:20:06,759 packages.buskill INFO INFO: Detected USB removal event
20:20:06,759 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
20:20:06,759 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:20:06,759 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:20:06,785 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:20:06,785 packages.buskill DEBUG DEBUG: subprocess stdout||
20:20:06,785 packages.buskill DEBUG DEBUG: subprocess stderr||
20:20:15,480 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:20:15,480 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:20:15,480 packages.buskill DEBUG device:|Bus 001 Device 017: ID ffff:5678|
20:20:15,481 packages.buskill DEBUG event:|1|
20:20:15,481 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:20:15,481 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:21:55,160 packages.buskill DEBUG DEBUG: attempting to disarm BusKill
20:21:55,169 packages.buskill INFO INFO: BusKill is disarmed.
20:21:58,229 packages.buskill DEBUG DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7f1684d46f50>>()
20:21:58,235 packages.buskill INFO INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
20:21:58,239 kivy WARNING stderr: [INFO/Process-2] child process calling self.run()
20:21:58,255 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:21:58,255 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:21:58,255 packages.buskill DEBUG device:|Bus 002 Device 001: ID 1d6b:0003|
20:21:58,255 packages.buskill DEBUG event:|1|
20:21:58,256 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:21:58,256 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:21:58,256 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:21:58,256 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:21:58,256 packages.buskill DEBUG device:|Bus 001 Device 005: ID 0408:a060|
20:21:58,256 packages.buskill DEBUG event:|1|
20:21:58,256 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:21:58,256 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:21:58,257 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:21:58,257 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:21:58,257 packages.buskill DEBUG device:|Bus 001 Device 004: ID 04ca:3016|
20:21:58,257 packages.buskill DEBUG event:|1|
20:21:58,257 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:21:58,257 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:21:58,257 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:21:58,257 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:21:58,257 packages.buskill DEBUG device:|Bus 001 Device 003: ID 30fa:0400|
20:21:58,257 packages.buskill DEBUG event:|1|
20:21:58,257 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:21:58,257 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:21:58,257 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:21:58,257 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:21:58,258 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
20:21:58,258 packages.buskill DEBUG event:|1|
20:21:58,258 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:21:58,258 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:21:58,258 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:21:58,258 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:21:58,258 packages.buskill DEBUG device:|Bus 001 Device 017: ID ffff:5678|
20:21:58,258 packages.buskill DEBUG event:|1|
20:21:58,258 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:21:58,258 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:21:58,258 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:21:58,258 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:21:58,258 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
20:21:58,258 packages.buskill DEBUG event:|1|
20:21:58,258 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:21:58,258 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:22:00,500 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:22:00,500 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:22:00,500 packages.buskill DEBUG device:|Bus 001 Device 017: ID ffff:5678|
20:22:00,500 packages.buskill DEBUG event:|2|
20:22:00,500 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:22:00,500 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:22:00,500 packages.buskill INFO INFO: Detected USB removal event
20:22:00,500 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f1684d46f50>>
20:22:00,500 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:22:00,500 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:22:00,523 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:22:00,523 packages.buskill DEBUG DEBUG: subprocess stdout||
20:22:00,523 packages.buskill DEBUG DEBUG: subprocess stderr||
20:22:03,238 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:22:03,238 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f1697845510>|
20:22:03,239 packages.buskill DEBUG device:|Bus 001 Device 018: ID ffff:5678|
20:22:03,239 packages.buskill DEBUG event:|1|
20:22:03,239 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:22:03,240 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:26:31,798 kivy INFO [WindowSDL   ] exiting mainloop and closing.
20:26:31,849 kivy INFO [Base        ] Leaving application in progress...
20:26:31,849 kivy WARNING stderr: [INFO/MainProcess] process shutting down
20:26:31,849 kivy WARNING stderr: [DEBUG/MainProcess] running all "atexit" finalizers with priority >= 0
20:26:31,849 kivy WARNING stderr: [DEBUG/MainProcess] running the remaining "atexit" finalizers
20:55:13,446 root INFO ===============================================================================
20:55:13,447 root INFO INFO: Writing to log file '/tmp/buskill.log'
20:55:13,447 root DEBUG BUSKILL_VERSION|{'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}|
20:55:13,447 root DEBUG os.environ|environ({'PYTHONHOME': '/tmp/.mount_buskilrsEn5E/opt/python3.7', 'SHELL': '/bin/bash', 'SESSION_MANAGER': 'local/goldishlaser-Predator-G3-571:@/tmp/.ICE-unix/1191,unix/goldishlaser-Predator-G3-571:/tmp/.ICE-unix/1191', 'QT_ACCESSIBILITY': '1', 'XDG_CONFIG_DIRS': '/etc/xdg/xdg-cinnamon:/etc/xdg', 'XDG_SESSION_PATH': '/org/freedesktop/DisplayManager/Session0', 'GNOME_DESKTOP_SESSION_ID': 'this-is-deprecated', 'TK_LIBRARY': '/tmp/.mount_buskilrsEn5E/usr/share/tcltk/tk8.5', 'LANGUAGE': 'en_US', 'MANDATORY_PATH': '/usr/share/gconf/cinnamon.mandatory.path', 'TKPATH': '/tmp/.mount_buskilrsEn5E/usr/share/tcltk/tk8.5', 'SSH_AUTH_SOCK': '/run/user/1000/keyring/ssh', 'ARGV0': '/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64/buskill-.AppImage', 'DESKTOP_SESSION': 'cinnamon', 'SSH_AGENT_PID': '1261', 'GTK_MODULES': 'gail:atk-bridge', 'XDG_SEAT': 'seat0', 'PWD': '/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64', 'XDG_SESSION_DESKTOP': 'cinnamon', 'LOGNAME': 'goldishlaser', 'QT_QPA_PLATFORMTHEME': 'qt5ct', 'XDG_SESSION_TYPE': 'x11', 'GPG_AGENT_INFO': '/run/user/1000/gnupg/S.gpg-agent:0:1', 'XAUTHORITY': '/home/goldishlaser/.Xauthority', 'XDG_GREETER_DATA_DIR': '/var/lib/lightdm-data/goldishlaser', 'GDM_LANG': 'en_US', 'INSIDE_NEMO_PYTHON': '', 'HOME': '/home/goldishlaser', 'LANG': 'en_US.UTF-8', 'XDG_CURRENT_DESKTOP': 'X-Cinnamon', 'XDG_SEAT_PATH': '/org/freedesktop/DisplayManager/Seat0', 'APPDIR': '/tmp/.mount_buskilrsEn5E', 'XDG_SESSION_CLASS': 'user', 'GTK_OVERLAY_SCROLLING': '1', 'DEFAULTS_PATH': '/usr/share/gconf/cinnamon.default.path', 'USER': 'goldishlaser', 'OWD': '/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64', 'DISPLAY': ':0', 'SHLVL': '1', 'XDG_VTNR': '7', 'XDG_SESSION_ID': 'c2', 'APPIMAGE': '/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64/buskill-.AppImage', 'XDG_RUNTIME_DIR': '/run/user/1000', 'TCL_LIBRARY': '/tmp/.mount_buskilrsEn5E/usr/share/tcltk/tcl8.5', 'GTK3_MODULES': 'xapp-gtk3-module', 'XDG_DATA_DIRS': '/usr/share/cinnamon:/usr/share/gnome:/home/goldishlaser/.local/share/flatpak/exports/share:/var/lib/flatpak/exports/share:/usr/local/share:/usr/share', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin', 'GDMSESSION': 'cinnamon', 'DBUS_SESSION_BUS_ADDRESS': 'unix:path=/run/user/1000/bus', 'GIO_LAUNCHED_DESKTOP_FILE_PID': '72624', 'GIO_LAUNCHED_DESKTOP_FILE': '/usr/share/applications/nemo.desktop'})|
20:55:13,447 root DEBUG sys.argv|['/tmp/.mount_buskilrsEn5E/opt/src/main.py']|
20:55:13,447 root DEBUG sys.builtin_modules_names|('_abc', '_ast', '_codecs', '_collections', '_functools', '_imp', '_io', '_locale', '_operator', '_signal', '_sre', '_stat', '_string', '_symtable', '_thread', '_tracemalloc', '_warnings', '_weakref', 'atexit', 'builtins', 'errno', 'faulthandler', 'gc', 'itertools', 'marshal', 'posix', 'pwd', 'sys', 'time', 'xxsubtype', 'zipimport')|
20:55:13,447 root DEBUG sys.executable|/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64/buskill-.AppImage|
20:55:13,447 root DEBUG sys.path|['/tmp/.mount_buskilrsEn5E/opt/src', '/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python37.zip', '/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7', '/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/lib-dynload', '/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/site-packages']|
20:55:13,447 root DEBUG sys.prefix|/tmp/.mount_buskilrsEn5E/opt/python3.7|
20:55:13,447 root DEBUG sys.version|3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]|
20:55:13,447 root DEBUG sys.api_version|1013|
20:55:13,447 root DEBUG sys.version_info|sys.version_info(major=3, minor=7, micro=8, releaselevel='final', serial=0)|
20:55:13,447 root DEBUG __name__|__main__|
20:55:13,447 root DEBUG sys.platform|linux|
20:55:13,448 root DEBUG platform.platform()|Linux-5.4.0-144-generic-x86_64-with-debian-bullseye-sid|
20:55:13,448 root DEBUG platform.system()|Linux|
20:55:13,448 root DEBUG platform.release()|5.4.0-144-generic|
20:55:13,448 root DEBUG platform.version()|#161-Ubuntu SMP Fri Feb 3 14:49:04 UTC 2023|
20:55:13,448 root DEBUG platform.machine()|x86_64|
20:55:13,448 root DEBUG NAME="Linux Mint"
VERSION="20.3 (Una)"
ID=linuxmint
ID_LIKE=ubuntu
PRETTY_NAME="Linux Mint 20.3"
VERSION_ID="20.3"
HOME_URL="https://www.linuxmint.com/"
SUPPORT_URL="https://forums.linuxmint.com/"
BUG_REPORT_URL="http://linuxmint-troubleshooting-guide.readthedocs.io/en/latest/"
PRIVACY_POLICY_URL="https://www.linuxmint.com/"
VERSION_CODENAME=una
UBUNTU_CODENAME=focal

20:55:13,448 root INFO buskill version {'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}
20:55:13,684 packages.buskill DEBUG usb1.__version__:|3.0.0|
20:55:13,730 kivy INFO [Logger      ] Record log in /home/goldishlaser/.kivy/logs/kivy_23-03-23_0.txt
20:55:13,730 kivy INFO [Kivy        ] v1.11.1
20:55:13,730 kivy INFO [Kivy        ] Installed at "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/site-packages/kivy/__init__.py"
20:55:13,731 kivy INFO [Python      ] v3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]
20:55:13,731 kivy INFO [Python      ] Interpreter at "/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64/buskill-.AppImage"
20:55:13,776 kivy INFO [Factory     ] 184 symbols loaded
20:55:13,903 kivy INFO [Image       ] Providers: img_tex, img_dds, img_sdl2, img_gif (img_pil, img_ffpyplayer ignored)
20:55:14,104 kivy INFO [Window      ] Provider: sdl2(['window_egl_rpi'] ignored)
20:55:14,296 kivy INFO [GL          ] Using the "OpenGL" graphics system
20:55:14,297 kivy INFO [GL          ] Backend used <sdl2>
20:55:14,297 kivy INFO [GL          ] OpenGL version <b'4.6 (Compatibility Profile) Mesa 21.2.6'>
20:55:14,297 kivy INFO [GL          ] OpenGL vendor <b'Intel'>
20:55:14,298 kivy INFO [GL          ] OpenGL renderer <b'Mesa Intel(R) HD Graphics 630 (KBL GT2)'>
20:55:14,298 kivy INFO [GL          ] OpenGL parsed version: 4, 6
20:55:14,298 kivy INFO [GL          ] Shading version <b'4.60'>
20:55:14,298 kivy INFO [GL          ] Texture max size <16384>
20:55:14,298 kivy INFO [GL          ] Texture max units <32>
20:55:14,328 kivy INFO [Window      ] auto add sdl2 input provider
20:55:14,331 kivy INFO [Window      ] virtual keyboard not allowed, single mode, not docked
20:55:14,370 kivy INFO [Clipboard   ] Provider: sdl2(['clipboard_xclip', 'clipboard_xsel', 'clipboard_dbusklipper', 'clipboard_gtk3'] ignored)
20:55:14,380 kivy CRITICAL [Cutbuffer   ] Unable to find any valuable Cutbuffer provider. Please enable debug logging (e.g. add -d if running from the command line, or change the log level in the config) and re-run your app to identify potential causes
xclip - FileNotFoundError: [Errno 2] No such file or directory: 'xclip': 'xclip'
  File "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xclip.py", line 17, in <module>
    p = subprocess.Popen(['xclip', '-version'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

xsel - FileNotFoundError: [Errno 2] No such file or directory: 'xsel': 'xsel'
  File "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xsel.py", line 16, in <module>
    p = subprocess.Popen(['xsel'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilrsEn5E/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

20:55:14,402 kivy INFO [Text        ] Provider: sdl2
20:55:14,430 packages.buskill DEBUG DEBUG: EXECUTED_AS_SCRIPT:|False|
DEBUG: EXE_PATH:|/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64/buskill-.AppImage|
DEBUG: EXE_DIR:|/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64|
DEBUG: EXE_FILE:|buskill-.AppImage|
DEBUG: APP_DIR:|/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64|
DEBUG: APPS_DIR:|/home/goldishlaser/Downloads/BUSKILL/.buskill|
DEBUG: SRC_DIR:|/tmp/.mount_buskilrsEn5E/opt/src|
DEBUG: os.environ['PATH']:|/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin:/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64:/home/goldishlaser/Downloads/BUSKILL/.buskill/buskill-lin--x86_64|

20:55:14,430 packages.buskill INFO INFO: using DATA_DIR:|/home/goldishlaser/Downloads/BUSKILL/.buskill/.buskill|
20:55:14,503 kivy INFO [GL          ] NPOT texture support is available
20:55:14,758 kivy INFO [ProbeSysfs  ] device match: /dev/input/event15
20:55:14,759 kivy INFO [MTD         ] Read event from </dev/input/event15>
20:55:14,759 kivy INFO [Base        ] Start application main loop
20:55:14,769 kivy WARNING [MTD         ] Unable to open device "/dev/input/event15". Please ensure you have the appropriate permissions.
20:55:14,789 kivy INFO [GL          ] Unpack subimage support is available
20:55:16,345 packages.buskill DEBUG DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7fc78b967790>>()
20:55:16,356 packages.buskill INFO INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
20:55:16,359 kivy WARNING stderr: [INFO/Process-1] child process calling self.run()
20:55:16,381 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:16,382 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:16,382 packages.buskill DEBUG device:|Bus 002 Device 001: ID 1d6b:0003|
20:55:16,382 packages.buskill DEBUG event:|1|
20:55:16,382 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:16,382 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:16,382 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:16,382 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:16,382 packages.buskill DEBUG device:|Bus 001 Device 005: ID 0408:a060|
20:55:16,382 packages.buskill DEBUG event:|1|
20:55:16,382 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:16,383 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:16,383 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:16,383 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:16,383 packages.buskill DEBUG device:|Bus 001 Device 004: ID 04ca:3016|
20:55:16,383 packages.buskill DEBUG event:|1|
20:55:16,383 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:16,383 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:16,383 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:16,383 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:16,383 packages.buskill DEBUG device:|Bus 001 Device 003: ID 30fa:0400|
20:55:16,383 packages.buskill DEBUG event:|1|
20:55:16,384 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:16,384 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:16,384 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:16,384 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:16,384 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
20:55:16,384 packages.buskill DEBUG event:|1|
20:55:16,384 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:16,384 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:16,384 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:16,384 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:16,384 packages.buskill DEBUG device:|Bus 001 Device 018: ID ffff:5678|
20:55:16,384 packages.buskill DEBUG event:|1|
20:55:16,385 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:16,385 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:16,385 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:16,385 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:16,385 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
20:55:16,385 packages.buskill DEBUG event:|1|
20:55:16,385 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:16,385 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:19,235 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:19,235 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:19,235 packages.buskill DEBUG device:|Bus 001 Device 018: ID ffff:5678|
20:55:19,235 packages.buskill DEBUG event:|2|
20:55:19,235 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:19,235 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:19,235 packages.buskill INFO INFO: Detected USB removal event
20:55:19,236 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc78b967790>>
20:55:19,236 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:55:19,236 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:55:19,261 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:55:19,262 packages.buskill DEBUG DEBUG: subprocess stdout||
20:55:19,262 packages.buskill DEBUG DEBUG: subprocess stderr||
20:55:25,511 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:25,511 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:25,511 packages.buskill DEBUG device:|Bus 001 Device 019: ID ffff:5678|
20:55:25,511 packages.buskill DEBUG event:|1|
20:55:25,512 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:25,512 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:39,971 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:55:39,971 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:55:39,971 packages.buskill DEBUG device:|Bus 001 Device 019: ID ffff:5678|
20:55:39,971 packages.buskill DEBUG event:|2|
20:55:39,971 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:55:39,971 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:55:39,972 packages.buskill INFO INFO: Detected USB removal event
20:55:39,972 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc78b967790>>
20:55:39,972 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:55:39,972 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:55:40,2 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:55:40,2 packages.buskill DEBUG DEBUG: subprocess stdout||
20:55:40,2 packages.buskill DEBUG DEBUG: subprocess stderr||
20:57:32,240 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:57:32,241 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:57:32,241 packages.buskill DEBUG device:|Bus 001 Device 028: ID ffff:5678|
20:57:32,241 packages.buskill DEBUG event:|1|
20:57:32,241 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:57:32,241 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:57:40,797 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:57:40,797 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:57:40,797 packages.buskill DEBUG device:|Bus 001 Device 028: ID ffff:5678|
20:57:40,797 packages.buskill DEBUG event:|2|
20:57:40,797 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:57:40,798 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:57:40,798 packages.buskill INFO INFO: Detected USB removal event
20:57:40,798 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc78b967790>>
20:57:40,798 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
20:57:40,798 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
20:57:40,834 packages.buskill DEBUG DEBUG: subprocess returncode|0|
20:57:40,835 packages.buskill DEBUG DEBUG: subprocess stdout||
20:57:40,835 packages.buskill DEBUG DEBUG: subprocess stderr||
20:57:43,923 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
20:57:43,924 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
20:57:43,924 packages.buskill DEBUG device:|Bus 001 Device 029: ID ffff:5678|
20:57:43,924 packages.buskill DEBUG event:|1|
20:57:43,925 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
20:57:43,925 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
20:57:52,321 buskill_gui DEBUG DEBUG: User switched to 'DebugLog' screen
20:57:57,378 buskill_gui DEBUG DEBUG: User copied contents of 'DebugLog' to clipboard
20:59:41,830 buskill_gui DEBUG DEBUG: Opening URL in webbrowser = https://docs.buskill.in/buskill-app/en/stable/support.html
21:00:40,827 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:00:40,827 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:00:40,827 packages.buskill DEBUG device:|Bus 001 Device 029: ID ffff:5678|
21:00:40,827 packages.buskill DEBUG event:|2|
21:00:40,827 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:00:40,827 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:00:40,827 packages.buskill INFO INFO: Detected USB removal event
21:00:40,827 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc78b967790>>
21:00:40,828 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:00:40,828 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:00:40,852 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:00:40,852 packages.buskill DEBUG DEBUG: subprocess stdout||
21:00:40,852 packages.buskill DEBUG DEBUG: subprocess stderr||
21:00:46,161 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:00:46,162 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:00:46,163 packages.buskill DEBUG device:|Bus 001 Device 030: ID ffff:5678|
21:00:46,163 packages.buskill DEBUG event:|1|
21:00:46,163 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:00:46,164 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:23,278 packages.buskill DEBUG DEBUG: attempting to disarm BusKill
21:02:23,293 packages.buskill INFO INFO: BusKill is disarmed.
21:02:24,238 packages.buskill DEBUG DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7fc78b967790>>()
21:02:24,244 packages.buskill INFO INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
21:02:24,248 kivy WARNING stderr: [INFO/Process-2] child process calling self.run()
21:02:24,266 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:24,266 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:24,267 packages.buskill DEBUG device:|Bus 002 Device 001: ID 1d6b:0003|
21:02:24,267 packages.buskill DEBUG event:|1|
21:02:24,267 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:24,267 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:24,267 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:24,267 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:24,267 packages.buskill DEBUG device:|Bus 001 Device 005: ID 0408:a060|
21:02:24,267 packages.buskill DEBUG event:|1|
21:02:24,267 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:24,267 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:24,267 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:24,268 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:24,268 packages.buskill DEBUG device:|Bus 001 Device 004: ID 04ca:3016|
21:02:24,268 packages.buskill DEBUG event:|1|
21:02:24,268 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:24,268 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:24,268 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:24,268 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:24,268 packages.buskill DEBUG device:|Bus 001 Device 003: ID 30fa:0400|
21:02:24,268 packages.buskill DEBUG event:|1|
21:02:24,268 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:24,268 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:24,268 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:24,269 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:24,269 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
21:02:24,269 packages.buskill DEBUG event:|1|
21:02:24,269 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:24,269 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:24,269 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:24,269 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:24,269 packages.buskill DEBUG device:|Bus 001 Device 030: ID ffff:5678|
21:02:24,269 packages.buskill DEBUG event:|1|
21:02:24,269 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:24,269 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:24,269 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:24,269 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:24,269 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
21:02:24,270 packages.buskill DEBUG event:|1|
21:02:24,270 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:24,270 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:26,998 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:26,999 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:26,999 packages.buskill DEBUG device:|Bus 001 Device 030: ID ffff:5678|
21:02:26,999 packages.buskill DEBUG event:|2|
21:02:26,999 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:26,999 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:26,999 packages.buskill INFO INFO: Detected USB removal event
21:02:26,999 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc78b967790>>
21:02:26,999 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:02:26,999 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:02:27,32 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:02:27,32 packages.buskill DEBUG DEBUG: subprocess stdout||
21:02:27,32 packages.buskill DEBUG DEBUG: subprocess stderr||
21:02:33,50 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:02:33,51 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:02:33,51 packages.buskill DEBUG device:|Bus 001 Device 031: ID ffff:5678|
21:02:33,51 packages.buskill DEBUG event:|1|
21:02:33,51 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:02:33,52 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:02:39,726 buskill_gui DEBUG DEBUG: User switched to 'DebugLog' screen
21:02:41,219 buskill_gui DEBUG DEBUG: User copied contents of 'DebugLog' to clipboard
21:14:18,622 root INFO ===============================================================================
21:14:18,623 root INFO INFO: Writing to log file '/tmp/buskill.log'
21:14:18,623 root DEBUG BUSKILL_VERSION|{'VERSION': 'v0.6.0', 'GITHUB_REF': 'refs/heads/v0.6.0', 'GITHUB_SHA': 'e2242e2bcf5bcf67301be0011e79c4001676cb9c', 'SOURCE_DATE_EPOCH': '1666580582'}|
21:14:18,623 root DEBUG os.environ|environ({'PYTHONHOME': '/tmp/.mount_buskilDXA5cy/opt/python3.7', 'SHELL': '/bin/bash', 'SESSION_MANAGER': 'local/goldishlaser-Predator-G3-571:@/tmp/.ICE-unix/1191,unix/goldishlaser-Predator-G3-571:/tmp/.ICE-unix/1191', 'QT_ACCESSIBILITY': '1', 'XDG_CONFIG_DIRS': '/etc/xdg/xdg-cinnamon:/etc/xdg', 'XDG_SESSION_PATH': '/org/freedesktop/DisplayManager/Session0', 'GNOME_DESKTOP_SESSION_ID': 'this-is-deprecated', 'TK_LIBRARY': '/tmp/.mount_buskilDXA5cy/usr/share/tcltk/tk8.5', 'LANGUAGE': 'en_US', 'MANDATORY_PATH': '/usr/share/gconf/cinnamon.mandatory.path', 'TKPATH': '/tmp/.mount_buskilDXA5cy/usr/share/tcltk/tk8.5', 'SSH_AUTH_SOCK': '/run/user/1000/keyring/ssh', 'ARGV0': '/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64/buskill-v0.6.0.AppImage', 'DESKTOP_SESSION': 'cinnamon', 'SSH_AGENT_PID': '1261', 'GTK_MODULES': 'gail:atk-bridge', 'XDG_SEAT': 'seat0', 'PWD': '/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64', 'XDG_SESSION_DESKTOP': 'cinnamon', 'LOGNAME': 'goldishlaser', 'QT_QPA_PLATFORMTHEME': 'qt5ct', 'XDG_SESSION_TYPE': 'x11', 'GPG_AGENT_INFO': '/run/user/1000/gnupg/S.gpg-agent:0:1', 'XAUTHORITY': '/home/goldishlaser/.Xauthority', 'XDG_GREETER_DATA_DIR': '/var/lib/lightdm-data/goldishlaser', 'GDM_LANG': 'en_US', 'INSIDE_NEMO_PYTHON': '', 'HOME': '/home/goldishlaser', 'LANG': 'en_US.UTF-8', 'XDG_CURRENT_DESKTOP': 'X-Cinnamon', 'XDG_SEAT_PATH': '/org/freedesktop/DisplayManager/Seat0', 'APPDIR': '/tmp/.mount_buskilDXA5cy', 'XDG_SESSION_CLASS': 'user', 'GTK_OVERLAY_SCROLLING': '1', 'DEFAULTS_PATH': '/usr/share/gconf/cinnamon.default.path', 'USER': 'goldishlaser', 'OWD': '/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64', 'DISPLAY': ':0', 'SHLVL': '1', 'XDG_VTNR': '7', 'XDG_SESSION_ID': 'c2', 'APPIMAGE': '/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64/buskill-v0.6.0.AppImage', 'XDG_RUNTIME_DIR': '/run/user/1000', 'TCL_LIBRARY': '/tmp/.mount_buskilDXA5cy/usr/share/tcltk/tcl8.5', 'GTK3_MODULES': 'xapp-gtk3-module', 'XDG_DATA_DIRS': '/usr/share/cinnamon:/usr/share/gnome:/home/goldishlaser/.local/share/flatpak/exports/share:/var/lib/flatpak/exports/share:/usr/local/share:/usr/share', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin', 'GDMSESSION': 'cinnamon', 'DBUS_SESSION_BUS_ADDRESS': 'unix:path=/run/user/1000/bus', 'GIO_LAUNCHED_DESKTOP_FILE_PID': '74236', 'GIO_LAUNCHED_DESKTOP_FILE': '/usr/share/applications/nemo.desktop'})|
21:14:18,623 root DEBUG sys.argv|['/tmp/.mount_buskilDXA5cy/opt/src/main.py']|
21:14:18,623 root DEBUG sys.builtin_modules_names|('_abc', '_ast', '_codecs', '_collections', '_functools', '_imp', '_io', '_locale', '_operator', '_signal', '_sre', '_stat', '_string', '_symtable', '_thread', '_tracemalloc', '_warnings', '_weakref', 'atexit', 'builtins', 'errno', 'faulthandler', 'gc', 'itertools', 'marshal', 'posix', 'pwd', 'sys', 'time', 'xxsubtype', 'zipimport')|
21:14:18,623 root DEBUG sys.executable|/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64/buskill-v0.6.0.AppImage|
21:14:18,623 root DEBUG sys.path|['/tmp/.mount_buskilDXA5cy/opt/src', '/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python37.zip', '/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7', '/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/lib-dynload', '/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/site-packages']|
21:14:18,623 root DEBUG sys.prefix|/tmp/.mount_buskilDXA5cy/opt/python3.7|
21:14:18,623 root DEBUG sys.version|3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]|
21:14:18,623 root DEBUG sys.api_version|1013|
21:14:18,623 root DEBUG sys.version_info|sys.version_info(major=3, minor=7, micro=8, releaselevel='final', serial=0)|
21:14:18,623 root DEBUG __name__|__main__|
21:14:18,624 root DEBUG sys.platform|linux|
21:14:18,624 root DEBUG platform.platform()|Linux-5.4.0-144-generic-x86_64-with-debian-bullseye-sid|
21:14:18,624 root DEBUG platform.system()|Linux|
21:14:18,624 root DEBUG platform.release()|5.4.0-144-generic|
21:14:18,624 root DEBUG platform.version()|#161-Ubuntu SMP Fri Feb 3 14:49:04 UTC 2023|
21:14:18,624 root DEBUG platform.machine()|x86_64|
21:14:18,624 root DEBUG NAME="Linux Mint"
VERSION="20.3 (Una)"
ID=linuxmint
ID_LIKE=ubuntu
PRETTY_NAME="Linux Mint 20.3"
VERSION_ID="20.3"
HOME_URL="https://www.linuxmint.com/"
SUPPORT_URL="https://forums.linuxmint.com/"
BUG_REPORT_URL="http://linuxmint-troubleshooting-guide.readthedocs.io/en/latest/"
PRIVACY_POLICY_URL="https://www.linuxmint.com/"
VERSION_CODENAME=una
UBUNTU_CODENAME=focal

21:14:18,624 root INFO buskill version {'VERSION': 'v0.6.0', 'GITHUB_REF': 'refs/heads/v0.6.0', 'GITHUB_SHA': 'e2242e2bcf5bcf67301be0011e79c4001676cb9c', 'SOURCE_DATE_EPOCH': '1666580582'}
21:14:18,858 packages.buskill DEBUG usb1.__version__:|3.0.0|
21:14:18,906 kivy INFO [Logger      ] Record log in /home/goldishlaser/.kivy/logs/kivy_23-03-23_1.txt
21:14:18,905 kivy INFO [Kivy        ] v1.11.1
21:14:18,906 kivy INFO [Kivy        ] Installed at "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/site-packages/kivy/__init__.py"
21:14:18,906 kivy INFO [Python      ] v3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]
21:14:18,906 kivy INFO [Python      ] Interpreter at "/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64/buskill-v0.6.0.AppImage"
21:14:18,959 kivy INFO [Factory     ] 184 symbols loaded
21:14:19,115 kivy INFO [Image       ] Providers: img_tex, img_dds, img_sdl2, img_gif (img_pil, img_ffpyplayer ignored)
21:14:19,348 kivy INFO [Window      ] Provider: sdl2(['window_egl_rpi'] ignored)
21:14:19,535 kivy INFO [GL          ] Using the "OpenGL" graphics system
21:14:19,536 kivy INFO [GL          ] Backend used <sdl2>
21:14:19,536 kivy INFO [GL          ] OpenGL version <b'4.6 (Compatibility Profile) Mesa 21.2.6'>
21:14:19,536 kivy INFO [GL          ] OpenGL vendor <b'Intel'>
21:14:19,536 kivy INFO [GL          ] OpenGL renderer <b'Mesa Intel(R) HD Graphics 630 (KBL GT2)'>
21:14:19,536 kivy INFO [GL          ] OpenGL parsed version: 4, 6
21:14:19,537 kivy INFO [GL          ] Shading version <b'4.60'>
21:14:19,537 kivy INFO [GL          ] Texture max size <16384>
21:14:19,537 kivy INFO [GL          ] Texture max units <32>
21:14:19,559 kivy INFO [Window      ] auto add sdl2 input provider
21:14:19,561 kivy INFO [Window      ] virtual keyboard not allowed, single mode, not docked
21:14:19,605 kivy INFO [Clipboard   ] Provider: sdl2(['clipboard_xclip', 'clipboard_xsel', 'clipboard_dbusklipper', 'clipboard_gtk3'] ignored)
21:14:19,615 kivy CRITICAL [Cutbuffer   ] Unable to find any valuable Cutbuffer provider. Please enable debug logging (e.g. add -d if running from the command line, or change the log level in the config) and re-run your app to identify potential causes
xclip - FileNotFoundError: [Errno 2] No such file or directory: 'xclip': 'xclip'
  File "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xclip.py", line 17, in <module>
    p = subprocess.Popen(['xclip', '-version'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

xsel - FileNotFoundError: [Errno 2] No such file or directory: 'xsel': 'xsel'
  File "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xsel.py", line 16, in <module>
    p = subprocess.Popen(['xsel'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilDXA5cy/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

21:14:19,638 kivy INFO [Text        ] Provider: sdl2
21:14:19,664 packages.buskill DEBUG DEBUG: EXECUTED_AS_SCRIPT:|False|
DEBUG: EXE_PATH:|/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64/buskill-v0.6.0.AppImage|
DEBUG: EXE_DIR:|/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64|
DEBUG: EXE_FILE:|buskill-v0.6.0.AppImage|
DEBUG: APP_DIR:|/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64|
DEBUG: APPS_DIR:|/home/goldishlaser/Downloads/BUSKILL|
DEBUG: SRC_DIR:|/tmp/.mount_buskilDXA5cy/opt/src|
DEBUG: os.environ['PATH']:|/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin:/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64:/home/goldishlaser/Downloads/BUSKILL/buskill-lin-v0.6.0-x86_64|

21:14:19,665 packages.buskill INFO INFO: using DATA_DIR:|/home/goldishlaser/Downloads/BUSKILL/.buskill|
21:14:19,738 kivy INFO [GL          ] NPOT texture support is available
21:14:19,973 kivy INFO [ProbeSysfs  ] device match: /dev/input/event15
21:14:19,974 kivy INFO [MTD         ] Read event from </dev/input/event15>
21:14:19,974 kivy INFO [Base        ] Start application main loop
21:14:19,975 kivy WARNING [MTD         ] Unable to open device "/dev/input/event15". Please ensure you have the appropriate permissions.
21:14:20,31 kivy INFO [GL          ] Unpack subimage support is available
21:14:21,430 packages.buskill DEBUG DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7fdc10774fd0>>()
21:14:21,442 packages.buskill INFO INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
21:14:21,446 kivy WARNING stderr: [INFO/Process-1] child process calling self.run()
21:14:21,466 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:21,467 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:21,467 packages.buskill DEBUG device:|Bus 002 Device 001: ID 1d6b:0003|
21:14:21,467 packages.buskill DEBUG event:|1|
21:14:21,467 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:21,467 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:21,467 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:21,467 packages.buskill DEBUG device:|Bus 001 Device 005: ID 0408:a060|
21:14:21,467 packages.buskill DEBUG event:|1|
21:14:21,467 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:21,467 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:21,467 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:21,468 packages.buskill DEBUG device:|Bus 001 Device 004: ID 04ca:3016|
21:14:21,468 packages.buskill DEBUG event:|1|
21:14:21,468 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:21,468 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:21,468 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:21,468 packages.buskill DEBUG device:|Bus 001 Device 003: ID 30fa:0400|
21:14:21,468 packages.buskill DEBUG event:|1|
21:14:21,468 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:21,468 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:21,469 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:21,469 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
21:14:21,469 packages.buskill DEBUG event:|1|
21:14:21,469 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:21,470 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:21,470 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:21,470 packages.buskill DEBUG device:|Bus 001 Device 031: ID ffff:5678|
21:14:21,470 packages.buskill DEBUG event:|1|
21:14:21,470 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:21,470 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:21,470 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:21,470 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
21:14:21,470 packages.buskill DEBUG event:|1|
21:14:21,470 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:23,139 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:23,139 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:23,140 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:14:23,140 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:23,140 packages.buskill DEBUG device:|Bus 001 Device 031: ID ffff:5678|
21:14:23,140 packages.buskill DEBUG device:|Bus 001 Device 031: ID ffff:5678|
21:14:23,140 packages.buskill DEBUG event:|2|
21:14:23,140 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:14:23,140 packages.buskill DEBUG event:|2|
21:14:23,140 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:23,140 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:23,140 packages.buskill INFO INFO: Detected USB removal event
21:14:23,140 packages.buskill INFO INFO: Detected USB removal event
21:14:23,140 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc78b967790>>
21:14:23,140 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fdc10774fd0>>
21:14:23,140 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:14:23,140 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:14:23,140 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:14:23,140 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:14:23,170 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:14:23,170 packages.buskill DEBUG DEBUG: subprocess stdout||
21:14:23,170 packages.buskill DEBUG DEBUG: subprocess stderr||
21:14:23,174 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:14:23,174 packages.buskill DEBUG DEBUG: subprocess stdout||
21:14:23,174 packages.buskill DEBUG DEBUG: subprocess stderr||
21:14:25,732 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:25,732 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:14:25,732 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc793f6b450>|
21:14:25,732 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fdc12c76450>|
21:14:25,733 packages.buskill DEBUG device:|Bus 001 Device 032: ID ffff:5678|
21:14:25,733 packages.buskill DEBUG device:|Bus 001 Device 032: ID ffff:5678|
21:14:25,733 packages.buskill DEBUG event:|1|
21:14:25,733 packages.buskill DEBUG event:|1|
21:14:25,733 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:25,733 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:14:25,733 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:14:31,251 kivy INFO [WindowSDL   ] exiting mainloop and closing.
21:14:31,310 kivy INFO [Base        ] Leaving application in progress...
21:14:31,311 kivy WARNING stderr: [INFO/MainProcess] process shutting down
21:14:31,311 kivy WARNING stderr: [DEBUG/MainProcess] running all "atexit" finalizers with priority >= 0
21:14:31,311 kivy WARNING stderr: [DEBUG/MainProcess] running the remaining "atexit" finalizers
21:14:33,177 kivy INFO [WindowSDL   ] exiting mainloop and closing.
21:14:33,211 kivy INFO [Base        ] Leaving application in progress...
21:14:33,212 kivy WARNING stderr: [INFO/MainProcess] process shutting down
21:14:33,213 kivy WARNING stderr: [DEBUG/MainProcess] running all "atexit" finalizers with priority >= 0
21:14:33,213 kivy WARNING stderr: [DEBUG/MainProcess] running the remaining "atexit" finalizers
21:15:26,585 root INFO ===============================================================================
21:15:26,585 root INFO INFO: Writing to log file '/tmp/buskill.log'
21:15:26,585 root DEBUG BUSKILL_VERSION|{'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}|
21:15:26,586 root DEBUG os.environ|environ({'PYTHONHOME': '/tmp/.mount_buskilhxmmLE/opt/python3.7', 'SHELL': '/bin/bash', 'SESSION_MANAGER': 'local/goldishlaser-Predator-G3-571:@/tmp/.ICE-unix/1191,unix/goldishlaser-Predator-G3-571:/tmp/.ICE-unix/1191', 'QT_ACCESSIBILITY': '1', 'XDG_CONFIG_DIRS': '/etc/xdg/xdg-cinnamon:/etc/xdg', 'XDG_SESSION_PATH': '/org/freedesktop/DisplayManager/Session0', 'GNOME_DESKTOP_SESSION_ID': 'this-is-deprecated', 'TK_LIBRARY': '/tmp/.mount_buskilhxmmLE/usr/share/tcltk/tk8.5', 'LANGUAGE': 'en_US', 'MANDATORY_PATH': '/usr/share/gconf/cinnamon.mandatory.path', 'TKPATH': '/tmp/.mount_buskilhxmmLE/usr/share/tcltk/tk8.5', 'SSH_AUTH_SOCK': '/run/user/1000/keyring/ssh', 'ARGV0': '/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64/buskill-.AppImage', 'DESKTOP_SESSION': 'cinnamon', 'SSH_AGENT_PID': '1261', 'GTK_MODULES': 'gail:atk-bridge', 'XDG_SEAT': 'seat0', 'PWD': '/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64', 'XDG_SESSION_DESKTOP': 'cinnamon', 'LOGNAME': 'goldishlaser', 'QT_QPA_PLATFORMTHEME': 'qt5ct', 'XDG_SESSION_TYPE': 'x11', 'GPG_AGENT_INFO': '/run/user/1000/gnupg/S.gpg-agent:0:1', 'XAUTHORITY': '/home/goldishlaser/.Xauthority', 'XDG_GREETER_DATA_DIR': '/var/lib/lightdm-data/goldishlaser', 'GDM_LANG': 'en_US', 'INSIDE_NEMO_PYTHON': '', 'HOME': '/home/goldishlaser', 'LANG': 'en_US.UTF-8', 'XDG_CURRENT_DESKTOP': 'X-Cinnamon', 'XDG_SEAT_PATH': '/org/freedesktop/DisplayManager/Seat0', 'APPDIR': '/tmp/.mount_buskilhxmmLE', 'XDG_SESSION_CLASS': 'user', 'GTK_OVERLAY_SCROLLING': '1', 'DEFAULTS_PATH': '/usr/share/gconf/cinnamon.default.path', 'USER': 'goldishlaser', 'OWD': '/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64', 'DISPLAY': ':0', 'SHLVL': '1', 'XDG_VTNR': '7', 'XDG_SESSION_ID': 'c2', 'APPIMAGE': '/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64/buskill-.AppImage', 'XDG_RUNTIME_DIR': '/run/user/1000', 'TCL_LIBRARY': '/tmp/.mount_buskilhxmmLE/usr/share/tcltk/tcl8.5', 'GTK3_MODULES': 'xapp-gtk3-module', 'XDG_DATA_DIRS': '/usr/share/cinnamon:/usr/share/gnome:/home/goldishlaser/.local/share/flatpak/exports/share:/var/lib/flatpak/exports/share:/usr/local/share:/usr/share', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin', 'GDMSESSION': 'cinnamon', 'DBUS_SESSION_BUS_ADDRESS': 'unix:path=/run/user/1000/bus', 'GIO_LAUNCHED_DESKTOP_FILE_PID': '74502', 'GIO_LAUNCHED_DESKTOP_FILE': '/usr/share/applications/nemo.desktop'})|
21:15:26,586 root DEBUG sys.argv|['/tmp/.mount_buskilhxmmLE/opt/src/main.py']|
21:15:26,586 root DEBUG sys.builtin_modules_names|('_abc', '_ast', '_codecs', '_collections', '_functools', '_imp', '_io', '_locale', '_operator', '_signal', '_sre', '_stat', '_string', '_symtable', '_thread', '_tracemalloc', '_warnings', '_weakref', 'atexit', 'builtins', 'errno', 'faulthandler', 'gc', 'itertools', 'marshal', 'posix', 'pwd', 'sys', 'time', 'xxsubtype', 'zipimport')|
21:15:26,586 root DEBUG sys.executable|/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64/buskill-.AppImage|
21:15:26,586 root DEBUG sys.path|['/tmp/.mount_buskilhxmmLE/opt/src', '/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python37.zip', '/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7', '/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/lib-dynload', '/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/site-packages']|
21:15:26,586 root DEBUG sys.prefix|/tmp/.mount_buskilhxmmLE/opt/python3.7|
21:15:26,586 root DEBUG sys.version|3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]|
21:15:26,586 root DEBUG sys.api_version|1013|
21:15:26,586 root DEBUG sys.version_info|sys.version_info(major=3, minor=7, micro=8, releaselevel='final', serial=0)|
21:15:26,586 root DEBUG __name__|__main__|
21:15:26,586 root DEBUG sys.platform|linux|
21:15:26,587 root DEBUG platform.platform()|Linux-5.4.0-144-generic-x86_64-with-debian-bullseye-sid|
21:15:26,587 root DEBUG platform.system()|Linux|
21:15:26,587 root DEBUG platform.release()|5.4.0-144-generic|
21:15:26,587 root DEBUG platform.version()|#161-Ubuntu SMP Fri Feb 3 14:49:04 UTC 2023|
21:15:26,587 root DEBUG platform.machine()|x86_64|
21:15:26,587 root DEBUG NAME="Linux Mint"
VERSION="20.3 (Una)"
ID=linuxmint
ID_LIKE=ubuntu
PRETTY_NAME="Linux Mint 20.3"
VERSION_ID="20.3"
HOME_URL="https://www.linuxmint.com/"
SUPPORT_URL="https://forums.linuxmint.com/"
BUG_REPORT_URL="http://linuxmint-troubleshooting-guide.readthedocs.io/en/latest/"
PRIVACY_POLICY_URL="https://www.linuxmint.com/"
VERSION_CODENAME=una
UBUNTU_CODENAME=focal

21:15:26,587 root INFO buskill version {'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}
21:15:26,804 packages.buskill DEBUG usb1.__version__:|3.0.0|
21:15:26,854 kivy INFO [Logger      ] Record log in /home/goldishlaser/.kivy/logs/kivy_23-03-23_2.txt
21:15:26,854 kivy INFO [Kivy        ] v1.11.1
21:15:26,855 kivy INFO [Kivy        ] Installed at "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/site-packages/kivy/__init__.py"
21:15:26,855 kivy INFO [Python      ] v3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]
21:15:26,855 kivy INFO [Python      ] Interpreter at "/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64/buskill-.AppImage"
21:15:26,898 kivy INFO [Factory     ] 184 symbols loaded
21:15:27,23 kivy INFO [Image       ] Providers: img_tex, img_dds, img_sdl2, img_gif (img_pil, img_ffpyplayer ignored)
21:15:27,227 kivy INFO [Window      ] Provider: sdl2(['window_egl_rpi'] ignored)
21:15:27,435 kivy INFO [GL          ] Using the "OpenGL" graphics system
21:15:27,435 kivy INFO [GL          ] Backend used <sdl2>
21:15:27,436 kivy INFO [GL          ] OpenGL version <b'4.6 (Compatibility Profile) Mesa 21.2.6'>
21:15:27,436 kivy INFO [GL          ] OpenGL vendor <b'Intel'>
21:15:27,436 kivy INFO [GL          ] OpenGL renderer <b'Mesa Intel(R) HD Graphics 630 (KBL GT2)'>
21:15:27,436 kivy INFO [GL          ] OpenGL parsed version: 4, 6
21:15:27,436 kivy INFO [GL          ] Shading version <b'4.60'>
21:15:27,436 kivy INFO [GL          ] Texture max size <16384>
21:15:27,436 kivy INFO [GL          ] Texture max units <32>
21:15:27,458 kivy INFO [Window      ] auto add sdl2 input provider
21:15:27,461 kivy INFO [Window      ] virtual keyboard not allowed, single mode, not docked
21:15:27,499 kivy INFO [Clipboard   ] Provider: sdl2(['clipboard_xclip', 'clipboard_xsel', 'clipboard_dbusklipper', 'clipboard_gtk3'] ignored)
21:15:27,508 kivy CRITICAL [Cutbuffer   ] Unable to find any valuable Cutbuffer provider. Please enable debug logging (e.g. add -d if running from the command line, or change the log level in the config) and re-run your app to identify potential causes
xclip - FileNotFoundError: [Errno 2] No such file or directory: 'xclip': 'xclip'
  File "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xclip.py", line 17, in <module>
    p = subprocess.Popen(['xclip', '-version'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

xsel - FileNotFoundError: [Errno 2] No such file or directory: 'xsel': 'xsel'
  File "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xsel.py", line 16, in <module>
    p = subprocess.Popen(['xsel'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilhxmmLE/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

21:15:27,530 kivy INFO [Text        ] Provider: sdl2
21:15:27,557 packages.buskill DEBUG DEBUG: EXECUTED_AS_SCRIPT:|False|
DEBUG: EXE_PATH:|/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64/buskill-.AppImage|
DEBUG: EXE_DIR:|/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64|
DEBUG: EXE_FILE:|buskill-.AppImage|
DEBUG: APP_DIR:|/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64|
DEBUG: APPS_DIR:|/home/goldishlaser/Downloads/BUSKILL|
DEBUG: SRC_DIR:|/tmp/.mount_buskilhxmmLE/opt/src|
DEBUG: os.environ['PATH']:|/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin:/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64:/home/goldishlaser/Downloads/BUSKILL/buskill-lin--x86_64|

21:15:27,558 packages.buskill INFO INFO: using DATA_DIR:|/home/goldishlaser/Downloads/BUSKILL/.buskill|
21:15:27,634 kivy INFO [GL          ] NPOT texture support is available
21:15:27,825 kivy INFO [ProbeSysfs  ] device match: /dev/input/event15
21:15:27,825 kivy INFO [MTD         ] Read event from </dev/input/event15>
21:15:27,825 kivy INFO [Base        ] Start application main loop
21:15:27,826 kivy WARNING [MTD         ] Unable to open device "/dev/input/event15". Please ensure you have the appropriate permissions.
21:15:27,867 kivy INFO [GL          ] Unpack subimage support is available
21:15:28,816 packages.buskill DEBUG DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7f2b2eccd4d0>>()
21:15:28,832 packages.buskill INFO INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
21:15:28,835 kivy WARNING stderr: [INFO/Process-1] child process calling self.run()
21:15:28,847 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:28,847 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:28,847 packages.buskill DEBUG device:|Bus 002 Device 001: ID 1d6b:0003|
21:15:28,847 packages.buskill DEBUG event:|1|
21:15:28,847 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:28,847 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:28,847 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:28,847 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:28,848 packages.buskill DEBUG device:|Bus 001 Device 005: ID 0408:a060|
21:15:28,848 packages.buskill DEBUG event:|1|
21:15:28,848 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:28,848 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:28,848 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:28,848 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:28,848 packages.buskill DEBUG device:|Bus 001 Device 004: ID 04ca:3016|
21:15:28,848 packages.buskill DEBUG event:|1|
21:15:28,848 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:28,848 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:28,848 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:28,848 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:28,848 packages.buskill DEBUG device:|Bus 001 Device 003: ID 30fa:0400|
21:15:28,848 packages.buskill DEBUG event:|1|
21:15:28,849 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:28,849 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:28,849 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:28,849 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:28,849 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
21:15:28,849 packages.buskill DEBUG event:|1|
21:15:28,849 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:28,849 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:28,849 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:28,849 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:28,849 packages.buskill DEBUG device:|Bus 001 Device 032: ID ffff:5678|
21:15:28,849 packages.buskill DEBUG event:|1|
21:15:28,849 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:28,849 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:28,849 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:28,850 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:28,850 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
21:15:28,850 packages.buskill DEBUG event:|1|
21:15:28,850 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:28,850 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:30,973 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:30,973 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:30,973 packages.buskill DEBUG device:|Bus 001 Device 032: ID ffff:5678|
21:15:30,973 packages.buskill DEBUG event:|2|
21:15:30,973 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:30,973 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:30,973 packages.buskill INFO INFO: Detected USB removal event
21:15:30,973 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f2b2eccd4d0>>
21:15:30,973 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:15:30,973 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:15:31,3 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:15:31,4 packages.buskill DEBUG DEBUG: subprocess stdout||
21:15:31,4 packages.buskill DEBUG DEBUG: subprocess stderr||
21:15:34,494 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:34,495 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:34,495 packages.buskill DEBUG device:|Bus 001 Device 033: ID ffff:5678|
21:15:34,495 packages.buskill DEBUG event:|1|
21:15:34,495 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:34,495 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:40,248 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:40,248 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:40,248 packages.buskill DEBUG device:|Bus 001 Device 033: ID ffff:5678|
21:15:40,248 packages.buskill DEBUG event:|2|
21:15:40,248 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:40,248 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:40,248 packages.buskill INFO INFO: Detected USB removal event
21:15:40,248 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f2b2eccd4d0>>
21:15:40,249 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:15:40,249 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:15:40,288 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:15:40,288 packages.buskill DEBUG DEBUG: subprocess stdout||
21:15:40,288 packages.buskill DEBUG DEBUG: subprocess stderr||
21:15:42,347 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:15:42,348 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f2b31124410>|
21:15:42,348 packages.buskill DEBUG device:|Bus 001 Device 034: ID ffff:5678|
21:15:42,348 packages.buskill DEBUG event:|1|
21:15:42,348 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:15:42,348 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:15:52,911 buskill_gui DEBUG DEBUG: User switched to 'DebugLog' screen
21:15:54,502 buskill_gui DEBUG DEBUG: User copied contents of 'DebugLog' to clipboard
21:18:28,946 root INFO ===============================================================================
21:18:28,946 root INFO INFO: Writing to log file '/tmp/buskill.log'
21:18:28,946 root DEBUG BUSKILL_VERSION|{'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}|
21:18:28,946 root DEBUG os.environ|environ({'PYTHONHOME': '/tmp/.mount_buskilcJ8ClY/opt/python3.7', 'SHELL': '/bin/bash', 'SESSION_MANAGER': 'local/goldishlaser-Predator-G3-571:@/tmp/.ICE-unix/1191,unix/goldishlaser-Predator-G3-571:/tmp/.ICE-unix/1191', 'QT_ACCESSIBILITY': '1', 'XDG_CONFIG_DIRS': '/etc/xdg/xdg-cinnamon:/etc/xdg', 'XDG_SESSION_PATH': '/org/freedesktop/DisplayManager/Session0', 'GNOME_DESKTOP_SESSION_ID': 'this-is-deprecated', 'TK_LIBRARY': '/tmp/.mount_buskilcJ8ClY/usr/share/tcltk/tk8.5', 'LANGUAGE': 'en_US', 'MANDATORY_PATH': '/usr/share/gconf/cinnamon.mandatory.path', 'TKPATH': '/tmp/.mount_buskilcJ8ClY/usr/share/tcltk/tk8.5', 'SSH_AUTH_SOCK': '/run/user/1000/keyring/ssh', 'ARGV0': '/home/goldishlaser/Downloads/buskill-lin--x86_64/buskill-.AppImage', 'DESKTOP_SESSION': 'cinnamon', 'SSH_AGENT_PID': '1261', 'GTK_MODULES': 'gail:atk-bridge', 'XDG_SEAT': 'seat0', 'PWD': '/home/goldishlaser/Downloads/buskill-lin--x86_64', 'XDG_SESSION_DESKTOP': 'cinnamon', 'LOGNAME': 'goldishlaser', 'QT_QPA_PLATFORMTHEME': 'qt5ct', 'XDG_SESSION_TYPE': 'x11', 'GPG_AGENT_INFO': '/run/user/1000/gnupg/S.gpg-agent:0:1', 'XAUTHORITY': '/home/goldishlaser/.Xauthority', 'XDG_GREETER_DATA_DIR': '/var/lib/lightdm-data/goldishlaser', 'GDM_LANG': 'en_US', 'INSIDE_NEMO_PYTHON': '', 'HOME': '/home/goldishlaser', 'LANG': 'en_US.UTF-8', 'XDG_CURRENT_DESKTOP': 'X-Cinnamon', 'XDG_SEAT_PATH': '/org/freedesktop/DisplayManager/Seat0', 'APPDIR': '/tmp/.mount_buskilcJ8ClY', 'XDG_SESSION_CLASS': 'user', 'GTK_OVERLAY_SCROLLING': '1', 'DEFAULTS_PATH': '/usr/share/gconf/cinnamon.default.path', 'USER': 'goldishlaser', 'OWD': '/home/goldishlaser/Downloads/buskill-lin--x86_64', 'DISPLAY': ':0', 'SHLVL': '1', 'XDG_VTNR': '7', 'XDG_SESSION_ID': 'c2', 'APPIMAGE': '/home/goldishlaser/Downloads/buskill-lin--x86_64/buskill-.AppImage', 'XDG_RUNTIME_DIR': '/run/user/1000', 'TCL_LIBRARY': '/tmp/.mount_buskilcJ8ClY/usr/share/tcltk/tcl8.5', 'GTK3_MODULES': 'xapp-gtk3-module', 'XDG_DATA_DIRS': '/usr/share/cinnamon:/usr/share/gnome:/home/goldishlaser/.local/share/flatpak/exports/share:/var/lib/flatpak/exports/share:/usr/local/share:/usr/share', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin', 'GDMSESSION': 'cinnamon', 'DBUS_SESSION_BUS_ADDRESS': 'unix:path=/run/user/1000/bus', 'GIO_LAUNCHED_DESKTOP_FILE_PID': '74916', 'GIO_LAUNCHED_DESKTOP_FILE': '/usr/share/applications/nemo.desktop'})|
21:18:28,946 root DEBUG sys.argv|['/tmp/.mount_buskilcJ8ClY/opt/src/main.py']|
21:18:28,946 root DEBUG sys.builtin_modules_names|('_abc', '_ast', '_codecs', '_collections', '_functools', '_imp', '_io', '_locale', '_operator', '_signal', '_sre', '_stat', '_string', '_symtable', '_thread', '_tracemalloc', '_warnings', '_weakref', 'atexit', 'builtins', 'errno', 'faulthandler', 'gc', 'itertools', 'marshal', 'posix', 'pwd', 'sys', 'time', 'xxsubtype', 'zipimport')|
21:18:28,946 root DEBUG sys.executable|/home/goldishlaser/Downloads/buskill-lin--x86_64/buskill-.AppImage|
21:18:28,946 root DEBUG sys.path|['/tmp/.mount_buskilcJ8ClY/opt/src', '/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python37.zip', '/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7', '/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/lib-dynload', '/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/site-packages']|
21:18:28,946 root DEBUG sys.prefix|/tmp/.mount_buskilcJ8ClY/opt/python3.7|
21:18:28,946 root DEBUG sys.version|3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]|
21:18:28,946 root DEBUG sys.api_version|1013|
21:18:28,946 root DEBUG sys.version_info|sys.version_info(major=3, minor=7, micro=8, releaselevel='final', serial=0)|
21:18:28,946 root DEBUG __name__|__main__|
21:18:28,946 root DEBUG sys.platform|linux|
21:18:28,947 root DEBUG platform.platform()|Linux-5.4.0-144-generic-x86_64-with-debian-bullseye-sid|
21:18:28,947 root DEBUG platform.system()|Linux|
21:18:28,947 root DEBUG platform.release()|5.4.0-144-generic|
21:18:28,947 root DEBUG platform.version()|#161-Ubuntu SMP Fri Feb 3 14:49:04 UTC 2023|
21:18:28,947 root DEBUG platform.machine()|x86_64|
21:18:28,947 root DEBUG NAME="Linux Mint"
VERSION="20.3 (Una)"
ID=linuxmint
ID_LIKE=ubuntu
PRETTY_NAME="Linux Mint 20.3"
VERSION_ID="20.3"
HOME_URL="https://www.linuxmint.com/"
SUPPORT_URL="https://forums.linuxmint.com/"
BUG_REPORT_URL="http://linuxmint-troubleshooting-guide.readthedocs.io/en/latest/"
PRIVACY_POLICY_URL="https://www.linuxmint.com/"
VERSION_CODENAME=una
UBUNTU_CODENAME=focal

21:18:28,947 root INFO buskill version {'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}
21:18:29,230 packages.buskill DEBUG usb1.__version__:|3.0.0|
21:18:29,294 kivy INFO [Logger      ] Record log in /home/goldishlaser/.kivy/logs/kivy_23-03-23_3.txt
21:18:29,294 kivy INFO [Kivy        ] v1.11.1
21:18:29,295 kivy INFO [Kivy        ] Installed at "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/site-packages/kivy/__init__.py"
21:18:29,295 kivy INFO [Python      ] v3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)]
21:18:29,295 kivy INFO [Python      ] Interpreter at "/home/goldishlaser/Downloads/buskill-lin--x86_64/buskill-.AppImage"
21:18:29,347 kivy INFO [Factory     ] 184 symbols loaded
21:18:29,480 kivy INFO [Image       ] Providers: img_tex, img_dds, img_sdl2, img_gif (img_pil, img_ffpyplayer ignored)
21:18:29,728 kivy INFO [Window      ] Provider: sdl2(['window_egl_rpi'] ignored)
21:18:30,71 kivy INFO [GL          ] Using the "OpenGL" graphics system
21:18:30,72 kivy INFO [GL          ] Backend used <sdl2>
21:18:30,73 kivy INFO [GL          ] OpenGL version <b'4.6 (Compatibility Profile) Mesa 21.2.6'>
21:18:30,73 kivy INFO [GL          ] OpenGL vendor <b'Intel'>
21:18:30,74 kivy INFO [GL          ] OpenGL renderer <b'Mesa Intel(R) HD Graphics 630 (KBL GT2)'>
21:18:30,74 kivy INFO [GL          ] OpenGL parsed version: 4, 6
21:18:30,74 kivy INFO [GL          ] Shading version <b'4.60'>
21:18:30,74 kivy INFO [GL          ] Texture max size <16384>
21:18:30,74 kivy INFO [GL          ] Texture max units <32>
21:18:30,93 kivy INFO [Window      ] auto add sdl2 input provider
21:18:30,96 kivy INFO [Window      ] virtual keyboard not allowed, single mode, not docked
21:18:30,142 kivy INFO [Clipboard   ] Provider: sdl2(['clipboard_xclip', 'clipboard_xsel', 'clipboard_dbusklipper', 'clipboard_gtk3'] ignored)
21:18:30,153 kivy CRITICAL [Cutbuffer   ] Unable to find any valuable Cutbuffer provider. Please enable debug logging (e.g. add -d if running from the command line, or change the log level in the config) and re-run your app to identify potential causes
xclip - FileNotFoundError: [Errno 2] No such file or directory: 'xclip': 'xclip'
  File "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xclip.py", line 17, in <module>
    p = subprocess.Popen(['xclip', '-version'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

xsel - FileNotFoundError: [Errno 2] No such file or directory: 'xsel': 'xsel'
  File "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/site-packages/kivy/core/__init__.py", line 63, in core_select_lib
    fromlist=[modulename], level=0)
  File "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/site-packages/kivy/core/clipboard/clipboard_xsel.py", line 16, in <module>
    p = subprocess.Popen(['xsel'], stdout=subprocess.PIPE)
  File "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/subprocess.py", line 800, in __init__
    restore_signals, start_new_session)
  File "/tmp/.mount_buskilcJ8ClY/opt/python3.7/lib/python3.7/subprocess.py", line 1551, in _execute_child
    raise child_exception_type(errno_num, err_msg, err_filename)

21:18:30,175 kivy INFO [Text        ] Provider: sdl2
21:18:30,201 packages.buskill DEBUG DEBUG: EXECUTED_AS_SCRIPT:|False|
DEBUG: EXE_PATH:|/home/goldishlaser/Downloads/buskill-lin--x86_64/buskill-.AppImage|
DEBUG: EXE_DIR:|/home/goldishlaser/Downloads/buskill-lin--x86_64|
DEBUG: EXE_FILE:|buskill-.AppImage|
DEBUG: APP_DIR:|/home/goldishlaser/Downloads/buskill-lin--x86_64|
DEBUG: APPS_DIR:|/home/goldishlaser/Downloads|
DEBUG: SRC_DIR:|/tmp/.mount_buskilcJ8ClY/opt/src|
DEBUG: os.environ['PATH']:|/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin:/home/goldishlaser/Downloads/buskill-lin--x86_64:/home/goldishlaser/Downloads/buskill-lin--x86_64|

21:18:30,201 packages.buskill INFO INFO: using DATA_DIR:|/home/goldishlaser/Downloads/.buskill|
21:18:30,277 kivy INFO [GL          ] NPOT texture support is available
21:18:31,427 kivy INFO [ProbeSysfs  ] device match: /dev/input/event15
21:18:31,428 kivy INFO [MTD         ] Read event from </dev/input/event15>
21:18:31,429 kivy INFO [Base        ] Start application main loop
21:18:31,429 kivy WARNING [MTD         ] Unable to open device "/dev/input/event15". Please ensure you have the appropriate permissions.
21:18:31,480 kivy INFO [GL          ] Unpack subimage support is available
21:18:32,598 kivy INFO [WindowSDL   ] exiting mainloop and closing.
21:18:32,633 kivy INFO [Base        ] Leaving application in progress...
21:18:32,634 kivy WARNING stderr: [INFO/MainProcess] process shutting down
21:18:32,634 kivy WARNING stderr: [DEBUG/MainProcess] running all "atexit" finalizers with priority >= 0
21:18:32,634 kivy WARNING stderr: [DEBUG/MainProcess] running the remaining "atexit" finalizers
21:18:33,907 packages.buskill DEBUG DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7f42e90ce850>>()
21:18:33,917 packages.buskill INFO INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
21:18:33,920 kivy WARNING stderr: [INFO/Process-1] child process calling self.run()
21:18:33,939 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:33,940 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:33,940 packages.buskill DEBUG device:|Bus 002 Device 001: ID 1d6b:0003|
21:18:33,940 packages.buskill DEBUG event:|1|
21:18:33,940 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:33,940 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:33,941 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:33,941 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:33,941 packages.buskill DEBUG device:|Bus 001 Device 005: ID 0408:a060|
21:18:33,941 packages.buskill DEBUG event:|1|
21:18:33,941 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:33,941 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:33,942 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:33,942 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:33,942 packages.buskill DEBUG device:|Bus 001 Device 004: ID 04ca:3016|
21:18:33,942 packages.buskill DEBUG event:|1|
21:18:33,942 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:33,942 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:33,942 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:33,942 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:33,942 packages.buskill DEBUG device:|Bus 001 Device 003: ID 30fa:0400|
21:18:33,942 packages.buskill DEBUG event:|1|
21:18:33,942 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:33,942 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:33,943 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:33,943 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:33,943 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
21:18:33,943 packages.buskill DEBUG event:|1|
21:18:33,943 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:33,943 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:33,943 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:33,943 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:33,943 packages.buskill DEBUG device:|Bus 001 Device 034: ID ffff:5678|
21:18:33,943 packages.buskill DEBUG event:|1|
21:18:33,943 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:33,943 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:33,944 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:33,944 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:33,944 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
21:18:33,944 packages.buskill DEBUG event:|1|
21:18:33,944 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:33,944 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:35,866 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:35,866 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:35,866 packages.buskill DEBUG device:|Bus 001 Device 034: ID ffff:5678|
21:18:35,866 packages.buskill DEBUG event:|2|
21:18:35,866 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:35,866 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:35,866 packages.buskill INFO INFO: Detected USB removal event
21:18:35,867 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f42e90ce850>>
21:18:35,867 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:18:35,867 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:18:35,892 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:18:35,892 packages.buskill DEBUG DEBUG: subprocess stdout||
21:18:35,893 packages.buskill DEBUG DEBUG: subprocess stderr||
21:18:39,566 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:39,567 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:39,567 packages.buskill DEBUG device:|Bus 001 Device 035: ID ffff:5678|
21:18:39,567 packages.buskill DEBUG event:|1|
21:18:39,567 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:39,568 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:50,213 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:50,213 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:50,213 packages.buskill DEBUG device:|Bus 001 Device 035: ID ffff:5678|
21:18:50,213 packages.buskill DEBUG event:|2|
21:18:50,213 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:50,213 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:18:50,213 packages.buskill INFO INFO: Detected USB removal event
21:18:50,213 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f42e90ce850>>
21:18:50,213 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:18:50,214 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:18:50,249 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:18:50,249 packages.buskill DEBUG DEBUG: subprocess stdout||
21:18:50,249 packages.buskill DEBUG DEBUG: subprocess stderr||
21:18:52,80 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:18:52,81 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:18:52,81 packages.buskill DEBUG device:|Bus 001 Device 036: ID ffff:5678|
21:18:52,82 packages.buskill DEBUG event:|1|
21:18:52,82 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:18:52,82 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:07,267 packages.buskill DEBUG DEBUG: attempting to disarm BusKill
21:19:07,274 packages.buskill INFO INFO: BusKill is disarmed.
21:19:07,816 packages.buskill DEBUG DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7f42e90ce850>>()
21:19:07,822 packages.buskill INFO INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
21:19:07,826 kivy WARNING stderr: [INFO/Process-2] child process calling self.run()
21:19:07,848 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:07,848 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:07,848 packages.buskill DEBUG device:|Bus 002 Device 001: ID 1d6b:0003|
21:19:07,848 packages.buskill DEBUG event:|1|
21:19:07,848 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:07,848 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:07,849 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:07,849 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:07,849 packages.buskill DEBUG device:|Bus 001 Device 005: ID 0408:a060|
21:19:07,849 packages.buskill DEBUG event:|1|
21:19:07,849 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:07,849 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:07,849 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:07,850 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:07,850 packages.buskill DEBUG device:|Bus 001 Device 004: ID 04ca:3016|
21:19:07,850 packages.buskill DEBUG event:|1|
21:19:07,850 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:07,850 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:07,850 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:07,850 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:07,851 packages.buskill DEBUG device:|Bus 001 Device 003: ID 30fa:0400|
21:19:07,851 packages.buskill DEBUG event:|1|
21:19:07,851 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:07,851 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:07,851 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:07,851 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:07,851 packages.buskill DEBUG device:|Bus 001 Device 002: ID 0e6a:02c0|
21:19:07,851 packages.buskill DEBUG event:|1|
21:19:07,851 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:07,851 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:07,852 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:07,852 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:07,852 packages.buskill DEBUG device:|Bus 001 Device 036: ID ffff:5678|
21:19:07,852 packages.buskill DEBUG event:|1|
21:19:07,852 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:07,852 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:07,852 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:07,852 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:07,852 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
21:19:07,852 packages.buskill DEBUG event:|1|
21:19:07,852 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:07,852 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:10,163 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:10,163 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:10,163 packages.buskill DEBUG device:|Bus 001 Device 036: ID ffff:5678|
21:19:10,163 packages.buskill DEBUG event:|2|
21:19:10,163 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:10,163 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:10,163 packages.buskill INFO INFO: Detected USB removal event
21:19:10,163 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f42e90ce850>>
21:19:10,163 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
21:19:10,163 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
21:19:10,187 packages.buskill DEBUG DEBUG: subprocess returncode|0|
21:19:10,187 packages.buskill DEBUG DEBUG: subprocess stdout||
21:19:10,187 packages.buskill DEBUG DEBUG: subprocess stderr||
21:19:12,450 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
21:19:12,451 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7f42e8d55410>|
21:19:12,451 packages.buskill DEBUG device:|Bus 001 Device 037: ID ffff:5678|
21:19:12,452 packages.buskill DEBUG event:|1|
21:19:12,452 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
21:19:12,452 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
21:19:40,358 buskill_gui DEBUG DEBUG: User switched to 'DebugLog' screen
maltfield commented 1 year ago

@goldfishlaser can you please try the latest build?

I worked with Melanie out-of-band and found that the on Linux systems with the Cinnamon Desktop Environment, the xdg-screensaver command does exist, but it doesn't actually lock the screen when you tell it to. And when that fails to lock the screen, it exits 0 with no error message. Therefore, we cannot have it "fall back" to the cinnamon lockscreen command.

The latest build executes it immediately at the same time as the first lockscreen attempt; hopefully that'll work for Melanie.

goldfishlaser commented 1 year ago

Attempt 1:

Note: Using one of the USBs that could possibly have something screwy due to being used when testing the prototype....

Result - no lock screen,

BusKill Log

18:11:15,506 packages.buskill DEBUG event:|1|
18:11:15,506 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:11:15,506 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
18:11:15,506 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:11:15,506 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc52e46d490>|
18:11:15,506 packages.buskill DEBUG device:|Bus 001 Device 001: ID 1d6b:0002|
18:11:15,506 packages.buskill DEBUG event:|1|
18:11:15,506 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:11:15,506 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
18:11:36,732 buskill_gui DEBUG DEBUG: User switched to 'DebugLog' screen
18:12:06,105 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:12:06,105 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc52e46d490>|
18:12:06,105 packages.buskill DEBUG device:|Bus 001 Device 032: ID 058f:6387|
18:12:06,105 packages.buskill DEBUG event:|2|
18:12:06,105 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:12:06,105 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
18:12:06,105 packages.buskill INFO INFO: Detected USB removal event
18:12:06,105 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc525db3fd0>>
18:12:06,105 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
18:12:06,106 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
18:12:06,127 packages.buskill DEBUG DEBUG: subprocess returncode|0|
18:12:06,127 packages.buskill DEBUG DEBUG: subprocess stdout||
18:12:06,127 packages.buskill DEBUG DEBUG: subprocess stderr||
18:12:06,127 packages.buskill DEBUG INFO: Attempting to execute `cinnamon-screensaver-command --lock`
18:12:06,138 packages.buskill DEBUG DEBUG: subprocess returncode|1|
18:12:06,140 packages.buskill DEBUG DEBUG: subprocess stdout||
18:12:06,140 packages.buskill DEBUG DEBUG: subprocess stderr|Python path configuration:
  PYTHONHOME = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  PYTHONPATH = (not set)
  program name = '/usr/bin/python3'
  isolated = 0
  environment = 1
  user site = 1
  import site = 1
  sys._base_executable = '/usr/bin/python3'
  sys.base_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.base_exec_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.executable = '/usr/bin/python3'
  sys.prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.exec_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.path = [
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python38.zip',
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python3.8',
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python3.8/lib-dynload',
  ]
Fatal Python error: init_fs_encoding: failed to get the Python codec of the filesystem encoding
Python runtime state: core initialized
ModuleNotFoundError: No module named 'encodings'

Current thread 0x00007fa0f2a28740 (most recent call first):
<no Python frame>
|
18:12:06,140 packages.buskill ERROR ERROR: Failed to execute `cinnamon-screensaver-command --lock`! 
18:12:11,551 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:12:11,552 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc52e46d490>|
18:12:11,552 packages.buskill DEBUG device:|Bus 001 Device 033: ID 058f:6387|
18:12:11,552 packages.buskill DEBUG event:|1|
18:12:11,553 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:12:11,553 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|

#### DMESG

[91124.150802] usb 1-5: USB disconnect, device number 30
[91134.635192] usb 1-5: new high-speed USB device number 32 using xhci_hcd
[91134.792879] usb 1-5: New USB device found, idVendor=058f, idProduct=6387, bcdDevice= 1.00
[91134.792885] usb 1-5: New USB device strings: Mfr=1, Product=2, SerialNumber=3
[91134.792889] usb 1-5: Product: Mass Storage
[91134.792893] usb 1-5: Manufacturer: Generic
[91134.792896] usb 1-5: SerialNumber: 50ADF982
[91134.795098] usb-storage 1-5:1.0: USB Mass Storage device detected
[91134.795629] scsi host3: usb-storage 1-5:1.0
[91135.829435] scsi 3:0:0:0: Direct-Access     Generic  Flash Disk       8.07 PQ: 0 ANSI: 4
[91135.830045] sd 3:0:0:0: Attached scsi generic sg1 type 0
[91135.830868] sd 3:0:0:0: [sdb] 31948800 512-byte logical blocks: (16.4 GB/15.2 GiB)
[91135.831618] sd 3:0:0:0: [sdb] Write Protect is off
[91135.831624] sd 3:0:0:0: [sdb] Mode Sense: 23 00 00 00
[91135.832444] sd 3:0:0:0: [sdb] Write cache: disabled, read cache: enabled, doesn't support DPO or FUA
[91135.863013]  sdb: sdb1 sdb2 sdb3
[91135.886239] sd 3:0:0:0: [sdb] Attached SCSI removable disk
[91136.651118] ISO 9660 Extensions: Microsoft Joliet Level 3
[91136.678769] EXT4-fs (sdb3): recovery complete
[91136.678772] EXT4-fs (sdb3): mounted filesystem with ordered data mode. Opts: (null)
[91136.680769] ISO 9660 Extensions: Microsoft Joliet Level 3
[91136.686988] ISO 9660 Extensions: RRIP_1991A
[91214.216450] usb 1-5: USB disconnect, device number 32
[91214.230761] Buffer I/O error on dev sdb3, logical block 1081344, lost sync page write
[91214.230765] JBD2: Error -5 detected when updating journal superblock for sdb3-8.
[91214.230766] Aborting journal on device sdb3-8.
[91214.230768] Buffer I/O error on dev sdb3, logical block 1081344, lost sync page write
[91214.230770] JBD2: Error -5 detected when updating journal superblock for sdb3-8.
[91219.539565] usb 1-5: new high-speed USB device number 33 using xhci_hcd
[91219.694886] usb 1-5: New USB device found, idVendor=058f, idProduct=6387, bcdDevice= 1.00
[91219.694890] usb 1-5: New USB device strings: Mfr=1, Product=2, SerialNumber=3
[91219.694893] usb 1-5: Product: Mass Storage
[91219.694895] usb 1-5: Manufacturer: Generic
[91219.694897] usb 1-5: SerialNumber: 50ADF982
[91219.696962] usb-storage 1-5:1.0: USB Mass Storage device detected
[91219.697995] scsi host3: usb-storage 1-5:1.0
[91220.725176] scsi 3:0:0:0: Direct-Access     Generic  Flash Disk       8.07 PQ: 0 ANSI: 4
[91220.725382] sd 3:0:0:0: Attached scsi generic sg1 type 0
[91220.726020] sd 3:0:0:0: [sdb] 31948800 512-byte logical blocks: (16.4 GB/15.2 GiB)
[91220.726678] sd 3:0:0:0: [sdb] Write Protect is off
[91220.726680] sd 3:0:0:0: [sdb] Mode Sense: 23 00 00 00
[91220.727332] sd 3:0:0:0: [sdb] Write cache: disabled, read cache: enabled, doesn't support DPO or FUA
[91220.754637]  sdb: sdb1 sdb2 sdb3
[91220.791703] sd 3:0:0:0: [sdb] Attached SCSI removable disk
[91221.502517] ISO 9660 Extensions: Microsoft Joliet Level 3
[91221.548786] ISO 9660 Extensions: Microsoft Joliet Level 3
[91222.186462] ISO 9660 Extensions: RRIP_1991A
[91222.189642] EXT4-fs (sdb3): recovery complete
[91222.196842] EXT4-fs (sdb3): mounted filesystem with ordered data mode. Opts: (null
goldfishlaser commented 1 year ago

Attempt 2

Note: Same USB

Result: Locks

BusKill Log

18:12:11,553 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
18:16:12,961 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:16:12,961 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc52e46d490>|
18:16:12,961 packages.buskill DEBUG device:|Bus 001 Device 033: ID 058f:6387|
18:16:12,961 packages.buskill DEBUG event:|2|
18:16:12,961 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:16:12,961 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
18:16:12,961 packages.buskill INFO INFO: Detected USB removal event
18:16:12,961 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc525db3fd0>>
18:16:12,961 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
18:16:12,961 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
18:16:12,986 packages.buskill DEBUG DEBUG: subprocess returncode|0|
18:16:13,8 packages.buskill DEBUG DEBUG: subprocess stdout||
18:16:13,9 packages.buskill DEBUG DEBUG: subprocess stderr||
18:16:13,9 packages.buskill DEBUG INFO: Attempting to execute `cinnamon-screensaver-command --lock`
18:16:13,20 packages.buskill DEBUG DEBUG: subprocess returncode|1|
18:16:13,21 packages.buskill DEBUG DEBUG: subprocess stdout||
18:16:13,21 packages.buskill DEBUG DEBUG: subprocess stderr|Python path configuration:
  PYTHONHOME = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  PYTHONPATH = (not set)
  program name = '/usr/bin/python3'
  isolated = 0
  environment = 1
  user site = 1
  import site = 1
  sys._base_executable = '/usr/bin/python3'
  sys.base_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.base_exec_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.executable = '/usr/bin/python3'
  sys.prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.exec_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.path = [
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python38.zip',
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python3.8',
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python3.8/lib-dynload',
  ]
Fatal Python error: init_fs_encoding: failed to get the Python codec of the filesystem encoding
Python runtime state: core initialized
ModuleNotFoundError: No module named 'encodings'

Current thread 0x00007f025e17f740 (most recent call first):
<no Python frame>
|
18:16:13,21 packages.buskill ERROR ERROR: Failed to execute `cinnamon-screensaver-command --lock`! 
18:16:13,396 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:16:13,396 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc52e46d490>|
18:16:13,396 packages.buskill DEBUG device:|Bus 001 Device 034: ID 058f:6387|
18:16:13,396 packages.buskill DEBUG event:|1|
18:16:13,396 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:16:13,396 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
18:16:15,224 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:16:15,224 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc52e46d490>|
18:16:15,224 packages.buskill DEBUG device:|Bus 001 Device 034: ID 058f:6387|
18:16:15,224 packages.buskill DEBUG event:|2|
18:16:15,224 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:16:15,224 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
18:16:15,224 packages.buskill INFO INFO: Detected USB removal event
18:16:15,225 packages.buskill DEBUG calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7fc525db3fd0>>
18:16:15,225 packages.buskill DEBUG DEBUG: BusKill lock-screen trigger executing now
18:16:15,225 packages.buskill DEBUG INFO: Attempting to execute `xdg-screensaver lock`
18:16:15,246 packages.buskill DEBUG DEBUG: subprocess returncode|0|
18:16:15,247 packages.buskill DEBUG DEBUG: subprocess stdout||
18:16:15,247 packages.buskill DEBUG DEBUG: subprocess stderr||
18:16:15,247 packages.buskill DEBUG INFO: Attempting to execute `cinnamon-screensaver-command --lock`
18:16:15,256 packages.buskill DEBUG DEBUG: subprocess returncode|1|
18:16:15,256 packages.buskill DEBUG DEBUG: subprocess stdout||
18:16:15,256 packages.buskill DEBUG DEBUG: subprocess stderr|Python path configuration:
  PYTHONHOME = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  PYTHONPATH = (not set)
  program name = '/usr/bin/python3'
  isolated = 0
  environment = 1
  user site = 1
  import site = 1
  sys._base_executable = '/usr/bin/python3'
  sys.base_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.base_exec_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.executable = '/usr/bin/python3'
  sys.prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.exec_prefix = '/tmp/.mount_buskilbiIPQW/opt/python3.7'
  sys.path = [
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python38.zip',
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python3.8',
    '/tmp/.mount_buskilbiIPQW/opt/python3.7/lib/python3.8/lib-dynload',
  ]
Fatal Python error: init_fs_encoding: failed to get the Python codec of the filesystem encoding
Python runtime state: core initialized
ModuleNotFoundError: No module named 'encodings'

Current thread 0x00007f48e5207740 (most recent call first):
<no Python frame>
|
18:16:15,256 packages.buskill ERROR ERROR: Failed to execute `cinnamon-screensaver-command --lock`! 
18:16:17,770 packages.buskill DEBUG DEBUG: called hotplugCallbackNix()
18:16:17,771 packages.buskill DEBUG context:|<usb1.USBContext object at 0x7fc52e46d490>|
18:16:17,771 packages.buskill DEBUG device:|Bus 001 Device 035: ID 058f:6387|
18:16:17,771 packages.buskill DEBUG event:|1|
18:16:17,771 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
18:16:17,771 packages.buskill DEBUG usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
^

#### DMESG
[91134.635192] usb 1-5: new high-speed USB device number 32 using xhci_hcd
[91134.792879] usb 1-5: New USB device found, idVendor=058f, idProduct=6387, bcdDevice= 1.00
[91134.792885] usb 1-5: New USB device strings: Mfr=1, Product=2, SerialNumber=3
[91134.792889] usb 1-5: Product: Mass Storage
[91134.792893] usb 1-5: Manufacturer: Generic
[91134.792896] usb 1-5: SerialNumber: 50ADF982
[91134.795098] usb-storage 1-5:1.0: USB Mass Storage device detected
[91134.795629] scsi host3: usb-storage 1-5:1.0
[91135.829435] scsi 3:0:0:0: Direct-Access     Generic  Flash Disk       8.07 PQ: 0 ANSI: 4
[91135.830045] sd 3:0:0:0: Attached scsi generic sg1 type 0
[91135.830868] sd 3:0:0:0: [sdb] 31948800 512-byte logical blocks: (16.4 GB/15.2 GiB)
[91135.831618] sd 3:0:0:0: [sdb] Write Protect is off
[91135.831624] sd 3:0:0:0: [sdb] Mode Sense: 23 00 00 00
[91135.832444] sd 3:0:0:0: [sdb] Write cache: disabled, read cache: enabled, doesn't support DPO or FUA
[91135.863013]  sdb: sdb1 sdb2 sdb3
[91135.886239] sd 3:0:0:0: [sdb] Attached SCSI removable disk
[91136.651118] ISO 9660 Extensions: Microsoft Joliet Level 3
[91136.678769] EXT4-fs (sdb3): recovery complete
[91136.678772] EXT4-fs (sdb3): mounted filesystem with ordered data mode. Opts: (null)
[91136.680769] ISO 9660 Extensions: Microsoft Joliet Level 3
[91136.686988] ISO 9660 Extensions: RRIP_1991A
[91214.216450] usb 1-5: USB disconnect, device number 32
[91214.230761] Buffer I/O error on dev sdb3, logical block 1081344, lost sync page write
[91214.230765] JBD2: Error -5 detected when updating journal superblock for sdb3-8.
[91214.230766] Aborting journal on device sdb3-8.
[91214.230768] Buffer I/O error on dev sdb3, logical block 1081344, lost sync page write
[91214.230770] JBD2: Error -5 detected when updating journal superblock for sdb3-8.
[91219.539565] usb 1-5: new high-speed USB device number 33 using xhci_hcd
[91219.694886] usb 1-5: New USB device found, idVendor=058f, idProduct=6387, bcdDevice= 1.00
[91219.694890] usb 1-5: New USB device strings: Mfr=1, Product=2, SerialNumber=3
[91219.694893] usb 1-5: Product: Mass Storage
[91219.694895] usb 1-5: Manufacturer: Generic
[91219.694897] usb 1-5: SerialNumber: 50ADF982
[91219.696962] usb-storage 1-5:1.0: USB Mass Storage device detected
[91219.697995] scsi host3: usb-storage 1-5:1.0
[91220.725176] scsi 3:0:0:0: Direct-Access     Generic  Flash Disk       8.07 PQ: 0 ANSI: 4
[91220.725382] sd 3:0:0:0: Attached scsi generic sg1 type 0
[91220.726020] sd 3:0:0:0: [sdb] 31948800 512-byte logical blocks: (16.4 GB/15.2 GiB)
[91220.726678] sd 3:0:0:0: [sdb] Write Protect is off
[91220.726680] sd 3:0:0:0: [sdb] Mode Sense: 23 00 00 00
[91220.727332] sd 3:0:0:0: [sdb] Write cache: disabled, read cache: enabled, doesn't support DPO or FUA
[91220.754637]  sdb: sdb1 sdb2 sdb3
[91220.791703] sd 3:0:0:0: [sdb] Attached SCSI removable disk
[91221.502517] ISO 9660 Extensions: Microsoft Joliet Level 3
[91221.548786] ISO 9660 Extensions: Microsoft Joliet Level 3
[91222.186462] ISO 9660 Extensions: RRIP_1991A
[91222.189642] EXT4-fs (sdb3): recovery complete
[91222.196842] EXT4-fs (sdb3): mounted filesystem with ordered data mode. Opts: (null)
[91461.070441] usb 1-5: USB disconnect, device number 33
[91461.384438] usb 1-5: new high-speed USB device number 34 using xhci_hcd
[91461.543703] usb 1-5: New USB device found, idVendor=058f, idProduct=6387, bcdDevice= 1.00
[91461.543707] usb 1-5: New USB device strings: Mfr=1, Product=2, SerialNumber=3
[91461.543710] usb 1-5: Product: Mass Storage
[91461.543712] usb 1-5: Manufacturer: Generic
[91461.543714] usb 1-5: SerialNumber: 50ADF982
[91461.546424] usb-storage 1-5:1.0: USB Mass Storage device detected
[91461.546934] scsi host3: usb-storage 1-5:1.0
[91462.551372] scsi 3:0:0:0: Direct-Access     Generic  Flash Disk       8.07 PQ: 0 ANSI: 4
[91462.552074] sd 3:0:0:0: Attached scsi generic sg1 type 0
[91462.552890] sd 3:0:0:0: [sdb] 31948800 512-byte logical blocks: (16.4 GB/15.2 GiB)
[91462.553633] sd 3:0:0:0: [sdb] Write Protect is off
[91462.553639] sd 3:0:0:0: [sdb] Mode Sense: 23 00 00 00
[91462.554439] sd 3:0:0:0: [sdb] Write cache: disabled, read cache: enabled, doesn't support DPO or FUA
[91462.602442]  sdb: sdb1 sdb2 sdb3
[91462.635336] sd 3:0:0:0: [sdb] Attached SCSI removable disk
[91463.275047] usb 1-5: USB disconnect, device number 34
[91465.764720] usb 1-5: new high-speed USB device number 35 using xhci_hcd
[91465.924836] usb 1-5: New USB device found, idVendor=058f, idProduct=6387, bcdDevice= 1.00
[91465.924839] usb 1-5: New USB device strings: Mfr=1, Product=2, SerialNumber=3
[91465.924840] usb 1-5: Product: Mass Storage
[91465.924841] usb 1-5: Manufacturer: Generic
[91465.924842] usb 1-5: SerialNumber: 50ADF982
[91465.926635] usb-storage 1-5:1.0: USB Mass Storage device detected
[91465.926810] scsi host3: usb-storage 1-5:1.0
[91466.934506] scsi 3:0:0:0: Direct-Access     Generic  Flash Disk       8.07 PQ: 0 ANSI: 4
[91466.935268] sd 3:0:0:0: Attached scsi generic sg1 type 0
[91466.936024] sd 3:0:0:0: [sdb] 31948800 512-byte logical blocks: (16.4 GB/15.2 GiB)
[91466.936739] sd 3:0:0:0: [sdb] Write Protect is off
[91466.936748] sd 3:0:0:0: [sdb] Mode Sense: 23 00 00 00
[91466.937452] sd 3:0:0:0: [sdb] Write cache: disabled, read cache: enabled, doesn't support DPO or FUA
[91466.968495]  sdb: sdb1 sdb2 sdb3
[91467.006521] sd 3:0:0:0: [sdb] Attached SCSI removable disk
[91469.257382] EXT4-fs (sdb3): recovery complete
[91469.257385] EXT4-fs (sdb3): mounted filesystem with ordered data mode. Opts: (null)
maltfield commented 1 year ago

Curious, this error messages seems related to:

goldfishlaser commented 1 year ago

I just noticed that BusKill (the latest version) is actually reliably working when I unplug my usb keyboard instead.

maltfield commented 1 year ago

@goldfishlaser as in it is locking your screen? Interesting. I wonder if it has something to do with the encoding of the usb device's name.

goldfishlaser commented 1 year ago

Precisely, I mean that it is locking my screen. I tried my USB mic and USB mouse as well, and they also successfully cause a screenlock when removed.

When it comes to using usb storage devices, I have tried multiple types of usb storage devices.

maltfield commented 1 year ago

I need some way to test the encoding issue on my end so I can reproduce it and squash this bug.

maltfield commented 1 year ago

@goldfishlaser can you please run the following commands on your system

sudo su -
sudo apt-get install git
git clone https://github.com/BusKill/buskill-app.git
cd buskill-app/
build/linux/debianWrapper.sh
/tmp/kivy_appdir/opt/python3.7/bin/python3.7

At the python prompt, please enter the following command

import encodings

Please send the output of the above python shell.

For reference, here's what I get in Debian 11

user@buskill:~/sandbox/buskill-app/src$ /tmp/kivy_appdir/opt/python3.7/bin/python3.7
Python 3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)] on linux
Type "help", "copyright", "credits" or "license" for more information.
>>> import encodings
>>> 
goldfishlaser commented 1 year ago
➜  buskill-app git:(master) ✗ /tmp/kivy_appdir/opt/python3.7/bin/python3.7
Python 3.7.8 (default, Jul  4 2020, 10:00:57) 
[GCC 9.3.1 20200408 (Red Hat 9.3.1-2)] on linux
Type "help", "copyright", "credits" or "license" for more information.
>>> import encodings
>>> 
goldfishlaser commented 1 year ago

Per what I noticed about the trigger working for devices like my mouse or keyboard, but not flash drive.

On a separate issue, coderjon recommended I use a USB with the following characteristics for testing BusKill:

"... a USB device that runs the USB connection at 12 Mbit/second “Full Speed” rates. That is much more robust than the 480 Mbit/s USB 2 limit.... Any USB 1 device will be “Full Speed” or slower, and many mice, keyboards, and USB-Serial adapters will also be “Full Speed” or slower. USB 2 disks almost always use the 480 Mbit/s speed."

Bit of a long shot but does anything about the difference between device types (1,2,etc) or their speeds and how your software decides to trigger the lock?

maltfield commented 1 year ago

I don't think the speed of the device should affect it (other than a delay so negligible that it's not human-detectable delay).

Further looking at the error

Fatal Python error: init_fs_encoding: failed to get the Python codec of the filesystem encoding
Python runtime state: core initialized
ModuleNotFoundError: No module named 'encodings'

Google returns this:

Which suggests that there's an issue with the PYTHONHOME. Your debug output shows that this is set to /tmp/.mount_buskilvF5fck/opt/python3.7. So it could be something weird about the temp dir that the AppImage is extracted-to at runtime. Several answers to the SO above suggest just unsetting PYTHONHOME. I'll have to look deeper at this in June, where I'll have a few weeks to focus on buskill dev.

maltfield commented 1 year ago

I created an HVM in QubesOS and installed linuxmint-20.3-cinnamon-64bit.iso. I then downloaded the BusKill app v0.6.0.

Because it's an HVM, I couldn't actually attach & detach a USB drive to it, but I instead used the built-in --run-trigger command argument to test the lockscreen trigger.

user@host:~/Downloads/buskill-lin-v0.6.0-x86_64$ yes | ./buskill-v0.6.0.AppImage --run-trigger

Curiously, I found that sometimes the screen would lock and sometimes it would not lock.

@goldfishlaser is it the same for you? If you execute the above command ten times in a row and wait ~10 seconds between each execution, does it lock the screen 100% of the time, 0% of the time, or something in-between?

I tried this myself. I found that if I do it repeatedly then it locks 100% of the time. But if I go off and do something in another window, then try again, then the screen won't lock on the first execution attempt -- but then it does work 100% of the time after that. I also found that this very strange behaviour can be repeated when executing xdg-screensaver lock directly (as opposed to having the BusKill app do it).

I then tried it again with the latest build from above, and I found similar behaviour: the first time it fails, subsequent times it succeeds. But if I click around to some other windows and then return to the terminal, then it fails again once and then succeeds on subsequent attempts.

I could not detect any important difference in the output between executions where the screen does and does not lock. Here's one example.

user@DESKTOP:~/Downloads/buskill-lin--x86_64$ echo 'y' | ./buskill-v0.6.0.AppImage --run-trigger
...
called hotplugCallbackNix()
context:|simulation|
device:|simulation|
event:|2|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
INFO: Detected USB removal event
calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7ff7a7d99350>>
DEBUG: BusKill lock-screen trigger executing now
INFO: Attempting to execute `xdg-screensaver lock`
DEBUG: called hotplugCallbackNix()
context:|<usb1.USBContext object at 0x7ff7a9ff4690>|
device:|Bus 001 Device 002: ID 0627:0001|
event:|1|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
DEBUG: called hotplugCallbackNix()
context:|<usb1.USBContext object at 0x7ff7a9ff4690>|
device:|Bus 001 Device 001: ID 1d6b:0002|
event:|1|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
DEBUG: subprocess returncode|0|
DEBUG: subprocess stdout||
DEBUG: subprocess stderr||
INFO: Attempting to execute `cinnamon-screensaver-command --lock`
DEBUG: subprocess returncode|1|
DEBUG: subprocess stdout||
DEBUG: subprocess stderr|Python path configuration:
  PYTHONHOME = '/tmp/.mount_buskilParXTg/opt/python3.7'
  PYTHONPATH = (not set)
  program name = '/usr/bin/python3'
  isolated = 0
  environment = 1
  user site = 1
  import site = 1
  sys._base_executable = '/usr/bin/python3'
  sys.base_prefix = '/tmp/.mount_buskilParXTg/opt/python3.7'
  sys.base_exec_prefix = '/tmp/.mount_buskilParXTg/opt/python3.7'
  sys.executable = '/usr/bin/python3'
  sys.prefix = '/tmp/.mount_buskilParXTg/opt/python3.7'
  sys.exec_prefix = '/tmp/.mount_buskilParXTg/opt/python3.7'
  sys.path = [
    '/tmp/.mount_buskilParXTg/opt/python3.7/lib/python38.zip',
    '/tmp/.mount_buskilParXTg/opt/python3.7/lib/python3.8',
    '/tmp/.mount_buskilParXTg/opt/python3.7/lib/python3.8/lib-dynload',
  ]
Fatal Python error: init_fs_encoding: failed to get the Python codec of the filesystem encoding
Python runtime state: core initialized
ModuleNotFoundError: No module named 'encodings'

Current thread 0x00007fd9615ed740 (most recent call first):
<no Python frame>
|
ERROR: Failed to execute `cinnamon-screensaver-command --lock`! 
user@DESKTOP:~/Downloads/buskill-lin--x86_64$ 
maltfield commented 1 year ago

So I was successfully able to reproduce the No module named 'encodings' error when executing a BusKill .AppImage build. The next step to try to solve it (for faster iteration) is to checkout this git repo and try to reproduce it when executing the python script directly.

Unfortunately, when I execute the python script directly, the screen appears to lock 100% of the time, and I don't get the encodings error. Interesting..

user@DESKTOP:~/sandbox/buskill-app$ echo 'y' | /tmp/kivy_appdir/opt/python3.7/bin/python3.7 src/main.py --run-trigger
===============================================================================
INFO: Writing to log file '/tmp/buskill.log'
buskill version {'VERSION': '', 'GITHUB_REF': '', 'GITHUB_SHA': '', 'SOURCE_DATE_EPOCH': ''}
usb1.__version__:|3.0.0|
DEBUG: EXECUTED_AS_SCRIPT:|True|
DEBUG: EXE_PATH:|/home/user/sandbox/buskill-app/src/main.py|
DEBUG: EXE_DIR:|/home/user/sandbox/buskill-app/src|
DEBUG: EXE_FILE:|main.py|
DEBUG: APP_DIR:|/home/user/sandbox/buskill-app|
DEBUG: APPS_DIR:|/home/user/sandbox|
DEBUG: SRC_DIR:|/home/user/sandbox/buskill-app/src|
DEBUG: os.environ['PATH']:|/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games:/snap/bin:/home/user/sandbox/buskill-app/src:/home/user/sandbox/buskill-app|

INFO: using DATA_DIR:|/home/user/sandbox/.buskill|
DEBUG: Attempting to set 'trigger' set to 'lock-screen'
INFO: BusKill 'trigger' set to 'lock-screen'
DEBUG: attempting to arm BusKill via <bound method BusKill.armNix of <packages.buskill.BusKill object at 0x7f4bd372e1d0>>()
INFO: BusKill is armed. Listening for removal event.
INFO: To disarm the CLI, exit with ^C or close this terminal
DEBUG: Attempting to set 'trigger' set to 'lock-screen'
INFO: BusKill 'trigger' set to 'lock-screen'
Are you sure you want to execute the 'lock-screen' trigger RIGHT NOW? [Y/N] DEBUG: called hotplugCallbackNix()
context:|simulation|
device:|simulation|
event:|2|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
INFO: Detected USB removal event
calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f4bd372e1d0>>
DEBUG: BusKill lock-screen trigger executing now
INFO: Attempting to execute `xdg-screensaver lock`
DEBUG: called hotplugCallbackNix()
context:|<usb1.USBContext object at 0x7f4bd36f70d0>|
device:|Bus 001 Device 002: ID 0627:0001|
event:|1|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
DEBUG: called hotplugCallbackNix()
context:|<usb1.USBContext object at 0x7f4bd36f70d0>|
device:|Bus 001 Device 001: ID 1d6b:0002|
event:|1|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
DEBUG: subprocess returncode|0|
DEBUG: subprocess stdout||
DEBUG: subprocess stderr||
INFO: Attempting to execute `cinnamon-screensaver-command --lock`
DEBUG: subprocess returncode|0|
DEBUG: subprocess stdout||
DEBUG: subprocess stderr||
user@DESKTOP:~/sandbox/buskill-app$ 

Therefore, this does appear to be something specific to the .AppImage. Perhaps it's an issue with the encoding of the temp filesystem created by AppImage runtime execution, as hypothesized above.

maltfield commented 1 year ago

Fortunately I can still build the .AppImage locally, so I can iterate without having to wait for GitHub Actions to build the .AppImage in the cloud. It's slower than executing it as a python script, but necessary if the issue is AppImage-specific

user@DESKTOP:~/sandbox/buskill-app$ build/linux/debianWrapper.sh
...
user@DESKTOP:~/sandbox/buskill-app$ echo 'y' | dist/buskill-lin--x86_64/buskill-.AppImage --run-trigger
maltfield commented 1 year ago

I locally added the following two lines to the top of the trigger_lockscreen_lin_cinamon() function

del os.environ['PYTHONHOME']
del os.environ['PYTHONPATH']

Then I built the .AppImage locally

user@DESKTOP:~/sandbox/buskill-app$ build/linux/debianWrapper.sh

Then I executed the .AppImage a couple times

user@DESKTOP:~/sandbox/buskill-app$ echo 'y' | dist/buskill-lin--x86_64/buskill-.AppImage --run-trigger

The first execution, the screen didn't lock. On the second execution, the screen did lock.

On both executions, I got an error from executing the cinnamon-screensaver-command --lock command. So, actually, I think the thing that's making it lock on the second execution is the xdg-screensaver lock command.

user@DESKTOP:~/sandbox/buskill-app$ echo 'y' | dist/buskill-lin--x86_64/buskill-.AppImage --run-trigger
...
called hotplugCallbackNix()
context:|simulation|
device:|simulation|
event:|2|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
INFO: Detected USB removal event
calling <bound method BusKill.triggerLin of <packages.buskill.BusKill object at 0x7f0ce52e2a90>>
DEBUG: BusKill lock-screen trigger executing now
INFO: Attempting to execute `xdg-screensaver lock`
DEBUG: called hotplugCallbackNix()
context:|<usb1.USBContext object at 0x7f0ce719a610>|
device:|Bus 001 Device 002: ID 0627:0001|
event:|1|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
DEBUG: called hotplugCallbackNix()
context:|<usb1.USBContext object at 0x7f0ce719a610>|
device:|Bus 001 Device 001: ID 1d6b:0002|
event:|1|
usb1.HOTPLUG_EVENT_DEVICE_ARRIVED:|1|
usb1.HOTPLUG_EVENT_DEVICE_LEFT:|2|
DEBUG: subprocess returncode|0|
DEBUG: subprocess stdout||
DEBUG: subprocess stderr||
ERROR: Failed to execute `cinnamon-screensaver-command --lock`! 'PYTHONPATH'
user@DESKTOP:~/sandbox/buskill-app$ 

As shown above, xdg-screensaver lock tends to fail on the first attempt but succeed on subsequent attempts, whereas the cinnamon-screensaver-command --lock command appears to work 100% of the time.

maltfield commented 1 year ago

Alright, so it looks like the error above

ERROR: Failed to execute `cinnamon-screensaver-command --lock`! 'PYTHONPATH'

...was caused by me attempting to del a variable in python that wasn't yet declared. So I fixed the code to this

if 'PYTHONHOME' in os.environ:
   del os.environ['PYTHONHOME']
if 'PYTHONPATH' in os.environ:
   del os.environ['PYTHONPATH']

Good news: when I've built a new .AppImage with the above lines at the top of the function, it's now locking 100% of the time and without the encoding error.

I tried another execution where I just kept the first block, and it also worked as expected.

if 'PYTHONHOME' in os.environ:
   del os.environ['PYTHONHOME']
#if 'PYTHONPATH' in os.environ:
#   del os.environ['PYTHONPATH']

And I tried the reverse.

#if 'PYTHONHOME' in os.environ:
#   del os.environ['PYTHONHOME']
if 'PYTHONPATH' in os.environ:
   del os.environ['PYTHONPATH']

...but the above resulted in the screen not locking and the encoding error was back. So this issue is definitely caused just by the PYTHONHOME environment variable

TODO: Make the change in the actual codebase and push to GitHub.

maltfield commented 1 year ago

I tested the latest build, and it's now locking the screen 100% of the time on Linux Mint Cinnamon 20.3

@goldfishlaser can you please try the above build and let me know if it now consistently locks the screen or if this issue persists?

goldfishlaser commented 1 year ago

@maltfield It worked!

maltfield commented 1 year ago

Great :) this should be fixed in v0.7.0.

Thanks again for helping to make BusKill better for Linux Mint users, and please post more bug reports if you find anything else that isn't working the way it should.

Can you please confirm that otherwise the app is fully functional in

If so, we'll add it to our documentation as a tested & supported system