sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

danielem · 2023-06-18 07:35:20

Hey, it's been like 2 weeks or more already that I have that issue - it takes about 25 seconds to start most of the apps, including sway WM, once it starts it works as usual. All of it happens on laptop with ryzen 5700U with 16GB of RAM with 100GB free disk space on SSD, and happens every time I start some app, no matter if it is a fresh restart or working for half a day already. Once app starts no issues with it at all.

It started all of suddenly, so initially thought that is some bug maybe in kernel that is gonna be quickly noticed and fixed, but after that time it doesn't seem a case any more. So any ideas of how to solve it or where to dig in the system to look for answers highly appreciated!

For the start stuff that seem suspecious in dmesg:

```
[ 0.867443] Estimated ratio of average max frequency by base frequency (times 1024): 1755
[ 0.867456] Monitor-Mwait will be used to enter C-1 state
[ 0.867460] ACPI: \_SB_.PLTF.P000: Found 3 idle states
[ 0.867466] ACPI: FW issue: working around C-state latencies out of order
[ 0.867533] ACPI: \_SB_.PLTF.P001: Found 3 idle states
[ 0.867538] ACPI: FW issue: working around C-state latencies out of order
[ 0.867632] ACPI: \_SB_.PLTF.P002: Found 3 idle states
[ 0.867637] ACPI: FW issue: working around C-state latencies out of order
[ 0.867730] ACPI: \_SB_.PLTF.P003: Found 3 idle states
[ 0.867735] ACPI: FW issue: working around C-state latencies out of order
[ 0.867832] ACPI: \_SB_.PLTF.P004: Found 3 idle states
[ 0.867837] ACPI: FW issue: working around C-state latencies out of order
[ 0.867928] ACPI: \_SB_.PLTF.P005: Found 3 idle states
[ 0.867933] ACPI: FW issue: working around C-state latencies out of order
[ 0.867995] ACPI: \_SB_.PLTF.P006: Found 3 idle states
[ 0.868000] ACPI: FW issue: working around C-state latencies out of order
[ 0.868096] ACPI: \_SB_.PLTF.P007: Found 3 idle states
[ 0.868101] ACPI: FW issue: working around C-state latencies out of order
[ 0.868201] ACPI: \_SB_.PLTF.P008: Found 3 idle states
[ 0.868205] ACPI: FW issue: working around C-state latencies out of order
[ 0.868300] ACPI: \_SB_.PLTF.P009: Found 3 idle states
[ 0.868305] ACPI: FW issue: working around C-state latencies out of order
[ 0.868402] ACPI: \_SB_.PLTF.P00A: Found 3 idle states
[ 0.868406] ACPI: FW issue: working around C-state latencies out of order
[ 0.868502] ACPI: \_SB_.PLTF.P00B: Found 3 idle states
[ 0.868507] ACPI: FW issue: working around C-state latencies out of order
[ 0.868603] ACPI: \_SB_.PLTF.P00C: Found 3 idle states
[ 0.868607] ACPI: FW issue: working around C-state latencies out of order
[ 0.868702] ACPI: \_SB_.PLTF.P00D: Found 3 idle states
[ 0.868706] ACPI: FW issue: working around C-state latencies out of order
[ 0.868809] ACPI: \_SB_.PLTF.P00E: Found 3 idle states
[ 0.868814] ACPI: FW issue: working around C-state latencies out of order
[ 0.868910] ACPI: \_SB_.PLTF.P00F: Found 3 idle states
[ 0.868915] ACPI: FW issue: working around C-state latencies out of order
[ 0.870209] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P000 (20221020/dspkginit-438)
[ 0.870212] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P001 (20221020/dspkginit-438)
[ 0.870214] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P002 (20221020/dspkginit-438)
[ 0.870215] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P003 (20221020/dspkginit-438)
[ 0.870217] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P004 (20221020/dspkginit-438)
[ 0.870219] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P005 (20221020/dspkginit-438)
[ 0.870220] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P006 (20221020/dspkginit-438)
[ 0.870222] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P007 (20221020/dspkginit-438)
[ 0.870224] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P008 (20221020/dspkginit-438)
[ 0.870225] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P009 (20221020/dspkginit-438)
[ 0.870227] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00A (20221020/dspkginit-438)
[ 0.870228] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00B (20221020/dspkginit-438)
[ 0.870230] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00C (20221020/dspkginit-438)
[ 0.870232] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00D (20221020/dspkginit-438)
[ 0.870233] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00E (20221020/dspkginit-438)
[ 0.870235] ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00F (20221020/dspkginit-438)
[ 0.870239] ACPI: \_TZ_.THRM: Invalid passive threshold

[ 5.749523] [drm] psp gfx command LOAD_TA(0x1) failed and response status is (0x7)
[ 5.749735] [drm] psp gfx command INVOKE_CMD(0x3) failed and response status is (0x4)
[ 5.749737] amdgpu 0000:04:00.0: amdgpu: Secure display: Generic Failure.
[ 5.749738] amdgpu 0000:04:00.0: amdgpu: SECUREDISPLAY: query securedisplay TA failed. ret 0x0
[ 5.751625] amdgpu 0000:04:00.0: amdgpu: SMU is initialized successfully!

[ 69.931401] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 125.938591] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 176.432001] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 313.080914] rtw_8821ce 0000:02:00.0: timed out to flush queue 1
[ 313.214182] rtw_8821ce 0000:02:00.0: timed out to flush queue 2
[ 313.354101] rtw_8821ce 0000:02:00.0: timed out to flush queue 1
[ 313.491047] rtw_8821ce 0000:02:00.0: timed out to flush queue 2
[ 316.712425] rtw_8821ce 0000:02:00.0: timed out to flush queue 2
[ 316.845696] rtw_8821ce 0000:02:00.0: timed out to flush queue 2
[ 336.330094] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 356.241421] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 405.398998] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 411.844824] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 414.609353] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 444.721535] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 516.907044] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 572.202981] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 578.347024] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 600.772368] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 600.778813] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 608.253864] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 626.068674] rtw_8821ce 0000:02:00.0: timed out to flush queue 2
[ 626.202388] rtw_8821ce 0000:02:00.0: timed out to flush queue 2
[ 740.597628] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 762.674019] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 774.345416] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 784.170788] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 817.655657] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 828.337950] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 838.238171] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 838.545175] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 847.459840] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 856.055313] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 877.461519] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 877.564828] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 892.305130] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 893.210076] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 904.291958] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 905.418115] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 919.953137] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 942.586613] rtw_8821ce 0000:02:00.0: timed out to flush queue 2
[ 942.719846] rtw_8821ce 0000:02:00.0: timed out to flush queue 2
[ 979.863779] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 981.697087] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 996.759554] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
[ 999.522732] rtw_8821ce 0000:02:00.0: unhandled firmware c2h interrupt
```

Last edited by danielem (2023-06-18 07:35:58)

ugjka · 2023-06-18 07:39:17

What does this say?

systemctl status --user xdg-desktop-portal-gtk.service

danielem · 2023-06-18 08:04:35

ugjka wrote:

What does this say?

systemctl status --user xdg-desktop-portal-gtk.service

● xdg-desktop-portal-gtk.service - Portal service (GTK/GNOME implementation)
     Loaded: loaded (/usr/lib/systemd/user/xdg-desktop-portal-gtk.service; static)
     Active: active (running) since Sun 2023-06-18 10:09:33 EEST; 53min ago
   Main PID: 785 (xdg-desktop-por)
      Tasks: 5 (limit: 18378)
     Memory: 8.8M
        CPU: 109ms
     CGroup: /user.slice/user-1001.slice/user@1001.service/app.slice/xdg-desktop-portal-gtk.service
             └─785 /usr/lib/xdg-desktop-portal-gtk

Jun 18 10:09:33 comp systemd[552]: Starting Portal service (GTK/GNOME implementation)...
Jun 18 10:09:33 comp systemd[552]: Started Portal service (GTK/GNOME implementation).

ugjka · 2023-06-19 07:49:48

Ok, now check these.

systemctl --user status --failed
systemctl status --failed
journalctl -p err --no-pager

Last edited by ugjka (2023-06-19 07:51:02)

danielem · 2023-06-20 05:43:56

ugjka wrote:

Ok, now check these.

systemctl --user status --failed
systemctl status --failed
journalctl -p err --no-pager

systemctl status --failed

returns nothing

systemctl --user status --failed


× xdg-desktop-portal.service - Portal service
     Loaded: loaded (/usr/lib/systemd/user/xdg-desktop-portal.service; static)
     Active: failed (Result: timeout) since Tue 2023-06-20 08:24:58 EEST; 9min ago
    Process: 671 ExecStart=/usr/lib/xdg-desktop-portal (code=killed, signal=TERM)
   Main PID: 671 (code=killed, signal=TERM)
        CPU: 30ms

Jun 20 08:23:28 comp systemd[555]: Starting Portal service...
Jun 20 08:24:18 comp xdg-desktop-por[671]: Failed to create settings proxy: Error calling StartServiceByName for org.freedesktop.impl.portal.desktop.gnome: Timeout was reached
Jun 20 08:24:58 comp systemd[555]: xdg-desktop-portal.service: start operation timed out. Terminating.
Jun 20 08:24:58 comp systemd[555]: xdg-desktop-portal.service: Failed with result 'timeout'.
Jun 20 08:24:58 comp systemd[555]: Failed to start Portal service.

journalctl -p err --no-pager

....
Jun 20 00:33:21 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:21 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:21 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:22 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:22 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
Jun 20 00:33:23 comp kernel: rtw_8821ce 0000:02:00.0: failed to send h2c command
-- Boot 29b315606b024298bed32df304cd9697 --
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P000 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P001 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P002 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P003 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P004 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P005 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P006 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P007 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P008 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P009 (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00A (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00B (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00C (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00D (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00E (20221020/dspkginit-438)
Jun 20 08:22:47 comp kernel: ACPI Error: AE_NOT_FOUND, While resolving a named reference package element - \_PR_.P00F (20221020/dspkginit-438)
Jun 20 08:22:50 comp bluetoothd[455]: src/plugin.c:plugin_init() Failed to init vcp plugin
Jun 20 08:22:50 comp bluetoothd[455]: src/plugin.c:plugin_init() Failed to init mcp plugin
Jun 20 08:22:50 comp bluetoothd[455]: src/plugin.c:plugin_init() Failed to init bap plugin
Jun 20 08:22:51 comp kernel: amdgpu 0000:04:00.0: amdgpu: Secure display: Generic Failure.
Jun 20 08:22:51 comp kernel: amdgpu 0000:04:00.0: amdgpu: SECUREDISPLAY: query securedisplay TA failed. ret 0x0
Jun 20 08:23:25 comp login[493]: gkr-pam: unable to locate daemon control file
Jun 20 08:24:58 comp systemd[555]: Failed to start Portal service.

danielem · 2023-06-20 05:52:53

sudo pacman -Sy xdg-desktop-portal
sudo systemctl restart xdg-desktop-portal.service

Failed to restart xdg-desktop-portal.service: Unit xdg-desktop-portal.service not found.

icar · 2023-06-20 06:47:25

https://wiki.archlinux.org/title/XDG_De … interfaces

Choose what fits your DE

progandy · 2023-06-20 07:15:20

Jun 20 08:24:18 comp xdg-desktop-por[671]: Failed to create settings proxy: Error calling StartServiceByName for org.freedesktop.impl.portal.desktop.gnome: Timeout was reached

You probably have to remove xdg-desktop-portal-gnome. The gnome portal does not quickly detect it is not running in gnome and waits until a timeout is reached instead of exiting early. There are some fixes being worked on, but I don't remember the state of those.

danielem · 2023-06-20 08:35:20

icar wrote:

https://wiki.archlinux.org/title/XDG_De … interfaces
Choose what fits your DE

oh, interesting...

Normally using sway with wayland, but from time to time have issues with zoom and using gnome instead. They "sort of" coexisted w/o issues until recently.

Vedun · 2023-06-20 08:36:45

Roll back xdg-desktop-portal-gnome to version 43.1

https://gitlab.gnome.org/GNOME/xdg-desk … /issues/86

Last edited by Vedun (2023-06-20 08:37:15)

ugjka · 2023-06-24 14:30:41

you can systemd "mask" the gnome portal if it comes as an dependency

danielem · 2023-09-01 17:50:13

Got so used to that is starts so long, that till yesterday was working with that issue, but finally got a moment and decided to just remove gnome, including it's xdg and that did work like a charm!

THANKS!

Arch Linux

#1 2023-06-18 07:35:20

sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#2 2023-06-18 07:39:17

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#3 2023-06-18 08:04:35

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#4 2023-06-19 07:49:48

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#5 2023-06-20 05:43:56

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#6 2023-06-20 05:52:53

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#7 2023-06-20 06:47:25

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#8 2023-06-20 07:15:20

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#9 2023-06-20 08:35:20

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#10 2023-06-20 08:36:45

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#11 2023-06-24 14:30:41

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

#12 2023-09-01 17:50:13

Re: sway, firefox and etc - takes ~25 sec to start - ryzen 5700U

Board footer