Attachment 145610 Details for Bug 111846 – dmesg (from suspend entry to exit)

dmesg (from suspend entry to exit)

dmesg (text/plain), 14.64 KB, created by Yuxuan Shui on 2019-10-02 01:18:01 UTC

(hide)

Description:

Filename:

MIME Type:

Creator: Yuxuan Shui

Created: 2019-10-02 01:18:01 UTC

Size: 14.64 KB

patch

obsolete

>[  382.842591] PM: suspend entry (deep)
>[  382.866179] audit: type=1130 audit(1569978959.411:113): pid=1 uid=0 auid=4294967295 ses=4294967295 msg='unit=cjdns comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success'
>[  382.866792] Filesystems sync: 0.024 seconds
>[  382.867250] audit: type=1130 audit(1569978959.412:114): pid=1 uid=0 auid=4294967295 ses=4294967295 msg='unit=cjdns-resume comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success'
>[  382.867256] audit: type=1131 audit(1569978959.412:115): pid=1 uid=0 auid=4294967295 ses=4294967295 msg='unit=cjdns-resume comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success'
>[  383.123260] Freezing user space processes ... (elapsed 0.001 seconds) done.
>[  383.125196] OOM killer disabled.
>[  383.125715] Freezing remaining freezable tasks ... (elapsed 0.000 seconds) done.
>[  383.127148] printk: Suspending console(s) (use no_console_suspend to debug)
>[  383.128367] serial 00:03: disabled
>[  383.136667] sd 2:0:0:0: [sda] Synchronizing SCSI cache
>[  383.138135] sd 2:0:0:0: [sda] Stopping disk
>[  383.660691] ------------[ cut here ]------------
>[  383.660737] WARNING: CPU: 15 PID: 2253 at drivers/gpu/drm/amd/amdgpu/../display/dc/dcn20/dcn20_resource.c:2800 dcn20_validate_bandwidth+0xbc/0xd0 [amdgpu]
>[  383.660738] Modules linked in: rfcomm fuse tun bnep vfat fat amdgpu mxm_wmi btusb btrtl btbcm btintel snd_hda_codec_realtek bluetooth snd_hda_codec_generic snd_hda_codec_hdmi igb snd_hda_intel snd_intel_nhlt k10temp snd_hda_codec ecdh_generic ecc gpu_sched crc16 ttm snd_hda_core snd_usb_audio snd_usbmidi_lib snd_hwdep snd_pcm snd_rawmidi snd_seq_device snd_timer snd soundcore usbkbd usbmouse wmi nvidia_drm(PO) nvidia_modeset(PO) nvidia(PO) sg efivarfs ip_tables hid_generic usbhid
>[  383.660749] CPU: 15 PID: 2253 Comm: kworker/u64:221 Tainted: P        W  O      5.4.0-rc1-2-me+ #4
>[  383.660750] Hardware name: System manufacturer System Product Name/ROG STRIX X470-F GAMING, BIOS 5007 06/17/2019
>[  383.660752] Workqueue: events_unbound async_run_entry_fn
>[  383.660793] RIP: 0010:dcn20_validate_bandwidth+0xbc/0xd0 [amdgpu]
>[  383.660795] Code: 5b 5d 41 5c 41 5d e9 13 fd ff ff 48 89 85 70 21 00 00 31 d2 48 89 ee 4c 89 e7 e8 ff fc ff ff 41 89 c5 22 85 c8 1d 00 00 75 04 <0f> 0b eb 97 c6 85 c8 1d 00 00 00 41 89 c5 eb 8b 0f 1f 40 00 0f 1f
>[  383.660795] RSP: 0018:ffff90b2ca60fb10 EFLAGS: 00010246
>[  383.660796] RAX: 0000000000000000 RBX: 4079400000000000 RCX: 00000000000b61cf
>[  383.660796] RDX: 00000000000b618f RSI: 00000000000b618f RDI: 0000000000027700
>[  383.660797] RBP: ffff90b2766b0000 R08: 0000000000000006 R09: 0000000000000000
>[  383.660797] R10: 0000000000000001 R11: 3ff0000000000000 R12: ffff90b2d70b0000
>[  383.660797] R13: 0000000000000001 R14: 0000000000000000 R15: ffff90b2d77b1c00
>[  383.660798] FS:  0000000000000000(0000) GS:ffff90b2debc0000(0000) knlGS:0000000000000000
>[  383.660799] CS:  0010 DS: 0000 ES: 0000 CR0: 0000000080050033
>[  383.660799] CR2: 0000564308853568 CR3: 00000006f5b26000 CR4: 00000000003406e0
>[  383.660799] Call Trace:
>[  383.660840]  dc_validate_global_state+0x28a/0x310 [amdgpu]
>[  383.660843]  ? drm_modeset_lock+0x31/0xb0
>[  383.660883]  amdgpu_dm_atomic_check+0x576/0x7d0 [amdgpu]
>[  383.660885]  drm_atomic_check_only+0x561/0x790
>[  383.660887]  ? _raw_spin_unlock_irqrestore+0x14/0x30
>[  383.660889]  drm_atomic_commit+0x13/0x50
>[  383.660890]  drm_atomic_helper_disable_all+0x144/0x160
>[  383.660892]  drm_atomic_helper_suspend+0x4c/0xe0
>[  383.660932]  dm_suspend+0x1c/0x60 [amdgpu]
>[  383.660957]  amdgpu_device_ip_suspend_phase1+0x81/0xe0 [amdgpu]
>[  383.660983]  amdgpu_device_suspend+0x1e8/0x370 [amdgpu]
>[  383.660985]  pci_pm_suspend+0x72/0x130
>[  383.660986]  ? pci_pm_freeze+0xb0/0xb0
>[  383.660987]  dpm_run_callback+0x41/0x170
>[  383.660989]  __device_suspend+0x121/0x4b0
>[  383.660990]  async_suspend+0x1b/0x90
>[  383.660991]  async_run_entry_fn+0x37/0xe0
>[  383.660993]  process_one_work+0x1e2/0x3b0
>[  383.660994]  worker_thread+0x4a/0x3d0
>[  383.660995]  kthread+0xfb/0x130
>[  383.660996]  ? process_one_work+0x3b0/0x3b0
>[  383.660997]  ? kthread_park+0x90/0x90
>[  383.660998]  ret_from_fork+0x22/0x40
>[  383.661000] ---[ end trace 244a3f3955ee8d17 ]---
>[  383.873779] [drm] ring test on 10 succeeded in 9 usecs
>[  383.873845] [drm] ring test on 10 succeeded in 27 usecs
>[  384.004334] ACPI: EC: interrupt blocked
>[  384.052677] ACPI: Preparing to enter system sleep state S3
>[  384.362324] ACPI: EC: event blocked
>[  384.362325] ACPI: EC: EC stopped
>[  384.362326] PM: Saving platform NVS memory
>[  384.362331] Disabling non-boot CPUs ...
>[  384.363699] smpboot: CPU 1 is now offline
>[  384.365377] smpboot: CPU 2 is now offline
>[  384.367019] smpboot: CPU 3 is now offline
>[  384.368646] smpboot: CPU 4 is now offline
>[  384.370242] smpboot: CPU 5 is now offline
>[  384.371835] smpboot: CPU 6 is now offline
>[  384.373386] smpboot: CPU 7 is now offline
>[  384.374954] smpboot: CPU 8 is now offline
>[  384.376490] smpboot: CPU 9 is now offline
>[  384.378113] smpboot: CPU 10 is now offline
>[  384.379686] smpboot: CPU 11 is now offline
>[  384.381362] smpboot: CPU 12 is now offline
>[  384.383018] smpboot: CPU 13 is now offline
>[  384.384679] smpboot: CPU 14 is now offline
>[  384.386341] smpboot: CPU 15 is now offline
>[  384.387031] ACPI: Low-level resume complete
>[  384.387067] ACPI: EC: EC started
>[  384.387067] PM: Restoring platform NVS memory
>[  384.387541] Enabling non-boot CPUs ...
>[  384.387708] x86: Booting SMP configuration:
>[  384.387709] smpboot: Booting Node 0 Processor 1 APIC 0x2
>[  384.387801] microcode: CPU1: patch_level=0x0800820c
>[  384.390170] CPU1 is up
>[  384.390339] smpboot: Booting Node 0 Processor 2 APIC 0x4
>[  384.390440] microcode: CPU2: patch_level=0x0800820c
>[  384.392754] CPU2 is up
>[  384.392925] smpboot: Booting Node 0 Processor 3 APIC 0x6
>[  384.393022] microcode: CPU3: patch_level=0x0800820c
>[  384.395328] CPU3 is up
>[  384.395500] smpboot: Booting Node 0 Processor 4 APIC 0x8
>[  384.395619] microcode: CPU4: patch_level=0x0800820c
>[  384.397957] CPU4 is up
>[  384.398114] smpboot: Booting Node 0 Processor 5 APIC 0xa
>[  384.398230] microcode: CPU5: patch_level=0x0800820c
>[  384.400545] CPU5 is up
>[  384.400716] smpboot: Booting Node 0 Processor 6 APIC 0xc
>[  384.400831] microcode: CPU6: patch_level=0x0800820c
>[  384.403147] CPU6 is up
>[  384.403306] smpboot: Booting Node 0 Processor 7 APIC 0xe
>[  384.403424] microcode: CPU7: patch_level=0x0800820c
>[  384.405746] CPU7 is up
>[  384.405892] smpboot: Booting Node 0 Processor 8 APIC 0x1
>[  384.406133] microcode: CPU8: patch_level=0x0800820c
>[  384.408535] CPU8 is up
>[  384.408705] smpboot: Booting Node 0 Processor 9 APIC 0x3
>[  384.408806] microcode: CPU9: patch_level=0x0800820c
>[  384.411143] CPU9 is up
>[  384.411279] smpboot: Booting Node 0 Processor 10 APIC 0x5
>[  384.411388] microcode: CPU10: patch_level=0x0800820c
>[  384.413720] CPU10 is up
>[  384.413857] smpboot: Booting Node 0 Processor 11 APIC 0x7
>[  384.413964] microcode: CPU11: patch_level=0x0800820c
>[  384.416296] CPU11 is up
>[  384.416453] smpboot: Booting Node 0 Processor 12 APIC 0x9
>[  384.416569] microcode: CPU12: patch_level=0x0800820c
>[  384.418908] CPU12 is up
>[  384.419035] smpboot: Booting Node 0 Processor 13 APIC 0xb
>[  384.419151] microcode: CPU13: patch_level=0x0800820c
>[  384.421503] CPU13 is up
>[  384.421619] smpboot: Booting Node 0 Processor 14 APIC 0xd
>[  384.421735] microcode: CPU14: patch_level=0x0800820c
>[  384.424079] CPU14 is up
>[  384.424201] smpboot: Booting Node 0 Processor 15 APIC 0xf
>[  384.424317] microcode: CPU15: patch_level=0x0800820c
>[  384.426674] CPU15 is up
>[  384.427876] ACPI: Waking up from system sleep state S3
>[  384.428436] ACPI: EC: interrupt unblocked
>[  384.488722] ACPI: EC: event unblocked
>[  384.489035] usb usb1: root hub lost power or was reset
>[  384.489037] usb usb2: root hub lost power or was reset
>[  384.489324] sd 2:0:0:0: [sda] Starting disk
>[  384.544379] usb usb3: root hub lost power or was reset
>[  384.544381] usb usb4: root hub lost power or was reset
>[  384.544929] serial 00:03: activated
>[  384.650882] nvme nvme0: Shutdown timeout set to 8 seconds
>[  384.678231] nvme nvme0: 32/0/0 default/read/poll queues
>[  384.799478] ata5: SATA link down (SStatus 0 SControl 300)
>[  384.799564] ata9: SATA link down (SStatus 0 SControl 300)
>[  384.799589] ata1: SATA link down (SStatus 0 SControl 300)
>[  384.799659] ata6: SATA link down (SStatus 0 SControl 300)
>[  384.799798] ata4: SATA link down (SStatus 0 SControl 300)
>[  384.800427] ata2: SATA link down (SStatus 0 SControl 300)
>[  384.869733] usb 2-3: reset SuperSpeed Gen 1 USB device number 2 using xhci_hcd
>[  384.954341] ata3: SATA link up 6.0 Gbps (SStatus 133 SControl 300)
>[  384.954546] ata3.00: supports DRM functions and may not be fully accessible
>[  384.955215] ata3.00: disabling queued TRIM support
>[  384.956703] ata3.00: supports DRM functions and may not be fully accessible
>[  384.957194] ata3.00: disabling queued TRIM support
>[  384.958447] ata3.00: configured for UDMA/133
>[  385.002469] usb 3-2: reset high-speed USB device number 2 using xhci_hcd
>[  385.045371] usb 2-5: reset SuperSpeed Gen 1 USB device number 3 using xhci_hcd
>[  385.316056] usb 1-9: reset full-speed USB device number 5 using xhci_hcd
>[  385.530337] ata8: failed to resume link (SControl 0)
>[  385.530347] ata8: SATA link down (SStatus 0 SControl 0)
>[  385.530687] ata7: failed to resume link (SControl 0)
>[  385.530697] ata7: SATA link down (SStatus 0 SControl 0)
>[  385.764076] usb 1-3: reset high-speed USB device number 2 using xhci_hcd
>[  386.148754] usb 1-5: reset high-speed USB device number 3 using xhci_hcd
>[  386.676772] usb 1-14: reset full-speed USB device number 8 using xhci_hcd
>[  386.899165] [drm] PCIE GART of 512M enabled (table at 0x0000008000300000).
>[  386.899176] [drm] PSP is resuming...
>[  386.963328] [drm] reserve 0x7200000 from 0x81f7c00000 for PSP TMR
>[  387.020713] usb 2-3.4: reset SuperSpeed Gen 1 USB device number 4 using xhci_hcd
>[  387.032327] amdgpu: [powerplay] SMU is resuming...
>[  387.045852] amdgpu: [powerplay] SMU is resumed successfully!
>[  387.126037] usb 1-3.3: reset full-speed USB device number 9 using xhci_hcd
>[  387.184872] igb 0000:07:00.0 enp7s0: igb: enp7s0 NIC Link is Up 1000 Mbps Full Duplex, Flow Control: RX/TX
>[  387.326110] [drm] kiq ring mec 2 pipe 1 q 0
>[  387.326195] [drm] ring test on 10 succeeded in 34 usecs
>[  387.326231] [drm] ring test on 10 succeeded in 14 usecs
>[  387.326289] [drm] gfx 0 ring me 0 pipe 0 q 0
>[  387.326313] [drm] ring test on 0 succeeded in 9 usecs
>[  387.326313] [drm] gfx 1 ring me 0 pipe 1 q 0
>[  387.326320] [drm] ring test on 1 succeeded in 1 usecs
>[  387.326320] [drm] compute ring 0 mec 1 pipe 0 q 0
>[  387.326328] [drm] ring test on 2 succeeded in 2 usecs
>[  387.326328] [drm] compute ring 1 mec 1 pipe 1 q 0
>[  387.326333] [drm] ring test on 3 succeeded in 1 usecs
>[  387.326334] [drm] compute ring 2 mec 1 pipe 2 q 0
>[  387.326339] [drm] ring test on 4 succeeded in 1 usecs
>[  387.326340] [drm] compute ring 3 mec 1 pipe 3 q 0
>[  387.326345] [drm] ring test on 5 succeeded in 1 usecs
>[  387.326345] [drm] compute ring 4 mec 1 pipe 0 q 1
>[  387.326350] [drm] ring test on 6 succeeded in 1 usecs
>[  387.326351] [drm] compute ring 5 mec 1 pipe 1 q 1
>[  387.326356] [drm] ring test on 7 succeeded in 1 usecs
>[  387.326356] [drm] compute ring 6 mec 1 pipe 2 q 1
>[  387.326362] [drm] ring test on 8 succeeded in 1 usecs
>[  387.326362] [drm] compute ring 7 mec 1 pipe 3 q 1
>[  387.326367] [drm] ring test on 9 succeeded in 1 usecs
>[  387.326466] [drm] ring test on 11 succeeded in 30 usecs
>[  387.326496] [drm] ring test on 12 succeeded in 9 usecs
>[  387.330537] [drm] VCN decode and encode initialized successfully(under DPG Mode).
>[  387.330552] amdgpu 0000:0b:00.0: ring 0(gfx_0.0.0) uses VM inv eng 4 on hub 0
>[  387.330553] amdgpu 0000:0b:00.0: ring 1(gfx_0.1.0) uses VM inv eng 5 on hub 0
>[  387.330554] amdgpu 0000:0b:00.0: ring 2(comp_1.0.0) uses VM inv eng 6 on hub 0
>[  387.330554] amdgpu 0000:0b:00.0: ring 3(comp_1.1.0) uses VM inv eng 7 on hub 0
>[  387.330555] amdgpu 0000:0b:00.0: ring 4(comp_1.2.0) uses VM inv eng 8 on hub 0
>[  387.330556] amdgpu 0000:0b:00.0: ring 5(comp_1.3.0) uses VM inv eng 9 on hub 0
>[  387.330556] amdgpu 0000:0b:00.0: ring 6(comp_1.0.1) uses VM inv eng 10 on hub 0
>[  387.330557] amdgpu 0000:0b:00.0: ring 7(comp_1.1.1) uses VM inv eng 11 on hub 0
>[  387.330557] amdgpu 0000:0b:00.0: ring 8(comp_1.2.1) uses VM inv eng 12 on hub 0
>[  387.330558] amdgpu 0000:0b:00.0: ring 9(comp_1.3.1) uses VM inv eng 13 on hub 0
>[  387.330559] amdgpu 0000:0b:00.0: ring 10(kiq_2.1.0) uses VM inv eng 14 on hub 0
>[  387.330559] amdgpu 0000:0b:00.0: ring 11(sdma0) uses VM inv eng 15 on hub 0
>[  387.330560] amdgpu 0000:0b:00.0: ring 12(sdma1) uses VM inv eng 16 on hub 0
>[  387.330561] amdgpu 0000:0b:00.0: ring 13(vcn_dec) uses VM inv eng 4 on hub 1
>[  387.330561] amdgpu 0000:0b:00.0: ring 14(vcn_enc0) uses VM inv eng 5 on hub 1
>[  387.330562] amdgpu 0000:0b:00.0: ring 15(vcn_enc1) uses VM inv eng 6 on hub 1
>[  387.330562] amdgpu 0000:0b:00.0: ring 16(vcn_jpeg) uses VM inv eng 7 on hub 1
>[  387.330761] [drm] ib test on ring 0 succeeded
>[  387.330779] [drm] ib test on ring 1 succeeded
>[  387.330835] [drm] ib test on ring 2 succeeded
>[  387.330852] [drm] ib test on ring 3 succeeded
>[  387.330870] [drm] ib test on ring 4 succeeded
>[  387.330888] [drm] ib test on ring 5 succeeded
>[  387.330906] [drm] ib test on ring 6 succeeded
>[  387.330925] [drm] ib test on ring 7 succeeded
>[  387.330943] [drm] ib test on ring 8 succeeded
>[  387.330961] [drm] ib test on ring 9 succeeded
>[  387.330977] [drm] ib test on ring 10 succeeded
>[  387.330998] [drm] ib test on ring 11 succeeded
>[  387.331025] [drm] ib test on ring 12 succeeded
>[  387.469350] snd_hda_intel 0000:0b:00.1: CORB reset timeout#2, CORBRP = 65535
>[  387.610504] usb 1-3.1: reset low-speed USB device number 4 using xhci_hcd
>[  387.689717] snd_hda_codec_hdmi hdaudioC1D0: Unable to sync register 0x2f0d00. -5
>[  388.186641] usb 1-3.4: reset high-speed USB device number 12 using xhci_hcd
>[  388.396445] usb 1-3.2: reset full-speed USB device number 6 using xhci_hcd
>[  388.656465] usb 1-5.1: reset high-speed USB device number 7 using xhci_hcd
>[  388.824442] usb 1-5.2: reset full-speed USB device number 10 using xhci_hcd
>[  389.137854] usb 1-5.1.5: reset full-speed USB device number 14 using xhci_hcd
>[  389.439912] usb 1-5.1.1: reset full-speed USB device number 11 using xhci_hcd
>[  389.731450] usb 1-5.1.2: reset high-speed USB device number 13 using xhci_hcd
>[  389.931820] usb 1-5.1.6: reset full-speed USB device number 15 using xhci_hcd
>[  390.239830] usb 1-5.1.7: reset full-speed USB device number 16 using xhci_hcd
>[  390.634015] Bluetooth: hci0: BCM: chip id 102
>[  390.634299] OOM killer enabled.
>[  390.635773] Restarting tasks ... done.
>[  390.637555] PM: suspend exit

Actions: View

Attachments on bug 111846: 145610 | 145611

Use of freedesktop.org services, including Bugzilla, is subject to our Code of Conduct. How we collect and use information is described in our Privacy Policy.