System unusable after Suspend to RAM

Hi there,

two weeks ago I had to reinstall Manjaro. Everything went fine, except Suspend to Ram function. After waking up from suspend mode the system behaves like heavy swapping ending in a distorted display.

These are my specs:

$ inxi -MG
Machine:
  Type: Desktop Mobo: ASUSTeK model: PRIME X570-P v: Rev X.0x
    serial: <superuser required> UEFI: American Megatrends v: 4403
    date: 04/28/2022
Graphics:
  Device-1: AMD Navi 10 [Radeon RX 5600 OEM/5600 XT / 5700/5700 XT]
    driver: amdgpu v: kernel
  Display: x11 server: X.Org v: 21.1.4 driver: X: loaded: amdgpu
    unloaded: modesetting,radeon gpu: amdgpu resolution: 1: 1280x1024~60Hz
    2: 2560x1440~144Hz
  OpenGL: renderer: AMD Radeon RX 5700 XT (navi10 LLVM 14.0.6 DRM 3.47
    5.19.0-1-MANJARO) v: 4.6 Mesa 22.1.4

I have 32GB memory and a swap partition on SSD:

$ swapon
NAME      TYPE       SIZE USED PRIO
/dev/sda3 partition 43,9G   0B   -2

I’ve tried both recent kernels 5.18 and 5.19, with the same result. During my attempts I’ve disabled watchdog, but this did no better.

Any ideas please?

EDIT: Just found that waking up is fine after typing “systemctl suspend”; the problem endures when using Standby button from the start menu.

Hello,

What DE? That Standby might not do the same thing as systemctl suspend …

I’m using XFCE as DE.

So: suspend to RAM works just fine.

Your system might try to hibernate (instead of what you want: suspend)
and your swap might not be configured to be used

grep ^GRUB_CMDLINE /etc/default/grub

together with:

grep ^HOOKS /etc/mkinitcpio.conf

should tell

whether it is configured correctly

Is this correct?

$ grep ^GRUB_CMDLINE /etc/default/grub
GRUB_CMDLINE_LINUX_DEFAULT="quiet nmi_watchdog=0 apparmor=1 security=apparmor acpi_osi=Linux udev.log_priority=3 resume=UUID=de049378-2aff-4748-ba51-ab71f18e3b4f"
$ grep ^HOOKS /etc/mkinitcpio.conf
HOOKS="base udev autodetect modconf block keyboard keymap consolefont filesystems resume fsck"

I’m using this partition in /etc/fstab:

sda3      swap   1            de049378-2aff-4748-ba51-ab71f18e3b4f                [SWAP]
└─sda

Swap should be big enough?

$ free -h
              gesamt       benutzt     frei      gemns.  Puffer/Cache verfĂĽgbar
Speicher:       31Gi       5,9Gi        23Gi        97Mi       1,7Gi        24Gi
Swap:           43Gi          0B        43Gi

This looks o.k. to me - the swap is there, it is referred to correctly in /etc/default/grub
and resume is also in /etc/mkinitcpio.conf.

So now we need to figure out what the difference is between running
systemctl suspend
in a terminal (which works)
and you trying the (supposedly) same via the Xfce GUI (which for some reason doesn’t work)

However:
suspend to RAM does not need any of this - swap is not needed here.
only to hibernate the system (suspend to disk) is swap needed.

At the moment: I don’t know how to assess this.

OK, the issue got worse: Using systemctl suspend brings up the same problem now. I can still login again, but after some seconds the screen gets distorted. :frowning:

Maybe this is due to the amdgpu driver? In my old installation of Manjaro I had amdgpu-pro driver from AUR in use and everything was fine.

Is there a means to get that installed again?

Do you want to solve the issue by installing a driver that (till now) no one but you knows
or do you want see what the problem currently is?

Have a look at the system logs to see whether there is something helpful around the time this happens.
If something happens, there should be something in the logs about it.

OK, this is from journalctl (grep error):

Aug 05 00:24:09 shaun pulseaudio[1495]: ICE I/O error handler called
Aug 05 00:24:18 shaun xdg-desktop-por[1853]: Caught PipeWire error: connection error
Aug 05 01:12:57 shaun xdg-desktop-por[1867]: Caught PipeWire error: connection error
Aug 05 01:14:53 shaun pulseaudio[1497]: ICE I/O error handler called
Aug 05 01:14:53 shaun pulseaudio[1497]: X11 I/O error handler called
Aug 05 01:14:53 shaun pulseaudio[1497]: X11 I/O error exit handler called, preparing to tear down X11 modules
Aug 05 01:19:23 shaun gvfsd[2653]: PTP: reading event an error 0x05 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:20 shaun gvfsd[2724]: PTP: reading event an error 0x01 occurred
Aug 05 01:20:21 shaun gvfsd[2724]: PTP: reading event an error 0x05 occurred
Aug 05 01:28:35 shaun pulseaudio[1541]: ICE I/O error handler called
Aug 05 01:28:35 shaun vlc[2866]: The X11 connection broke: I/O error (code 1)
Aug 05 01:28:35 shaun pulseaudio[1541]: X11 I/O error handler called
Aug 05 01:28:35 shaun pulseaudio[1541]: X11 I/O error exit handler called, preparing to tear down X11 modules
Aug 05 01:28:35 shaun vlc[2866]: The X11 connection broke: I/O error (code 1)
Aug 05 01:28:35 shaun kernel: traps: vlc[2917] general protection fault ip:7f3441c40e5c sp:7f33d42cb770 error:0 in libc.so.6[7f3441c28000+178000]
Aug 05 01:45:07 shaun xdg-desktop-por[1870]: Caught PipeWire error: connection error
Aug 05 12:27:29 shaun org.freedesktop.thumbnails.Thumbnailer1[3415]: error: Could not find thumbnail in zip file
Aug 05 13:24:00 shaun pulseaudio[1507]: ICE I/O error handler called

you assume that the word error will lead you to relevant parts of the log
a fair assumption - but only looking at the lines where the word actually appears
narrows it down way too much

the appropriate journalctl command will let you select the time frame you want to look at
then you
scroll through and read all of it
(not a bad way to inspect logs if you don’t already know what you are looking for …)
and/or
you can type Shift + / (to search for a keyword in the whole output), but still see what came immediately before or after for context.

“suspend” would be one keyword I’d look for and the context around it … :wink:

It’s the same key combination as when you read a file through less - it lets you search within the active output.

You don’t need to put everything here unless you think you found something and don’t know how to interpret it.

1 Like

I found the following errors from amdgpu:

Jul 26 08:52:42 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* ring gfx_0.0.0 timeout, but soft recovered
Jul 26 08:52:46 shaun systemd[1]: NetworkManager-dispatcher.service: Deactivated successfully.
Jul 26 08:52:46 shaun audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm="systemd" exe="/usr/lib/syste>
Jul 26 08:52:46 shaun kernel: audit: type=1131 audit(1658818366.823:129): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm=>
Jul 26 08:52:52 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* ring gfx_0.0.0 timeout, signaled seq=28182, emitted seq=28185
Jul 26 08:52:52 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* Process information: process Xorg pid 1185 thread Xorg:cs0 pid 1270
Jul 26 08:52:52 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU reset begin!
Jul 26 08:52:56 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: failed to suspend display audio
Jul 26 08:52:56 shaun kernel: amdgpu 0000:0a:00.0: [drm:amdgpu_ring_test_helper [amdgpu]] *ERROR* ring kiq_2.1.0 test failed (-110)
Jul 26 08:52:56 shaun kernel: [drm:gfx_v10_0_hw_fini [amdgpu]] *ERROR* KGQ disable failed
Jul 26 08:52:57 shaun kernel: [drm:gfx_v10_0_hw_fini [amdgpu]] *ERROR* failed to halt cp gfx
Jul 26 08:52:57 shaun kernel: [drm] free PSP TMR buffer
Jul 26 08:52:57 shaun kernel: CPU: 1 PID: 190 Comm: kworker/u64:5 Tainted: G           OE     5.19.0-1-MANJARO #1 4946012fba2a0e3af1861ba0d9d5e240a6489637
Jul 26 08:52:57 shaun kernel: Hardware name: System manufacturer System Product Name/PRIME X570-P, BIOS 4403 04/28/2022
Jul 26 08:52:57 shaun kernel: Workqueue: amdgpu-reset-dev drm_sched_job_timedout [gpu_sched]
Jul 26 08:52:57 shaun kernel: Call Trace:
Jul 26 08:52:57 shaun kernel:  <TASK>
Jul 26 08:52:57 shaun kernel:  dump_stack_lvl+0x48/0x60
Jul 26 08:52:57 shaun kernel:  amdgpu_do_asic_reset+0x2a/0x459 [amdgpu 9716b7041163c90c6b7c2daffb216cc1bb7904c1]
Jul 26 08:52:57 shaun kernel:  amdgpu_device_gpu_recover_imp.cold+0x54a/0x8e1 [amdgpu 9716b7041163c90c6b7c2daffb216cc1bb7904c1]
Jul 26 08:52:57 shaun kernel:  amdgpu_job_timedout+0x18f/0x1c0 [amdgpu 9716b7041163c90c6b7c2daffb216cc1bb7904c1]
Jul 26 08:52:57 shaun kernel:  drm_sched_job_timedout+0x7a/0x110 [gpu_sched 2eed1392762e7c8d0b3499e51682ff20f6c1901a]
Jul 26 08:52:57 shaun kernel:  process_one_work+0x1c7/0x380
Jul 26 08:52:57 shaun kernel:  worker_thread+0x51/0x390
Jul 26 08:52:57 shaun kernel:  ? rescuer_thread+0x3b0/0x3b0
Jul 26 08:52:57 shaun kernel:  kthread+0xde/0x110
Jul 26 08:52:57 shaun kernel:  ? kthread_complete_and_exit+0x20/0x20
Jul 26 08:52:57 shaun kernel:  ret_from_fork+0x22/0x30
Jul 26 08:52:57 shaun kernel:  </TASK>
Jul 26 08:52:57 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: BACO reset
Jul 26 08:52:58 shaun kernel: r8169 0000:04:00.0 enp4s0: Link is Down
Jul 26 08:53:00 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU reset succeeded, trying to resume
Jul 26 08:53:00 shaun kernel: [drm] PCIE GART of 512M enabled (table at 0x0000008000300000)

I also found this from lightdm:

Aug 05 20:33:07 shaun avahi-daemon[972]: Registering new address record for 192.168.178.27 on enp4s0.IPv4.
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.8792] device (enp4s0): state change: ip-config -> ip-check (reason 'none', sys-iface-state: 'managed')
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.8804] device (enp4s0): state change: ip-check -> secondaries (reason 'none', sys-iface-state: 'managed')
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.8806] device (enp4s0): state change: secondaries -> activated (reason 'none', sys-iface-state: 'managed')
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.8808] manager: NetworkManager state is now CONNECTED_LOCAL
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.8810] manager: NetworkManager state is now CONNECTED_SITE
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.8811] policy: set 'Kabelgebundene Verbindung 1' (enp4s0) as default for IPv4 routing and DNS
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.8813] policy: set 'Kabelgebundene Verbindung 1' (enp4s0) as default for IPv6 routing and DNS
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.8875] device (enp4s0): Activation: successful, device activated.
Aug 05 20:33:07 shaun NetworkManager[987]: <info>  [1659724387.9680] manager: NetworkManager state is now CONNECTED_GLOBAL
Aug 05 20:33:12 shaun lightdm[14800]: gkr-pam: unable to locate daemon control file
Aug 05 20:33:12 shaun audit[14800]: USER_AUTH pid=14800 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:authentication grantors=pam_shells,pam_faillock,pam_p>
Aug 05 20:33:12 shaun audit[14800]: USER_ACCT pid=14800 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:accounting grantors=pam_access,pam_unix,pam_permit,pa>
Aug 05 20:33:12 shaun lightdm[14800]: gkr-pam: stashed password to try later in open session
Aug 05 20:33:12 shaun kernel: kauditd_printk_skb: 2 callbacks suppressed

there is nothing about suspend in there
and only, at the very last line, something about resume (which apparently fails, as you say)
but the log (the part you posted) does stop short of any possible info

I’m not the log interpretation guru.

post full log spanning before suspend till after resume and subsequent fail
if you can’t make anything out, someone else might be able to

you keep posting snippets with really nothing in them relating to your wake from suspend issue

from the messages I deduce you are german:
Du muĂźt Kontext liefern - den suspend sieht man definitiv im Log (hier aber nicht).
Danach sollte dann die relevante Info kommen.

Okay, this is a bit long, but hopefully someone can help:

Aug 05 23:09:55 shaun rtkit-daemon[1514]: Supervising 0 threads of 0 processes of 0 users.
Aug 05 23:09:55 shaun rtkit-daemon[1514]: Supervising 0 threads of 0 processes of 0 users.
Aug 05 23:10:15 shaun ModemManager[1017]: <info>  [sleep-monitor] system is about to suspend
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6063] manager: sleep: sleep requested (sleeping: no  enabled: yes)
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6064] manager: NetworkManager state is now ASLEEP
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6065] device (enp4s0): state change: activated -> deactivating (reason 'sleeping', sys-iface-state: 'managed')
Aug 05 23:10:15 shaun dbus-daemon[982]: [system] Activating via systemd: service name='org.freedesktop.nm_dispatcher' unit='dbus-org.freedesktop.nm-dispatcher.service' request>
Aug 05 23:10:15 shaun systemd[1]: Starting Network Manager Script Dispatcher Service...
Aug 05 23:10:15 shaun dbus-daemon[982]: [system] Successfully activated service 'org.freedesktop.nm_dispatcher'
Aug 05 23:10:15 shaun systemd[1]: Started Network Manager Script Dispatcher Service.
Aug 05 23:10:15 shaun audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm="systemd" exe="/usr/lib/syst>
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6137] device (enp4s0): state change: deactivating -> disconnected (reason 'sleeping', sys-iface-state: 'managed')
Aug 05 23:10:15 shaun avahi-daemon[980]: Withdrawing address record for 2001:16b8:f8b:6200:a63f:e323:e1c2:fb08 on enp4s0.
Aug 05 23:10:15 shaun avahi-daemon[980]: Leaving mDNS multicast group on interface enp4s0.IPv6 with address 2001:16b8:f8b:6200:a63f:e323:e1c2:fb08.
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6140] dhcp4 (enp4s0): canceled DHCP transaction
Aug 05 23:10:15 shaun avahi-daemon[980]: Joining mDNS multicast group on interface enp4s0.IPv6 with address fe80::bae2:9beb:712:d278.
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6140] dhcp4 (enp4s0): activation: beginning transaction (timeout in 45 seconds)
Aug 05 23:10:15 shaun avahi-daemon[980]: Registering new address record for fe80::bae2:9beb:712:d278 on enp4s0.*.
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6140] dhcp4 (enp4s0): state changed no lease
Aug 05 23:10:15 shaun avahi-daemon[980]: Withdrawing address record for fe80::bae2:9beb:712:d278 on enp4s0.
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6141] dhcp6 (enp4s0): canceled DHCP transaction
Aug 05 23:10:15 shaun avahi-daemon[980]: Leaving mDNS multicast group on interface enp4s0.IPv6 with address fe80::bae2:9beb:712:d278.
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6141] dhcp6 (enp4s0): activation: beginning transaction (timeout in 45 seconds)
Aug 05 23:10:15 shaun avahi-daemon[980]: Interface enp4s0.IPv6 no longer relevant for mDNS.
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6141] dhcp6 (enp4s0): state changed no lease
Aug 05 23:10:15 shaun kernel: audit: type=1130 audit(1659733815.610:187): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm=>
Aug 05 23:10:15 shaun avahi-daemon[980]: Withdrawing address record for 192.168.178.27 on enp4s0.
Aug 05 23:10:15 shaun avahi-daemon[980]: Leaving mDNS multicast group on interface enp4s0.IPv4 with address 192.168.178.27.
Aug 05 23:10:15 shaun avahi-daemon[980]: Interface enp4s0.IPv4 no longer relevant for mDNS.
Aug 05 23:10:15 shaun NetworkManager[994]: <info>  [1659733815.6211] device (enp4s0): state change: disconnected -> unmanaged (reason 'sleeping', sys-iface-state: 'managed')
Aug 05 23:10:15 shaun kernel: r8169 0000:04:00.0 enp4s0: Link is Down
Aug 05 23:10:15 shaun systemd[1]: Reached target Sleep.
Aug 05 23:10:15 shaun systemd[1]: Starting System Suspend...
Aug 05 23:10:15 shaun systemd-sleep[26802]: Entering sleep state 'suspend'...
Aug 05 23:10:15 shaun kernel: PM: suspend entry (deep)
Aug 05 23:12:20 shaun kernel: Filesystems sync: 0.009 seconds
Aug 05 23:12:20 shaun kernel: Freezing user space processes ... (elapsed 0.001 seconds) done.
Aug 05 23:12:20 shaun kernel: OOM killer disabled.
Aug 05 23:12:20 shaun kernel: Freezing remaining freezable tasks ... (elapsed 0.001 seconds) done.
Aug 05 23:12:20 shaun kernel: printk: Suspending console(s) (use no_console_suspend to debug)
Aug 05 23:12:20 shaun kernel: serial 00:04: disabled
Aug 05 23:12:20 shaun kernel: sd 3:0:0:0: [sda] Synchronizing SCSI cache
Aug 05 23:12:20 shaun kernel: sd 4:0:0:0: [sdb] Synchronizing SCSI cache
Aug 05 23:12:20 shaun kernel: sd 8:0:0:0: [sdc] Synchronizing SCSI cache
Aug 05 23:12:20 shaun kernel: sd 3:0:0:0: [sda] Stopping disk
Aug 05 23:12:20 shaun kernel: sd 4:0:0:0: [sdb] Stopping disk
Aug 05 23:12:20 shaun kernel: sd 8:0:0:0: [sdc] Stopping disk
Aug 05 23:12:20 shaun kernel: [drm] free PSP TMR buffer
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: MODE1 reset
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU mode1 reset
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU psp mode1 reset
Aug 05 23:12:20 shaun kernel: [drm] psp mode1 reset succeed 
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: Refused to change power state from D0 to D3hot
Aug 05 23:12:20 shaun kernel: ACPI: PM: Preparing to enter system sleep state S3
Aug 05 23:12:20 shaun kernel: ACPI: PM: Saving platform NVS memory
Aug 05 23:12:20 shaun kernel: Disabling non-boot CPUs ...
Aug 05 23:12:20 shaun kernel: smpboot: CPU 1 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 2 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 3 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 4 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 5 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 6 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 7 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 8 is now offline
Aug 05 23:12:20 shaun kernel: Spectre V2 : Update user space SMT mitigation: STIBP off
Aug 05 23:12:20 shaun kernel: smpboot: CPU 9 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 10 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 11 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 12 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 13 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 14 is now offline
Aug 05 23:12:20 shaun kernel: smpboot: CPU 15 is now offline
Aug 05 23:12:20 shaun kernel: ACPI: PM: Low-level resume complete
Aug 05 23:12:20 shaun kernel: ACPI: PM: Restoring platform NVS memory
Aug 05 23:12:20 shaun kernel: LVT offset 0 assigned for vector 0x400
Aug 05 23:12:20 shaun kernel: Enabling non-boot CPUs ...
Aug 05 23:12:20 shaun kernel: x86: Booting SMP configuration:
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 1 APIC 0x2
Aug 05 23:12:20 shaun kernel: microcode: CPU1: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C002: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU1 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 2 APIC 0x4
Aug 05 23:12:20 shaun kernel: microcode: CPU2: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C004: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU2 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 3 APIC 0x6
Aug 05 23:12:20 shaun kernel: microcode: CPU3: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C006: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU3 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 4 APIC 0x8
Aug 05 23:12:20 shaun kernel: microcode: CPU4: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C008: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU4 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 5 APIC 0xa
Aug 05 23:12:20 shaun kernel: microcode: CPU5: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C00A: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU5 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 6 APIC 0xc
Aug 05 23:12:20 shaun kernel: microcode: CPU6: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C00C: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU6 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 7 APIC 0xe
Aug 05 23:12:20 shaun kernel: microcode: CPU7: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C00E: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU7 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 8 APIC 0x1
Aug 05 23:12:20 shaun kernel: microcode: CPU8: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C001: Found 2 idle states
Aug 05 23:12:20 shaun kernel: Spectre V2 : Update user space SMT mitigation: STIBP always-on
Aug 05 23:12:20 shaun kernel: CPU8 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 9 APIC 0x3
Aug 05 23:12:20 shaun kernel: microcode: CPU9: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C003: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU9 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 10 APIC 0x5
Aug 05 23:12:20 shaun kernel: microcode: CPU10: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C005: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU10 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 11 APIC 0x7
Aug 05 23:12:20 shaun kernel: microcode: CPU11: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C007: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU11 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 12 APIC 0x9
Aug 05 23:12:20 shaun kernel: microcode: CPU12: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C009: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU12 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 13 APIC 0xb
Aug 05 23:12:20 shaun kernel: microcode: CPU13: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C00B: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU13 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 14 APIC 0xd
Aug 05 23:12:20 shaun kernel: microcode: CPU14: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C00D: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU14 is up
Aug 05 23:12:20 shaun kernel: smpboot: Booting Node 0 Processor 15 APIC 0xf
Aug 05 23:12:20 shaun kernel: microcode: CPU15: patch_level=0x08701021
Aug 05 23:12:20 shaun kernel: ACPI: \_PR_.C00F: Found 2 idle states
Aug 05 23:12:20 shaun kernel: CPU15 is up
Aug 05 23:12:20 shaun kernel: ACPI: PM: Waking up from system sleep state S3
Aug 05 23:12:20 shaun kernel: sd 4:0:0:0: [sdb] Starting disk
Aug 05 23:12:20 shaun kernel: sd 3:0:0:0: [sda] Starting disk
Aug 05 23:12:20 shaun kernel: sd 8:0:0:0: [sdc] Starting disk
Aug 05 23:12:20 shaun kernel: serial 00:04: activated
Aug 05 23:12:20 shaun kernel: nvme nvme0: Shutdown timeout set to 8 seconds
Aug 05 23:12:20 shaun kernel: nvme nvme0: 32/0/0 default/read/poll queues
Aug 05 23:12:20 shaun kernel: ata10: SATA link up 1.5 Gbps (SStatus 113 SControl 300)
Aug 05 23:12:20 shaun kernel: ata5: SATA link up 6.0 Gbps (SStatus 133 SControl 300)
Aug 05 23:12:20 shaun kernel: ata4: SATA link up 6.0 Gbps (SStatus 133 SControl 300)
Aug 05 23:12:20 shaun kernel: ata9: SATA link up 6.0 Gbps (SStatus 133 SControl 300)
Aug 05 23:12:20 shaun kernel: ata9.00: supports DRM functions and may not be fully accessible
Aug 05 23:12:20 shaun kernel: ata5.00: supports DRM functions and may not be fully accessible
Aug 05 23:12:20 shaun kernel: ata9.00: supports DRM functions and may not be fully accessible
Aug 05 23:12:20 shaun kernel: ata5.00: supports DRM functions and may not be fully accessible
Aug 05 23:12:20 shaun kernel: ata4.00: configured for UDMA/133
Aug 05 23:12:20 shaun kernel: ata9.00: configured for UDMA/133
Aug 05 23:12:20 shaun kernel: ata5.00: configured for UDMA/133
Aug 05 23:12:20 shaun kernel: ata10.00: configured for UDMA/133
Aug 05 23:12:20 shaun kernel: ata9.00: Enabling discard_zeroes_data
Aug 05 23:12:20 shaun kernel: ata5.00: Enabling discard_zeroes_data
Aug 05 23:12:20 shaun kernel: [drm] PCIE GART of 512M enabled (table at 0x0000008000300000).
Aug 05 23:12:20 shaun kernel: [drm] PSP is resuming...
Aug 05 23:12:20 shaun kernel: [drm] reserve 0x7200000 from 0x81f7c00000 for PSP TMR
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: RAS: optional ras ta ucode is not available
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: RAP: optional rap ta ucode is not available
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SECUREDISPLAY: securedisplay ta ucode is not available
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SMU is resuming...
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: smu driver if version = 0x00000037, smu fw if version = 0x00000033, smu fw program = 0, version = 0x002a1f00 (42.31.>
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SMU driver if version not matched
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: use vbios provided pptable
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: smc_dpm_info table revision(format.content): 4.5
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SMU is resumed successfully!
Aug 05 23:12:20 shaun kernel: [drm] kiq ring mec 2 pipe 1 q 0
Aug 05 23:12:20 shaun kernel: [drm] VCN decode and encode initialized successfully(under DPG Mode).
Aug 05 23:12:20 shaun kernel: [drm] JPEG decode initialized successfully.
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring gfx_0.0.0 uses VM inv eng 0 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring comp_1.0.0 uses VM inv eng 1 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring comp_1.1.0 uses VM inv eng 4 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring comp_1.2.0 uses VM inv eng 5 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring comp_1.3.0 uses VM inv eng 6 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring comp_1.0.1 uses VM inv eng 7 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring comp_1.1.1 uses VM inv eng 8 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring comp_1.2.1 uses VM inv eng 9 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring comp_1.3.1 uses VM inv eng 10 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring kiq_2.1.0 uses VM inv eng 11 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring sdma0 uses VM inv eng 12 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring sdma1 uses VM inv eng 13 on hub 0
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring vcn_dec uses VM inv eng 0 on hub 1
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring vcn_enc0 uses VM inv eng 1 on hub 1
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring vcn_enc1 uses VM inv eng 4 on hub 1
Aug 05 23:12:20 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: ring jpeg_dec uses VM inv eng 5 on hub 1
Aug 05 23:12:20 shaun kernel: OOM killer enabled.
Aug 05 23:12:20 shaun kernel: Restarting tasks ... done.
Aug 05 23:12:20 shaun kernel: PM: suspend exit
Aug 05 23:12:20 shaun systemd-sleep[26802]: System returned from sleep state.
Aug 05 23:12:20 shaun systemd[1]: systemd-suspend.service: Deactivated successfully.
Aug 05 23:12:20 shaun systemd[1]: Finished System Suspend.
Aug 05 23:12:20 shaun audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=systemd-suspend comm="systemd" exe="/usr/lib/systemd/system>
Aug 05 23:12:20 shaun audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=systemd-suspend comm="systemd" exe="/usr/lib/systemd/systemd>
Aug 05 23:12:20 shaun systemd[1]: Stopped target Sleep.
Aug 05 23:12:20 shaun systemd[1]: Reached target Suspend.
Aug 05 23:12:20 shaun systemd[1]: Stopped target Suspend.
Aug 05 23:12:20 shaun systemd-logind[985]: Operation 'sleep' finished.
Aug 05 23:12:20 shaun ModemManager[1017]: <info>  [sleep-monitor] system is resuming
Aug 05 23:12:20 shaun NetworkManager[994]: <info>  [1659733940.9785] manager: sleep: wake requested (sleeping: yes  enabled: yes)
Aug 05 23:12:20 shaun NetworkManager[994]: <info>  [1659733940.9785] device (enp4s0): state change: unmanaged -> unavailable (reason 'managed', sys-iface-state: 'external')
Aug 05 23:12:20 shaun kernel: audit: type=1130 audit(1659733940.973:188): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=systemd-suspend comm="systemd" >
Aug 05 23:12:20 shaun kernel: audit: type=1131 audit(1659733940.973:189): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=systemd-suspend comm="systemd" >
Aug 05 23:12:21 shaun kernel: Generic FE-GE Realtek PHY r8169-0-400:00: attached PHY driver (mii_bus:phy_addr=r8169-0-400:00, irq=MAC)
Aug 05 23:12:21 shaun NetworkManager[994]: <info>  [1659733941.1994] manager: NetworkManager state is now DISCONNECTED
Aug 05 23:12:21 shaun kernel: r8169 0000:04:00.0 enp4s0: Link is Down
Aug 05 23:12:23 shaun ModemManager[1017]: <info>  [base-manager] couldn't check support for device '/sys/devices/pci0000:00/0000:00:01.2/0000:02:00.0/0000:03:05.0/0000:04:00.0>
Aug 05 23:12:26 shaun systemd[1]: NetworkManager-dispatcher.service: Deactivated successfully.
Aug 05 23:12:26 shaun audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm="systemd" exe="/usr/lib/syste>
Aug 05 23:12:26 shaun kernel: audit: type=1131 audit(1659733946.513:190): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm=>
Aug 05 23:12:32 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* ring gfx_0.0.0 timeout, but soft recovered
Aug 05 23:12:33 shaun audit[27199]: CRED_ACQ pid=27199 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:setcred grantors=pam_env,pam_permit acct="lightdm" exe>
Aug 05 23:12:33 shaun lightdm[27199]: pam_unix(lightdm-greeter:session): session opened for user lightdm(uid=966) by (uid=0)
Aug 05 23:12:33 shaun systemd[1]: Created slice User Slice of UID 966.
ug 05 23:12:33 shaun kernel: audit: type=1103 audit(1659733953.003:191): pid=27199 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:setcred grantors=pam_env,>
Aug 05 23:12:33 shaun systemd[1]: Starting User Runtime Directory /run/user/966...
Aug 05 23:12:33 shaun systemd-logind[985]: New session c3 of user lightdm.
Aug 05 23:12:33 shaun systemd[1]: Finished User Runtime Directory /run/user/966.
Aug 05 23:12:33 shaun audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=user-runtime-dir@966 comm="systemd" exe="/usr/lib/systemd/s>
Aug 05 23:12:33 shaun systemd[1]: Starting User Manager for UID 966...
Aug 05 23:12:33 shaun kernel: audit: type=1130 audit(1659733953.013:192): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=user-runtime-dir@966 comm="syst>
Aug 05 23:12:33 shaun dbus-daemon[982]: [system] Activating via systemd: service name='org.freedesktop.home1' unit='dbus-org.freedesktop.home1.service' requested by ':1.226' (>
Aug 05 23:12:33 shaun dbus-daemon[982]: [system] Activation via systemd failed for unit 'dbus-org.freedesktop.home1.service': Unit dbus-org.freedesktop.home1.service not found.
Aug 05 23:12:33 shaun systemd[27203]: pam_systemd_home(systemd-user:account): systemd-homed is not available: Unit dbus-org.freedesktop.home1.service not found.
Aug 05 23:12:33 shaun audit[27203]: USER_ACCT pid=27203 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:accounting grantors=pam_access,pam_unix,pam_permit,pa>
Aug 05 23:12:33 shaun audit[27203]: CRED_ACQ pid=27203 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:setcred grantors=? acct="lightdm" exe="/usr/lib/system>
Aug 05 23:12:33 shaun audit[27203]: SYSCALL arch=c000003e syscall=1 success=yes exit=3 a0=9 a1=7ffdf2be6b00 a2=3 a3=7ffdf2be6815 items=0 ppid=1 pid=27203 auid=966 uid=0 gid=0 >
Aug 05 23:12:33 shaun audit: PROCTITLE proctitle="(systemd)"
Aug 05 23:12:33 shaun systemd[27203]: pam_warn(systemd-user:setcred): function=[pam_sm_setcred] flags=0x8002 service=[systemd-user] terminal=[] user=[lightdm] ruser=[<unknown>>
Aug 05 23:12:33 shaun systemd[27203]: pam_unix(systemd-user:session): session opened for user lightdm(uid=966) by (uid=0)
Aug 05 23:12:33 shaun systemd[27203]: pam_env(systemd-user:session): deprecated reading of user environment enabled
Aug 05 23:12:33 shaun audit[27203]: USER_START pid=27203 uid=0 auid=966 ses=5 subj==unconfined msg='op=PAM:session_open grantors=pam_loginuid,pam_loginuid,pam_keyinit,pam_syst>
Aug 05 23:12:33 shaun kernel: audit: type=1101 audit(1659733953.016:193): pid=27203 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:accounting grantors=pam_a>
Aug 05 23:12:33 shaun kernel: audit: type=1103 audit(1659733953.016:194): pid=27203 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:setcred grantors=? acct=">
Aug 05 23:12:33 shaun kernel: audit: type=1006 audit(1659733953.016:195): pid=27203 uid=0 subj==unconfined old-auid=4294967295 auid=966 tty=(none) old-ses=4294967295 ses=5 res>
Aug 05 23:12:33 shaun kernel: audit: type=1300 audit(1659733953.016:195): arch=c000003e syscall=1 success=yes exit=3 a0=9 a1=7ffdf2be6b00 a2=3 a3=7ffdf2be6815 items=0 ppid=1 p>
Aug 05 23:12:33 shaun kernel: audit: type=1327 audit(1659733953.016:195): proctitle="(systemd)"
Aug 05 23:12:33 shaun kernel: audit: type=1105 audit(1659733953.016:196): pid=27203 uid=0 auid=966 ses=5 subj==unconfined msg='op=PAM:session_open grantors=pam_loginuid,pam_lo>
Aug 05 23:12:33 shaun systemd-xdg-autostart-generator[27209]: /etc/xdg/autostart/octopi-notifier.desktop:12: Unknown key name 'SingleMainWindow' in section 'Desktop Entry', ig>
Aug 05 23:12:33 shaun systemd[27203]: Queued start job for default target Main User Target.
Aug 05 23:12:33 shaun systemd[27203]: Created slice User Application Slice.
Aug 05 23:12:33 shaun systemd[27203]: Reached target Paths.
Aug 05 23:12:33 shaun systemd[27203]: Reached target Timers.
Aug 05 23:12:33 shaun systemd[27203]: Starting D-Bus User Message Bus Socket...
Aug 05 23:12:33 shaun systemd[27203]: Listening on GnuPG network certificate management daemon.
Aug 05 23:12:33 shaun systemd[27203]: Listening on GCR ssh-agent wrapper.
Aug 05 23:12:33 shaun systemd[27203]: Listening on GNOME Keyring daemon.
Aug 05 23:12:33 shaun systemd[27203]: Listening on GnuPG cryptographic agent and passphrase cache (access for web browsers).
Aug 05 23:12:33 shaun systemd[27203]: Listening on GnuPG cryptographic agent and passphrase cache (restricted).
Aug 05 23:12:33 shaun systemd[27203]: Listening on GnuPG cryptographic agent (ssh-agent emulation).
Aug 05 23:12:33 shaun systemd[27203]: Listening on GnuPG cryptographic agent and passphrase cache.
Aug 05 23:12:33 shaun systemd[27203]: Listening on p11-kit server.
Aug 05 23:12:33 shaun systemd[27203]: Listening on PipeWire Multimedia System Socket.
Aug 05 23:12:33 shaun systemd[27203]: Listening on Sound System.
Aug 05 23:12:33 shaun systemd[27203]: Listening on D-Bus User Message Bus Socket.
Aug 05 23:12:33 shaun systemd[27203]: Reached target Sockets.
Aug 05 23:12:33 shaun systemd[27203]: Reached target Basic System.
Aug 05 23:12:33 shaun systemd[1]: Started User Manager for UID 966.
Aug 05 23:12:33 shaun audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=user@966 comm="systemd" exe="/usr/lib/systemd/systemd" host>
Aug 05 23:12:33 shaun systemd[27203]: Starting Update XDG user dir configuration...
Aug 05 23:12:33 shaun systemd[1]: Started Session c3 of User lightdm.
Aug 05 23:12:33 shaun systemd[27203]: Finished Update XDG user dir configuration.
Aug 05 23:12:33 shaun systemd[27203]: Reached target Main User Target.
Aug 05 23:12:33 shaun systemd[27203]: Startup finished in 98ms.
Aug 05 23:12:33 shaun kernel: audit: type=1130 audit(1659733953.116:197): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=user@966 comm="systemd" exe="/u>
Aug 05 23:12:33 shaun audit[27199]: USER_START pid=27199 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:session_open grantors=pam_unix,pam_systemd acct="lig>
Aug 05 23:12:33 shaun kernel: audit: type=1105 audit(1659733953.120:198): pid=27199 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:session_open grantors=pam>
Aug 05 23:12:33 shaun systemd[27203]: Created slice User Core Session Slice.
Aug 05 23:12:33 shaun systemd[27203]: Starting D-Bus User Message Bus...
Aug 05 23:12:33 shaun systemd[27203]: Started D-Bus User Message Bus.
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Activating systemd to hand-off: service name='org.a11y.Bus' unit='at-spi-dbus-bus.service' requested by '>
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Successfully activated service 'org.freedesktop.systemd1'
Aug 05 23:12:33 shaun systemd[27203]: Starting Accessibility services bus...
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Successfully activated service 'org.a11y.Bus'
Aug 05 23:12:33 shaun systemd[27203]: Started Accessibility services bus.
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Activating via systemd: service name='org.gtk.vfs.Daemon' unit='gvfs-daemon.service' requested by ':1.3' >
Aug 05 23:12:33 shaun systemd[27203]: Starting Virtual filesystem service...
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Successfully activated service 'org.gtk.vfs.Daemon'
Aug 05 23:12:33 shaun systemd[27203]: Started Virtual filesystem service.
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3962] device (enp4s0): carrier: link connected
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3964] device (enp4s0): state change: unavailable -> disconnected (reason 'carrier-changed', sys-iface-state: 'ma>
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3969] policy: auto-activating connection 'Kabelgebundene Verbindung 1' (ad55eb9f-1dcb-31c0-85cd-ca60ab56b55a)
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3973] device (enp4s0): Activation: starting connection 'Kabelgebundene Verbindung 1' (ad55eb9f-1dcb-31c0-85cd-ca>
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3973] device (enp4s0): state change: disconnected -> prepare (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3976] manager: NetworkManager state is now CONNECTING
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3977] device (enp4s0): state change: prepare -> config (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3981] device (enp4s0): state change: config -> ip-config (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3984] dhcp4 (enp4s0): activation: beginning transaction (timeout in 45 seconds)
Aug 05 23:12:38 shaun kernel: Generic FE-GE Realtek PHY r8169-0-400:00: Downshift occurred from negotiated speed 1Gbps to actual speed 100Mbps, check cabling!
Aug 05 23:12:33 shaun systemd[27203]: Listening on p11-kit server.
Aug 05 23:12:33 shaun systemd[27203]: Listening on PipeWire Multimedia System Socket.
Aug 05 23:12:33 shaun systemd[27203]: Listening on Sound System.
Aug 05 23:12:33 shaun systemd[27203]: Listening on D-Bus User Message Bus Socket.
Aug 05 23:12:33 shaun systemd[27203]: Reached target Sockets.
Aug 05 23:12:33 shaun systemd[27203]: Reached target Basic System.
Aug 05 23:12:33 shaun systemd[1]: Started User Manager for UID 966.
Aug 05 23:12:33 shaun audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=user@966 comm="systemd" exe="/usr/lib/systemd/systemd" host>
Aug 05 23:12:33 shaun systemd[27203]: Starting Update XDG user dir configuration...
Aug 05 23:12:33 shaun systemd[1]: Started Session c3 of User lightdm.
Aug 05 23:12:33 shaun systemd[27203]: Finished Update XDG user dir configuration.
Aug 05 23:12:33 shaun systemd[27203]: Reached target Main User Target.
Aug 05 23:12:33 shaun systemd[27203]: Startup finished in 98ms.
Aug 05 23:12:33 shaun kernel: audit: type=1130 audit(1659733953.116:197): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=user@966 comm="systemd" exe="/u>
Aug 05 23:12:33 shaun audit[27199]: USER_START pid=27199 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:session_open grantors=pam_unix,pam_systemd acct="lig>
Aug 05 23:12:33 shaun kernel: audit: type=1105 audit(1659733953.120:198): pid=27199 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='op=PAM:session_open grantors=pam>
Aug 05 23:12:33 shaun systemd[27203]: Created slice User Core Session Slice.
Aug 05 23:12:33 shaun systemd[27203]: Starting D-Bus User Message Bus...
Aug 05 23:12:33 shaun systemd[27203]: Started D-Bus User Message Bus.
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Activating systemd to hand-off: service name='org.a11y.Bus' unit='at-spi-dbus-bus.service' requested by '>
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Successfully activated service 'org.freedesktop.systemd1'
Aug 05 23:12:33 shaun systemd[27203]: Starting Accessibility services bus...
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Successfully activated service 'org.a11y.Bus'
Aug 05 23:12:33 shaun systemd[27203]: Started Accessibility services bus.
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Activating via systemd: service name='org.gtk.vfs.Daemon' unit='gvfs-daemon.service' requested by ':1.3' >
Aug 05 23:12:33 shaun systemd[27203]: Starting Virtual filesystem service...
Aug 05 23:12:33 shaun dbus-daemon[27233]: [session uid=966 pid=27233] Successfully activated service 'org.gtk.vfs.Daemon'
Aug 05 23:12:33 shaun systemd[27203]: Started Virtual filesystem service.
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3962] device (enp4s0): carrier: link connected
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3964] device (enp4s0): state change: unavailable -> disconnected (reason 'carrier-changed', sys-iface-state: 'ma>
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3969] policy: auto-activating connection 'Kabelgebundene Verbindung 1' (ad55eb9f-1dcb-31c0-85cd-ca60ab56b55a)
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3973] device (enp4s0): Activation: starting connection 'Kabelgebundene Verbindung 1' (ad55eb9f-1dcb-31c0-85cd-ca>
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3973] device (enp4s0): state change: disconnected -> prepare (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3976] manager: NetworkManager state is now CONNECTING
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3977] device (enp4s0): state change: prepare -> config (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3981] device (enp4s0): state change: config -> ip-config (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:38 shaun NetworkManager[994]: <info>  [1659733958.3984] dhcp4 (enp4s0): activation: beginning transaction (timeout in 45 seconds)
Aug 05 23:12:38 shaun kernel: Generic FE-GE Realtek PHY r8169-0-400:00: Downshift occurred from negotiated speed 1Gbps to actual speed 100Mbps, check cabling!
Aug 05 23:12:38 shaun kernel: r8169 0000:04:00.0 enp4s0: Link is Up - 100Mbps/Full (downshifted) - flow control off
Aug 05 23:12:38 shaun kernel: IPv6: ADDRCONF(NETDEV_CHANGE): enp4s0: link becomes ready
Aug 05 23:12:38 shaun avahi-daemon[980]: Joining mDNS multicast group on interface enp4s0.IPv6 with address fe80::bae2:9beb:712:d278.
Aug 05 23:12:38 shaun avahi-daemon[980]: New relevant interface enp4s0.IPv6 for mDNS.
Aug 05 23:12:38 shaun avahi-daemon[980]: Registering new address record for fe80::bae2:9beb:712:d278 on enp4s0.*.
Aug 05 23:12:39 shaun NetworkManager[994]: <info>  [1659733959.7771] dhcp6 (enp4s0): activation: beginning transaction (timeout in 45 seconds)
Aug 05 23:12:39 shaun avahi-daemon[980]: Leaving mDNS multicast group on interface enp4s0.IPv6 with address fe80::bae2:9beb:712:d278.
Aug 05 23:12:39 shaun avahi-daemon[980]: Joining mDNS multicast group on interface enp4s0.IPv6 with address 2001:16b8:f8b:6200:a63f:e323:e1c2:fb08.
Aug 05 23:12:39 shaun avahi-daemon[980]: Registering new address record for 2001:16b8:f8b:6200:a63f:e323:e1c2:fb08 on enp4s0.*.
Aug 05 23:12:39 shaun avahi-daemon[980]: Withdrawing address record for fe80::bae2:9beb:712:d278 on enp4s0.
Aug 05 23:12:39 shaun NetworkManager[994]: <info>  [1659733959.7794] dhcp6 (enp4s0): state changed new lease
Aug 05 23:12:39 shaun dbus-daemon[982]: [system] Activating via systemd: service name='org.freedesktop.nm_dispatcher' unit='dbus-org.freedesktop.nm-dispatcher.service' request>
Aug 05 23:12:39 shaun systemd[1]: Starting Network Manager Script Dispatcher Service...
Aug 05 23:12:39 shaun dbus-daemon[982]: [system] Successfully activated service 'org.freedesktop.nm_dispatcher'
Aug 05 23:12:39 shaun systemd[1]: Started Network Manager Script Dispatcher Service.
Aug 05 23:12:39 shaun audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm="systemd" exe="/usr/lib/syst>
Aug 05 23:12:39 shaun kernel: audit: type=1130 audit(1659733959.783:199): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm=>
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4269] dhcp4 (enp4s0): state changed new lease, address=192.168.178.27
Aug 05 23:12:40 shaun avahi-daemon[980]: Joining mDNS multicast group on interface enp4s0.IPv4 with address 192.168.178.27.
Aug 05 23:12:40 shaun avahi-daemon[980]: New relevant interface enp4s0.IPv4 for mDNS.
Aug 05 23:12:40 shaun avahi-daemon[980]: Registering new address record for 192.168.178.27 on enp4s0.IPv4.
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4281] device (enp4s0): state change: ip-config -> ip-check (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4294] device (enp4s0): state change: ip-check -> secondaries (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4295] device (enp4s0): state change: secondaries -> activated (reason 'none', sys-iface-state: 'managed')
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4298] manager: NetworkManager state is now CONNECTED_LOCAL
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4302] manager: NetworkManager state is now CONNECTED_SITE
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4303] policy: set 'Kabelgebundene Verbindung 1' (enp4s0) as default for IPv4 routing and DNS
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4305] policy: set 'Kabelgebundene Verbindung 1' (enp4s0) as default for IPv6 routing and DNS
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.4371] device (enp4s0): Activation: successful, device activated.
Aug 05 23:12:40 shaun NetworkManager[994]: <info>  [1659733960.5028] manager: NetworkManager state is now CONNECTED_GLOBAL
Aug 05 23:12:41 shaun kernel: [UFW BLOCK] IN=enp4s0 OUT= MAC=7c:10:c9:3f:8b:fa:2c:3a:fd:90:42:17:08:00 SRC=192.168.178.1 DST=192.168.178.27 LEN=60 TOS=0x00 PREC=0x00 TTL=64 ID>
Aug 05 23:12:42 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* ring gfx_0.0.0 timeout, signaled seq=427758, emitted seq=427760
Aug 05 23:12:42 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* Process information: process Xorg pid 1055 thread Xorg:cs0 pid 1276
Aug 05 23:12:42 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU reset begin!
Aug 05 23:12:45 shaun kernel: [UFW BLOCK] IN=enp4s0 OUT= MAC=7c:10:c9:3f:8b:fa:2c:3a:fd:90:42:17:08:00 SRC=192.168.178.1 DST=192.168.178.27 LEN=60 TOS=0x00 PREC=0x00 TTL=64 ID>
Aug 05 23:12:46 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: failed to suspend display audio
Aug 05 23:12:46 shaun kernel: amdgpu 0000:0a:00.0: [drm:amdgpu_ring_test_helper [amdgpu]] *ERROR* ring kiq_2.1.0 test failed (-110)
Aug 05 23:12:46 shaun kernel: [drm:gfx_v10_0_hw_fini [amdgpu]] *ERROR* KGQ disable failed
Aug 05 23:12:47 shaun kernel: [drm:gfx_v10_0_hw_fini [amdgpu]] *ERROR* failed to halt cp gfx
Aug 05 23:12:47 shaun kernel: [drm] free PSP TMR buffer
Aug 05 23:12:47 shaun kernel: CPU: 11 PID: 26883 Comm: kworker/u64:49 Tainted: G           OE     5.19.0-1-MANJARO #1 ddec7f9b5cec1118d0ee30c6025a5c29a117ae8b
Aug 05 23:12:47 shaun kernel: Hardware name: System manufacturer System Product Name/PRIME X570-P, BIOS 4403 04/28/2022
Aug 05 23:12:47 shaun kernel: Workqueue: amdgpu-reset-dev drm_sched_job_timedout [gpu_sched]
Aug 05 23:12:47 shaun kernel: Call Trace:
Aug 05 23:12:47 shaun kernel:  <TASK>
Aug 05 23:12:47 shaun kernel:  dump_stack_lvl+0x48/0x60
Aug 05 23:12:47 shaun kernel:  amdgpu_do_asic_reset+0x2a/0x459 [amdgpu b12386f7cb9adffc412b7e3a1be7b6847a13a100]
Aug 05 23:12:47 shaun kernel:  amdgpu_device_gpu_recover_imp.cold+0x54a/0x8e1 [amdgpu b12386f7cb9adffc412b7e3a1be7b6847a13a100]
Aug 05 23:12:47 shaun kernel:  amdgpu_job_timedout+0x18f/0x1c0 [amdgpu b12386f7cb9adffc412b7e3a1be7b6847a13a100]
Aug 05 23:12:47 shaun kernel:  drm_sched_job_timedout+0x7a/0x110 [gpu_sched ce1671abbfff8d186094a9623082a3bd4e109f65]
Aug 05 23:12:47 shaun kernel:  process_one_work+0x1c7/0x380
Aug 05 23:12:47 shaun kernel:  worker_thread+0x51/0x390
Aug 05 23:12:47 shaun kernel:  ? rescuer_thread+0x3b0/0x3b0
Aug 05 23:12:47 shaun kernel:  kthread+0xde/0x110
Aug 05 23:12:47 shaun kernel:  ? kthread_complete_and_exit+0x20/0x20
Aug 05 23:12:47 shaun kernel:  ret_from_fork+0x22/0x30
Aug 05 23:12:47 shaun kernel:  </TASK>
Aug 05 23:12:47 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: BACO reset
Aug 05 23:12:49 shaun systemd[1]: NetworkManager-dispatcher.service: Deactivated successfully.
Aug 05 23:12:49 shaun audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm="systemd" exe="/usr/lib/syste>
Aug 05 23:12:49 shaun kernel: audit: type=1131 audit(1659733969.793:200): pid=1 uid=0 auid=4294967295 ses=4294967295 subj==unconfined msg='unit=NetworkManager-dispatcher comm=>
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU reset succeeded, trying to resume
Aug 05 23:12:50 shaun kernel: [drm] PCIE GART of 512M enabled (table at 0x0000008000300000).
Aug 05 23:12:50 shaun kernel: [drm] VRAM is lost due to GPU reset!
Aug 05 23:12:50 shaun kernel: [drm] PSP is resuming...
Aug 05 23:12:50 shaun kernel: [drm] reserve 0x7200000 from 0x81f7c00000 for PSP TMR
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: RAS: optional ras ta ucode is not available
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: RAP: optional rap ta ucode is not available
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SECUREDISPLAY: securedisplay ta ucode is not available
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SMU is resuming...
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: smu driver if version = 0x00000037, smu fw if version = 0x00000033, smu fw program = 0, version = 0x002a1f00 (42.31.>
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SMU driver if version not matched
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: use vbios provided pptable
Aug 05 23:12:50 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: smc_dpm_info table revision(format.content): 4.5
Aug 05 23:12:54 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SMU: I'm not done with your previous command: SMN_C2PMSG_66:0x0000003A SMN_C2PMSG_82:0x00000000
Aug 05 23:12:54 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: RunBtc failed!
Aug 05 23:12:54 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: Failed to setup smc hw!
Aug 05 23:12:54 shaun kernel: [drm:amdgpu_device_ip_resume_phase2 [amdgpu]] *ERROR* resume of IP block <smu> failed -62
Aug 05 23:12:54 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU reset(3) failed
Aug 05 23:12:54 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU reset end with ret = -62
Aug 05 23:12:54 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* GPU Recovery Failed: -62
Aug 05 23:13:04 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* ring gfx_0.0.0 timeout, signaled seq=427760, emitted seq=427760
Aug 05 23:13:04 shaun kernel: [drm:amdgpu_job_timedout [amdgpu]] *ERROR* Process information: process Xorg pid 1055 thread Xorg:cs0 pid 1276
Aug 05 23:13:04 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: GPU reset begin!
Aug 05 23:13:08 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SMU: I'm not done with your previous command: SMN_C2PMSG_66:0x0000003A SMN_C2PMSG_82:0x00000000
Aug 05 23:13:08 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: Failed to retrieve enabled ppfeatures!
Aug 05 23:13:13 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: SMU: I'm not done with your previous command: SMN_C2PMSG_66:0x0000003A SMN_C2PMSG_82:0x00000000
Aug 05 23:13:13 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: Failed to retrieve enabled ppfeatures!
Aug 05 23:13:17 shaun kernel: amdgpu 0000:0a:00.0: amdgpu: failed to suspend display audio
Aug 05 23:13:20 shaun kernel: [UFW BLOCK] IN=enp4s0 OUT= MAC=01:00:5e:00:00:01:2c:3a:fd:90:42:17:08:00 SRC=192.168.178.1 DST=224.0.0.1 LEN=36 TOS=0x00 PREC=0xC0 TTL=1 ID=26626>
Aug 05 23:13:27 shaun kernel: [UFW BLOCK] IN=enp4s0 OUT= MAC=33:33:00:00:00:01:2c:3a:fd:90:42:17:86:dd SRC=fe80:0000:0000:0000:2e3a:fdff:fe90:4217 DST=ff02:0000:0000:0000:0000>
-- Boot c6b86eb45b76484f98d903177e84c81a --

So - if noone can give a help with this, maybe I should file a bug report. Where would be the proper place to do this?

Best regards

schollsky

I have a GPD Pocket 3 N6000 (manjaro/xfce) that can’t resume after a deep suspend (though you get further than I get–I get a black screen).

To see if this is a S3 (deep suspend) issue, you could put this in grub command line:

mem_sleep_default=shallow

Then:

sudo update-grub

and reboot and try suspend/resume.

Shallow’s okay, but just okay. Shallow will shut down wifi, sound, usb, but it’s not a true suspend, so there’s more of a battery drain. OTH, it makes for an easier resume and a good troubleshooter.

Jake

So, i’ve tried mem_sleep_default=shallow in GRUB, but this makes it worse: Only black screen shows after reboot and syspend/resume…

Very odd, considering that shallow is such a light suspend. Have you tried a Manjaro live usb/cd to see if you can replicate the difficulties?

Jake

A good idea, I’ll try a Live USB later.

The live system (XFCE 21.35) just works fine - so it must be something im my config. I wouldn’t like to install again.

What files could I inspect for the reason of the error?

Kind regards

schollsky

That’s a rabbit hole for sure. Keep the install as lean as possible, and every other app install, stop and put it through its paces–reboot, suspend, resume.

As a rule of thumb, don’t replace the network manager and leave grub default if you can.

Since it can play nice with systemctl suspend, avoid the suspend procedure in Power Manager, and just install xautolock and run:

xautolock -locker "systemctl suspend" -time 1 # (1 minue suspend)

Jake