ubuntu-x-swat team mailing list archive

Thread
Date
[Bug 751084] Re: gpu lockup at resume from hibernate

To: ubuntu-x-swat@xxxxxxxxxxxxxxxxxxx
From: Valentin Quequet <751084@xxxxxxxxxxxxxxxxxx>
Date: Wed, 06 Apr 2011 11:26:39 -0000
Reply-to: Bug 751084 <751084@xxxxxxxxxxxxxxxxxx>
Sender: bounces@xxxxxxxxxxxxx
apport information

** Tags added: apport-collected

** Description changed:

  Binary package hint: xorg
  
  Xorg fails at resume from disk ; radeon open source driver
  
  While suspend/resume to RAM function right, suspend/resume to disk fails
  indeed.
  
  The X server makes many successive attempts to start but fails with the
  following syslog message appended.
  
  I managed to log on a console, though. Then, killing this failing Xorg
  instance allowed the boot process (gdm or whichever script) to spawn a
  new and functional Xorg instance ; obviously not restoring my graphical
  user session.
  
  Salut !
  
  ----- HERE COME THAT MESSAGE !!! -----
  
  [ 1074.171002] tg3 0000:03:00.0: eth0: Link is down
  [ 1075.482573] ADDRCONF(NETDEV_UP): wlan0: link is not ready
  [ 1077.928646] ADDRCONF(NETDEV_UP): wlan0: link is not ready
  [ 1079.999040] PM: Marking nosave pages: 000000000009d000 - 0000000000100000
  [ 1079.999045] PM: Marking nosave pages: 00000000bfe90000 - 0000000100000000
  [ 1080.000021] PM: Marking nosave pages: 00000000b4000000 - 00000000b8000000
  [ 1080.000315] PM: Basic memory bitmaps created
  [ 1080.000316] PM: Syncing filesystems ... done.
  [ 1080.029785] Freezing user space processes ... (elapsed 0.02 seconds) done.
  [ 1080.050105] Freezing remaining freezable tasks ... (elapsed 0.01 seconds) done.
  [ 1080.070119] PM: Preallocating image memory... done (allocated 626764 pages)
  [ 1080.546991] PM: Allocated 2507056 kbytes in 0.47 seconds (5334.16 MB/s)
  [ 1080.546994] Suspending console(s) (use no_console_suspend to debug)
  [ 1080.563755] sd 2:0:0:0: [sda] Synchronizing SCSI cache
  [ 1080.574796] HDA Intel 0000:02:00.1: PCI INT B disabled
  [ 1080.680458] HDA Intel 0000:00:14.2: PCI INT A disabled
  [ 1080.700082] PM: freeze of drv:HDA Intel dev:0000:00:14.2 complete after 125.934 msecs
  [ 1080.750213] PM: freeze of drv:radeon dev:0000:02:00.0 complete after 176.106 msecs
  [ 1080.750270] PM: freeze of drv:pcieport dev:0000:00:02.0 complete after 176.009 msecs
  [ 1080.750291] PM: freeze of drv: dev:pci0000:00 complete after 176.002 msecs
  [ 1080.750316] PM: freeze of devices complete after 203.047 msecs
  [ 1080.750867] PM: late freeze of devices complete after 0.548 msecs
  [ 1080.750929] ACPI: Preparing to enter system sleep state S4
  [ 1081.100166] PM: Saving platform NVS memory
  [ 1081.100232] Disabling non-boot CPUs ...
  [ 1081.210072] CPU 1 is now offline
  [ 1081.210401] Extended CMOS year: 2000
  [ 1081.210466] PM: Creating hibernation image:
  [ 1081.220049] PM: Need to copy 386033 pages
  [ 1081.220049] PM: Normal pages needed: 386033 + 1024, available pages: 645593
  [ 1081.220049] PM: Restoring platform NVS memory
  [ 1081.220049] PCI-DMA: Resuming GART IOMMU
  [ 1081.220049] PCI-DMA: Restoring GART aperture settings
  [ 1081.220049] Extended CMOS year: 2000
  [ 1081.220049] Enabling non-boot CPUs ...
  [ 1081.220049] Booting Node 0 Processor 1 APIC 0x1
  [ 1081.110427] Switch to broadcast mode on CPU1
  [ 1081.390544] CPU1 is up
  [ 1081.390679] ACPI: Waking up from system sleep state S4
  [ 1081.400120] Switched to NOHz mode on CPU #1
  [ 1082.030620] pcieport 0000:00:02.0: restoring config space at offset 0x7 (was 0x9191, writing 0x20009191)
  [ 1082.030649] pcieport 0000:00:04.0: restoring config space at offset 0x7 (was 0x200001f1, writing 0x1f1)
  [ 1082.030675] pcieport 0000:00:05.0: restoring config space at offset 0x7 (was 0x200001f1, writing 0x1f1)
  [ 1082.030721] ahci 0000:00:11.0: restoring config space at offset 0x1 (was 0x2300403, writing 0x2300407)
  [ 1082.030900] HDA Intel 0000:00:14.2: restoring config space at offset 0xf (was 0x10b, writing 0xb)
  [ 1082.030918] HDA Intel 0000:00:14.2: restoring config space at offset 0x1 (was 0x4100006, writing 0x4100002)
  [ 1082.031053] HDA Intel 0000:02:00.1: restoring config space at offset 0x1 (was 0x100007, writing 0x100003)
  [ 1082.031103] tg3 0000:03:00.0: restoring config space at offset 0x1 (was 0x100006, writing 0x100406)
  [ 1082.031310] PM: early restore of devices complete after 0.766 msecs
  [ 1082.116203] HDA Intel 0000:00:14.2: PCI INT A -> GSI 16 (level, low) -> IRQ 16
  [ 1082.116265] radeon 0000:02:00.0: setting latency timer to 64
  [ 1082.116464] HDA Intel 0000:02:00.1: PCI INT B -> GSI 19 (level, low) -> IRQ 19
  [ 1082.116470] HDA Intel 0000:02:00.1: setting latency timer to 64
  [ 1082.116508] HDA Intel 0000:02:00.1: irq 46 for MSI/MSI-X
  [ 1082.135611] radeon 0000:02:00.0: WB enabled
  [ 1082.145420] sd 2:0:0:0: [sda] Starting disk
  [ 1082.151701] [drm] ring test succeeded in 1 usecs
  [ 1082.151717] [drm] ib test succeeded in 0 usecs
  [ 1082.174119] usb usb4: root hub lost power or was reset
  [ 1082.174177] usb usb3: root hub lost power or was reset
  [ 1082.174182] usb usb2: root hub lost power or was reset
  [ 1082.174212] usb usb1: root hub lost power or was reset
  [ 1082.218358] PM: restore of drv:HDA Intel dev:0000:00:14.2 complete after 102.169 msecs
  [ 1082.312540] PM: restore of drv:battery dev:PNP0C0A:00 complete after 180.839 msecs
  [ 1082.320150] PM: restore of drv:usb dev:usb1 complete after 176.012 msecs
  [ 1082.320176] PM: restore of drv:hub dev:1-0:1.0 complete after 175.983 msecs
  [ 1082.320184] PM: restore of drv: dev:ep_00 complete after 174.989 msecs
  [ 1082.320188] PM: restore of drv: dev:ep_81 complete after 175.024 msecs
  [ 1082.410142] PM: restore of drv:usb dev:usb3 complete after 264.905 msecs
  [ 1082.410161] PM: restore of drv:hub dev:3-0:1.0 complete after 264.913 msecs
  [ 1082.410168] PM: restore of drv: dev:ep_00 complete after 264.918 msecs
  [ 1082.410172] PM: restore of drv: dev:ep_81 complete after 264.925 msecs
  [ 1082.530093] PM: restore of drv:usb dev:usb4 complete after 384.837 msecs
  [ 1082.530127] PM: restore of drv:hub dev:4-0:1.0 complete after 384.867 msecs
  [ 1082.530144] PM: restore of drv: dev:ep_00 complete after 384.875 msecs
  [ 1082.530174] PM: restore of drv: dev:ep_81 complete after 384.917 msecs
  [ 1082.560092] PM: restore of drv:usb dev:usb2 complete after 414.889 msecs
  [ 1082.560124] PM: restore of drv:hub dev:2-0:1.0 complete after 414.919 msecs
  [ 1082.560156] PM: restore of drv: dev:ep_00 complete after 414.934 msecs
  [ 1082.560193] PM: restore of drv: dev:ep_81 complete after 414.981 msecs
  [ 1082.670097] ata4: SATA link up 1.5 Gbps (SStatus 113 SControl 300)
  [ 1082.670126] ata3: SATA link up 3.0 Gbps (SStatus 123 SControl 300)
  [ 1082.674797] ata4.00: configured for UDMA/100
  [ 1082.712175] ata3.00: configured for UDMA/100
  [ 1082.775078] PM: restore of drv:sd dev:2:0:0:0 complete after 629.649 msecs
  [ 1082.775125] PM: restore of drv:scsi_disk dev:2:0:0:0 complete after 445.068 msecs
  [ 1082.775132] PM: restore of drv:scsi_device dev:2:0:0:0 complete after 629.655 msecs
  [ 1082.880106] usb 4-1: reset low speed USB device using ohci_hcd and address 2
  [ 1083.080147] PM: restore of drv:radeon dev:0000:02:00.0 complete after 963.873 msecs
  [ 1083.221056] PM: restore of drv:usb dev:4-1 complete after 1075.736 msecs
  [ 1083.221102] PM: restore of drv: dev:ep_00 complete after 1075.761 msecs
  [ 1083.221110] PM: restore of drv:usbhid dev:4-1:1.0 complete after 1075.786 msecs
  [ 1083.221127] PM: restore of drv: dev:ep_81 complete after 1075.797 msecs
  [ 1083.221134] PM: restore of drv:generic-usb dev:0003:045E:007D.0001 complete after 445.992 msecs
  [ 1083.330089] usb 2-5: reset high speed USB device using ehci_hcd and address 3
  [ 1083.518380] PM: restore of drv:usb dev:2-5 complete after 1373.089 msecs
  [ 1083.518414] PM: restore of drv:uvcvideo dev:2-5:1.0 complete after 1373.112 msecs
  [ 1083.518435] PM: restore of drv: dev:ep_00 complete after 1373.121 msecs
  [ 1083.518444] PM: restore of drv: dev:ep_83 complete after 1373.136 msecs
  [ 1083.518449] PM: restore of drv:uvcvideo dev:2-5:1.1 complete after 1373.138 msecs
  [ 1083.518452] PM: restore of drv:video4linux dev:video0 complete after 297.262 msecs
  [ 1083.560188] PM: restore of devices complete after 1444.189 msecs
  [ 1083.560421] PM: Image restored successfully.
  [ 1083.560423] Restarting tasks ... done.
  [ 1083.573518] PM: Basic memory bitmaps freed
  [ 1083.573525] video LNXVIDEO:00: Restoring backlight state
  [ 1084.331042] tg3 0000:03:00.0: eth0: Link is down
  [ 1088.331011] tg3 0000:03:00.0: eth0: Link is down
  [ 1090.475857] ADDRCONF(NETDEV_UP): wlan0: link is not ready
  [ 1094.190133] radeon 0000:02:00.0: GPU lockup CP stall for more than 10020msec
  [ 1094.190142] ------------[ cut here ]------------
  [ 1094.190205] WARNING: at /build/buildd/linux-2.6.38/drivers/gpu/drm/radeon/radeon_fence.c:248 radeon_fence_wait+0x36f/0x3e0 [radeon]()
  [ 1094.190213] Hardware name: eMachines G640                 
  [ 1094.190218] GPU lockup (waiting for 0x000143F3 last fence id 0x000143F1)
  [ 1094.190223] Modules linked in: ipt_MASQUERADE iptable_nat nf_nat nf_conntrack_ipv4 nf_conntrack nf_defrag_ipv4 ip_tables x_tables snd_hrtimer binfmt_misc ipx p8023 kvm_amd kvm parport_pc ppdev snd_hda_codec_hdmi snd_hda_codec_realtek snd_hda_intel snd_hda_codec snd_hwdep snd_pcm arc4 snd_seq_midi dm_crypt joydev snd_rawmidi snd_seq_midi_event snd_seq ath9k snd_timer snd_seq_device mac80211 snd ath9k_common ath9k_hw ath uvcvideo videodev soundcore cfg80211 sp5100_tco i2c_piix4 snd_page_alloc psmouse v4l2_compat_ioctl32 lp edac_core serio_raw edac_mce_amd acer_wmi k10temp sparse_keymap parport reiserfs raid10 raid456 async_pq async_xor async_memcpy async_raid6_recov raid6_pq async_tx raid1 raid0 multipath linear nbd dm_raid45 xor btrfs zlib_deflate libcrc32c radeon usbhid hid ttm drm_kms_helper drm video ahci tg3 i2c_algo_bit pata_atiixp libahci
  [ 1094.190345] Pid: 1464, comm: Xorg Tainted: G        W   2.6.38-7-generic #39-Ubuntu
  [ 1094.190350] Call Trace:
  [ 1094.190364]  [<ffffffff8106573f>] ? warn_slowpath_common+0x7f/0xc0
  [ 1094.190374]  [<ffffffff81065836>] ? warn_slowpath_fmt+0x46/0x50
  [ 1094.190418]  [<ffffffffa012b66f>] ? radeon_fence_wait+0x36f/0x3e0 [radeon]
  [ 1094.190428]  [<ffffffff81087710>] ? autoremove_wake_function+0x0/0x40
  [ 1094.190472]  [<ffffffffa012bf51>] ? radeon_sync_obj_wait+0x11/0x20 [radeon]
  [ 1094.190492]  [<ffffffffa0093b0d>] ? ttm_bo_wait+0xfd/0x1b0 [ttm]
  [ 1094.190510]  [<ffffffffa0093e88>] ? ttm_bo_list_ref_sub+0x28/0x30 [ttm]
  [ 1094.190555]  [<ffffffffa01448e3>] ? radeon_gem_wait_idle_ioctl+0x93/0x110 [radeon]
  [ 1094.190584]  [<ffffffffa005b384>] ? drm_ioctl+0x3e4/0x4c0 [drm]
  [ 1094.190630]  [<ffffffffa0144850>] ? radeon_gem_wait_idle_ioctl+0x0/0x110 [radeon]
  [ 1094.190639]  [<ffffffff8100b7b1>] ? handle_signal+0x131/0x260
  [ 1094.190647]  [<ffffffff810156a1>] ? fpu_finit+0x21/0x40
  [ 1094.190653]  [<ffffffff810157ca>] ? init_fpu+0x4a/0x150
  [ 1094.190663]  [<ffffffff811751cf>] ? do_vfs_ioctl+0x8f/0x360
  [ 1094.190669]  [<ffffffff8100bd06>] ? sys_rt_sigreturn+0x106/0x140
  [ 1094.190677]  [<ffffffff81175531>] ? sys_ioctl+0x91/0xa0
  [ 1094.190684]  [<ffffffff8100c002>] ? system_call_fastpath+0x16/0x1b
  [ 1094.190690] ---[ end trace 5a5d197966b56a30 ]---
  [ 1094.191920] radeon 0000:02:00.0: GPU softreset 
  [ 1094.191927] radeon 0000:02:00.0:   GRBM_STATUS=0xB2703828
  [ 1094.191933] radeon 0000:02:00.0:   GRBM_STATUS_SE0=0x1C000007
  [ 1094.191938] radeon 0000:02:00.0:   GRBM_STATUS_SE1=0x00000007
  [ 1094.191944] radeon 0000:02:00.0:   SRBM_STATUS=0x200000C0
  [ 1094.192004] radeon 0000:02:00.0:   GRBM_SOFT_RESET=0x00007F6B
  [ 1094.192111] radeon 0000:02:00.0:   GRBM_STATUS=0x00003828
  [ 1094.192117] radeon 0000:02:00.0:   GRBM_STATUS_SE0=0x00000007
  [ 1094.192122] radeon 0000:02:00.0:   GRBM_STATUS_SE1=0x00000007
  [ 1094.192128] radeon 0000:02:00.0:   SRBM_STATUS=0x200000C0
  [ 1094.193133] radeon 0000:02:00.0: GPU reset succeed
  [ 1094.214820] radeon 0000:02:00.0: WB enabled
  [ 1094.230956] [drm] ring test succeeded in 1 usecs
  [ 1094.230965] [drm] ib test succeeded in 1 usecs
  [ 1094.901518] [drm:drm_mode_getfb] *ERROR* invalid framebuffer id
  [ 1105.160129] radeon 0000:02:00.0: GPU lockup CP stall for more than 10000msec
  
  ----- END OF MESSAGE !!! -----
  
  ProblemType: Bug
  DistroRelease: Ubuntu 11.04
  Package: xorg 1:7.6+4ubuntu1
  ProcVersionSignature: Ubuntu 2.6.38-7.39-generic 2.6.38
  Uname: Linux 2.6.38-7-generic x86_64
  Architecture: amd64
  Date: Tue Apr  5 09:20:19 2011
  DistroCodename: natty
  DistroVariant: ubuntu
  InstallationMedia: Ubuntu 10.04 LTS "Lucid Lynx" - Release amd64 (20100429)
  ProcEnviron:
   LANGUAGE=fr_FR:en
   LANG=fr_FR.UTF-8
   SHELL=/bin/bash
  SourcePackage: xorg
  Symptom: display
  UpgradeStatus: Upgraded to natty on 2010-11-23 (132 days ago)
  version.libgl1-mesa-glx: libgl1-mesa-glx 7.10.1-0ubuntu3
  version.xserver-xorg: xserver-xorg 1:7.6+4ubuntu1
+ --- 
+ Architecture: amd64
+ DistroRelease: Ubuntu 11.04
+ InstallationMedia: Ubuntu 10.04 LTS "Lucid Lynx" - Release amd64 (20100429)
+ Package: xserver-xorg-video-ati 1:6.14.0-0ubuntu4
+ PackageArchitecture: amd64
+ ProcEnviron:
+  PATH=(custom, no user)
+  LANG=fr_FR.UTF-8
+  SHELL=/bin/bash
+ ProcVersionSignature: Ubuntu 2.6.38-8.40-generic 2.6.38.2
+ Tags:  unity-2d natty
+ Uname: Linux 2.6.38-8-generic x86_64
+ UpgradeStatus: Upgraded to natty on 2010-11-23 (133 days ago)
+ UserGroups: pkcs11

** Attachment added: "Dependencies.txt"
   https://bugs.launchpad.net/bugs/751084/+attachment/1987517/+files/Dependencies.txt

-- 
You received this bug notification because you are a member of Ubuntu-X,
which is subscribed to xserver-xorg-video-ati in Ubuntu.
https://bugs.launchpad.net/bugs/751084

Title:
  gpu lockup at resume from hibernate
References

[Bug 751084] [NEW] Xorg fails at resume from disk ; radeon oss driver
From: Valentin Quequet, 2011-04-05