[   60.756646] vboxdrv: fAsync=0 offMin=0x1c3 offMax=0x1238
[   60.756704] vboxdrv: TSC mode is 'synchronous', kernel timer mode is 'normal'.
[   60.756707] vboxdrv: Successfully loaded version 4.0.4 (interface 0x00160000).
[   61.008318] Bluetooth: L2CAP ver 2.15
[   61.008321] Bluetooth: L2CAP socket layer initialized
[   61.015737] Bluetooth: BNEP (Ethernet Emulation) ver 1.3
[   61.015740] Bluetooth: BNEP filters: protocol multicast
[   61.022168] Bluetooth: SCO (Voice Link) ver 0.6
[   61.022171] Bluetooth: SCO socket layer initialized
[   61.110179] Bluetooth: RFCOMM TTY layer initialized
[   61.110190] Bluetooth: RFCOMM socket layer initialized
[   61.110192] Bluetooth: RFCOMM ver 1.11
[   62.352579] EXT4-fs (sda2): re-mounted. Opts: errors=remount-ro,commit=0
[   62.840109] hda-intel: IRQ timing workaround is activated for card #1. Suggest a bigger bdl_pos_adj.
[   63.672692] EXT4-fs (sda2): re-mounted. Opts: errors=remount-ro,commit=0
[   70.390029] eth1: no IPv6 routers present
[   76.294979] Bluetooth: HIDP (Human Interface Emulation) ver 1.2
[   84.340208] CE: hpet increased min_delta_ns to 20113 nsec
[ 1932.638791] EXT4-fs (sda2): re-mounted. Opts: errors=remount-ro,commit=0
[ 1934.332729] PM: Syncing filesystems ... done.
[ 1934.465223] PM: Preparing system for mem sleep
[ 1934.960675] Freezing user space processes ... (elapsed 0.01 seconds) done.
[ 1934.980134] Freezing remaining freezable tasks ... (elapsed 0.01 seconds) done.
[ 1935.000104] PM: Entering mem sleep
[ 1935.000155] Suspending console(s) (use no_console_suspend to debug)
[ 1935.001056] sd 0:0:0:0: [sda] Synchronizing SCSI cache
[ 1935.001178] sd 0:0:0:0: [sda] Stopping disk
[ 1935.020074] ACPI handle has no context!
[ 1935.021965] ACPI handle has no context!
[ 1935.021978] sdhci-pci 0000:09:01.1: PCI INT B disabled
[ 1935.021993] ACPI handle has no context!
[ 1935.022023] wl 0000:04:00.0: PCI INT A disabled
[ 1935.022140] ehci_hcd 0000:00:1d.7: PCI INT A disabled
[ 1935.022166] uhci_hcd 0000:00:1d.2: PCI INT C disabled
[ 1935.022173] uhci_hcd 0000:00:1d.1: PCI INT B disabled
[ 1935.022182] uhci_hcd 0000:00:1d.0: PCI INT A disabled
[ 1935.023024] ehci_hcd 0000:00:1a.7: PCI INT C disabled
[ 1935.023048] uhci_hcd 0000:00:1a.2: PCI INT C disabled
[ 1935.023054] uhci_hcd 0000:00:1a.1: PCI INT B disabled
[ 1935.040257] uhci_hcd 0000:00:1a.0: PCI INT A disabled
[ 1935.130083] HDA Intel 0000:01:00.1: PCI INT B disabled
[ 1935.130133] ACPI handle has no context!
[ 1935.150019] PM: suspend of drv:HDA Intel dev:0000:01:00.1 complete after 127.978 msecs
[ 1935.150347] HDA Intel 0000:00:1b.0: PCI INT A disabled
[ 1935.170018] PM: suspend of drv:HDA Intel dev:0000:00:1b.0 complete after 147.824 msecs
[ 1935.497806] PM: suspend of drv:sd dev:0:0:0:0 complete after 496.753 msecs
[ 1935.497815] PM: suspend of drv:scsi dev:target0:0:0 complete after 496.701 msecs
[ 1935.497828] PM: suspend of drv:scsi dev:host0 complete after 496.587 msecs
[ 1935.510016] PM: suspend of drv:ahci dev:0000:00:1f.2 complete after 487.948 msecs
[ 1936.604673] [drm] Disabling audio support
[ 1936.700028] PM: suspend of drv:radeon dev:0000:01:00.0 complete after 1677.985 msecs
[ 1936.700047] PM: suspend of drv:pcieport dev:0000:00:01.0 complete after 1676.984 msecs
[ 1936.700077] PM: suspend of drv: dev:pci0000:00 complete after 1676.981 msecs
[ 1936.700086] PM: suspend of devices complete after 1699.454 msecs
[ 1936.700089] PM: suspend devices took 1.700 seconds
[ 1936.760245] PM: late suspend of devices complete after 60.151 msecs
[ 1936.760576] ACPI: Preparing to enter system sleep state S3
[ 1936.790461] PM: Saving platform NVS memory
[ 1936.791427] Disabling non-boot CPUs ...
[ 1936.900029] CPU 1 is now offline
[ 1936.900404] Extended CMOS year: 2000
[ 1936.900404] Back to C!
[ 1936.900404] PM: Restoring platform NVS memory
[ 1936.900404] Extended CMOS year: 2000
[ 1936.900404] Enabling non-boot CPUs ...
[ 1936.900404] Booting Node 0 Processor 1 APIC 0x1
[ 1937.070020] Switched to NOHz mode on CPU #1
[ 1937.070454] CPU1 is up
[ 1937.071117] ACPI: Waking up from system sleep state S3
[ 1937.100689] pcieport 0000:00:01.0: restoring config space at offset 0x7 (was 0x20002020, writing 0x2020)
[ 1937.100693] pcieport 0000:00:01.0: restoring config space at offset 0x6 (was 0x0, writing 0x10100)
[ 1937.100698] pcieport 0000:00:01.0: restoring config space at offset 0x3 (was 0x10000, writing 0x10010)
[ 1937.100702] pcieport 0000:00:01.0: restoring config space at offset 0x1 (was 0x100107, writing 0x100507)
[ 1937.100750] uhci_hcd 0000:00:1a.0: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 1937.100792] uhci_hcd 0000:00:1a.1: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 1937.100814] uhci_hcd 0000:00:1a.2: restoring config space at offset 0xf (was 0x300, writing 0x30a)
[ 1937.100828] uhci_hcd 0000:00:1a.2: restoring config space at offset 0x8 (was 0x1, writing 0x1841)
[ 1937.100841] uhci_hcd 0000:00:1a.2: restoring config space at offset 0x1 (was 0x2900000, writing 0x2900001)
[ 1937.100890] ehci_hcd 0000:00:1a.7: restoring config space at offset 0x1 (was 0x2900106, writing 0x2900102)
[ 1937.100927] HDA Intel 0000:00:1b.0: restoring config space at offset 0xf (was 0x100, writing 0x10b)
[ 1937.100947] HDA Intel 0000:00:1b.0: restoring config space at offset 0x3 (was 0x0, writing 0x10)
[ 1937.100954] HDA Intel 0000:00:1b.0: restoring config space at offset 0x1 (was 0x100106, writing 0x100102)
[ 1937.100988] pcieport 0000:00:1c.0: restoring config space at offset 0xf (was 0x40100, writing 0x4010a)
[ 1937.101000] pcieport 0000:00:1c.0: restoring config space at offset 0x9 (was 0x10001, writing 0xf1f1f001)
[ 1937.101005] pcieport 0000:00:1c.0: restoring config space at offset 0x8 (was 0x0, writing 0xf7f0f600)
[ 1937.101010] pcieport 0000:00:1c.0: restoring config space at offset 0x7 (was 0x0, writing 0x3030)
[ 1937.101015] pcieport 0000:00:1c.0: restoring config space at offset 0x6 (was 0x0, writing 0x30200)
[ 1937.101023] pcieport 0000:00:1c.0: restoring config space at offset 0x3 (was 0x810000, writing 0x810010)
[ 1937.101029] pcieport 0000:00:1c.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 1937.101082] pcieport 0000:00:1c.1: restoring config space at offset 0xf (was 0x40200, writing 0x40205)
[ 1937.101097] pcieport 0000:00:1c.1: restoring config space at offset 0x7 (was 0x3030, writing 0x4040)
[ 1937.101106] pcieport 0000:00:1c.1: restoring config space at offset 0x3 (was 0x810000, writing 0x810010)
[ 1937.101113] pcieport 0000:00:1c.1: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 1937.101165] pcieport 0000:00:1c.3: restoring config space at offset 0xf (was 0x40400, writing 0x4040a)
[ 1937.101177] pcieport 0000:00:1c.3: restoring config space at offset 0x9 (was 0x10001, writing 0xf5f1f401)
[ 1937.101183] pcieport 0000:00:1c.3: restoring config space at offset 0x7 (was 0x20000000, writing 0x5050)
[ 1937.101193] pcieport 0000:00:1c.3: restoring config space at offset 0x3 (was 0x810000, writing 0x810010)
[ 1937.101199] pcieport 0000:00:1c.3: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 1937.101251] pcieport 0000:00:1c.5: restoring config space at offset 0xf (was 0x40200, writing 0x40205)
[ 1937.101263] pcieport 0000:00:1c.5: restoring config space at offset 0x9 (was 0x10001, writing 0xc011c001)
[ 1937.101270] pcieport 0000:00:1c.5: restoring config space at offset 0x7 (was 0x20000000, writing 0x6060)
[ 1937.101279] pcieport 0000:00:1c.5: restoring config space at offset 0x3 (was 0x810000, writing 0x810010)
[ 1937.101285] pcieport 0000:00:1c.5: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 1937.101351] uhci_hcd 0000:00:1d.0: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 1937.101393] uhci_hcd 0000:00:1d.1: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 1937.101434] uhci_hcd 0000:00:1d.2: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 1937.101483] ehci_hcd 0000:00:1d.7: restoring config space at offset 0x1 (was 0x2900106, writing 0x2900102)
[ 1937.101511] pci 0000:00:1e.0: restoring config space at offset 0xf (was 0x40000, writing 0x400ff)
[ 1937.101523] pci 0000:00:1e.0: restoring config space at offset 0x9 (was 0x10001, writing 0x1fff1)
[ 1937.101528] pci 0000:00:1e.0: restoring config space at offset 0x8 (was 0x0, writing 0xfc10fc10)
[ 1937.101533] pci 0000:00:1e.0: restoring config space at offset 0x7 (was 0x22800000, writing 0x228000f0)
[ 1937.101545] pci 0000:00:1e.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100107)
[ 1937.101625] ahci 0000:00:1f.2: restoring config space at offset 0xf (was 0x200, writing 0x20a)
[ 1937.101648] ahci 0000:00:1f.2: restoring config space at offset 0x1 (was 0x2b00007, writing 0x2b00407)
[ 1937.101703] pci 0000:00:1f.3: restoring config space at offset 0x4 (was 0x4, writing 0xc0200004)
[ 1937.101740] radeon 0000:01:00.0: restoring config space at offset 0xf (was 0x1ff, writing 0x105)
[ 1937.101757] radeon 0000:01:00.0: restoring config space at offset 0x6 (was 0x0, writing 0xcfef0000)
[ 1937.101762] radeon 0000:01:00.0: restoring config space at offset 0x5 (was 0x1, writing 0x2001)
[ 1937.101767] radeon 0000:01:00.0: restoring config space at offset 0x4 (was 0x8, writing 0xd0000008)
[ 1937.101772] radeon 0000:01:00.0: restoring config space at offset 0x3 (was 0x800000, writing 0x800010)
[ 1937.101779] radeon 0000:01:00.0: restoring config space at offset 0x1 (was 0x100000, writing 0x40100507)
[ 1937.101837] HDA Intel 0000:01:00.1: restoring config space at offset 0xf (was 0x2ff, writing 0x20a)
[ 1937.101858] HDA Intel 0000:01:00.1: restoring config space at offset 0x4 (was 0x0, writing 0xcfeec000)
[ 1937.101863] HDA Intel 0000:01:00.1: restoring config space at offset 0x3 (was 0x800000, writing 0x800010)
[ 1937.101870] HDA Intel 0000:01:00.1: restoring config space at offset 0x1 (was 0x100000, writing 0x40100103)
[ 1937.101938] wl 0000:04:00.0: restoring config space at offset 0xf (was 0x100, writing 0x10a)
[ 1937.101978] wl 0000:04:00.0: restoring config space at offset 0x4 (was 0x4, writing 0xf8000004)
[ 1937.101987] wl 0000:04:00.0: restoring config space at offset 0x3 (was 0x0, writing 0x10)
[ 1937.101999] wl 0000:04:00.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100106)
[ 1937.102151] tg3 0000:08:00.0: restoring config space at offset 0x3 (was 0x0, writing 0x10)
[ 1937.102163] tg3 0000:08:00.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100106)
[ 1937.102227] firewire_ohci 0000:09:01.0: restoring config space at offset 0xf (was 0x4020100, writing 0x402010a)
[ 1937.102251] firewire_ohci 0000:09:01.0: restoring config space at offset 0x4 (was 0x0, writing 0xfc100000)
[ 1937.102257] firewire_ohci 0000:09:01.0: restoring config space at offset 0x3 (was 0x800000, writing 0x802010)
[ 1937.102264] firewire_ohci 0000:09:01.0: restoring config space at offset 0x1 (was 0x2100000, writing 0x2100106)
[ 1937.102287] firewire_ohci 0000:09:01.0: proprietary Ricoh MMC controller disabled (via firewire function)
[ 1937.102289] firewire_ohci 0000:09:01.0: MMC cards are now supported by standard SDHCI controller
[ 1937.102305] sdhci-pci 0000:09:01.1: restoring config space at offset 0xf (was 0x200, writing 0x20a)
[ 1937.102329] sdhci-pci 0000:09:01.1: restoring config space at offset 0x4 (was 0x0, writing 0xfc100800)
[ 1937.102335] sdhci-pci 0000:09:01.1: restoring config space at offset 0x3 (was 0x804000, writing 0x804010)
[ 1937.102343] sdhci-pci 0000:09:01.1: restoring config space at offset 0x1 (was 0x2100000, writing 0x2100106)
[ 1937.102370] pci 0000:09:01.2: restoring config space at offset 0xf (was 0x200, writing 0x20a)
[ 1937.102394] pci 0000:09:01.2: restoring config space at offset 0x4 (was 0x0, writing 0xfc101000)
[ 1937.102400] pci 0000:09:01.2: restoring config space at offset 0x3 (was 0x804000, writing 0x804010)
[ 1937.102407] pci 0000:09:01.2: restoring config space at offset 0x1 (was 0x2100000, writing 0x2100106)
[ 1937.102434] r852 0000:09:01.3: restoring config space at offset 0xf (was 0x200, writing 0x20a)
[ 1937.102458] r852 0000:09:01.3: restoring config space at offset 0x4 (was 0x0, writing 0xfc101400)
[ 1937.102464] r852 0000:09:01.3: restoring config space at offset 0x3 (was 0x804000, writing 0x804010)
[ 1937.102472] r852 0000:09:01.3: restoring config space at offset 0x1 (was 0x2100000, writing 0x2100106)
[ 1937.103172] PM: early resume of devices complete after 2.632 msecs
[ 1937.103244] uhci_hcd 0000:00:1a.0: PCI INT A -> GSI 16 (level, low) -> IRQ 16
[ 1937.103252] uhci_hcd 0000:00:1a.0: setting latency timer to 64
[ 1937.103280] usb usb3: root hub lost power or was reset
[ 1937.103297] uhci_hcd 0000:00:1a.1: PCI INT B -> GSI 21 (level, low) -> IRQ 21
[ 1937.103306] uhci_hcd 0000:00:1a.1: setting latency timer to 64
[ 1937.103340] usb usb4: root hub lost power or was reset
[ 1937.103356] uhci_hcd 0000:00:1a.2: PCI INT C -> GSI 19 (level, low) -> IRQ 19
[ 1937.103366] uhci_hcd 0000:00:1a.2: setting latency timer to 64
[ 1937.103400] usb usb5: root hub lost power or was reset
[ 1937.103419] ehci_hcd 0000:00:1a.7: PCI INT C -> GSI 19 (level, low) -> IRQ 19
[ 1937.103429] ehci_hcd 0000:00:1a.7: setting latency timer to 64
[ 1937.103489] HDA Intel 0000:00:1b.0: PCI INT A -> GSI 22 (level, low) -> IRQ 22
[ 1937.103498] HDA Intel 0000:00:1b.0: setting latency timer to 64
[ 1937.103556] HDA Intel 0000:00:1b.0: irq 46 for MSI/MSI-X
[ 1937.103565] uhci_hcd 0000:00:1d.0: PCI INT A -> GSI 23 (level, low) -> IRQ 23
[ 1937.103575] uhci_hcd 0000:00:1d.0: setting latency timer to 64
[ 1937.103608] uhci_hcd 0000:00:1d.1: PCI INT B -> GSI 19 (level, low) -> IRQ 19
[ 1937.103606] usb usb6: root hub lost power or was reset
[ 1937.103616] uhci_hcd 0000:00:1d.1: setting latency timer to 64
[ 1937.103622] uhci_hcd 0000:00:1d.2: PCI INT C -> GSI 18 (level, low) -> IRQ 18
[ 1937.103628] uhci_hcd 0000:00:1d.2: setting latency timer to 64
[ 1937.103648] usb usb7: root hub lost power or was reset
[ 1937.103668] ehci_hcd 0000:00:1d.7: PCI INT A -> GSI 23 (level, low) -> IRQ 23
[ 1937.103665] usb usb8: root hub lost power or was reset
[ 1937.103676] ehci_hcd 0000:00:1d.7: setting latency timer to 64
[ 1937.103683] pci 0000:00:1e.0: setting latency timer to 64
[ 1937.103709] ahci 0000:00:1f.2: setting latency timer to 64
[ 1937.103740] radeon 0000:01:00.0: setting latency timer to 64
[ 1937.103868] HDA Intel 0000:01:00.1: PCI INT B -> GSI 17 (level, low) -> IRQ 17
[ 1937.103877] HDA Intel 0000:01:00.1: setting latency timer to 64
[ 1937.103962] HDA Intel 0000:01:00.1: irq 48 for MSI/MSI-X
[ 1937.104024] wl 0000:04:00.0: PCI INT A -> GSI 17 (level, low) -> IRQ 17
[ 1937.104036] wl 0000:04:00.0: setting latency timer to 64
[ 1937.113925] radeon 0000:01:00.0: WB enabled
[ 1937.135282] sdhci-pci 0000:09:01.1: PCI INT B -> GSI 18 (level, low) -> IRQ 18
[ 1937.137075] sd 0:0:0:0: [sda] Starting disk
[ 1937.145683] [drm] ring test succeeded in 1 usecs
[ 1937.145701] [drm] ib test succeeded in 0 usecs
[ 1937.145703] [drm] Enabling audio support
[ 1937.197913] firewire_core: skipped bus generations, destroying all nodes
[ 1937.260209] PM: resume of drv:usb dev:usb4 complete after 123.696 msecs
[ 1937.260238] PM: resume of drv:hub dev:4-0:1.0 complete after 123.713 msecs
[ 1937.260243] PM: resume of drv:usb dev:usb5 complete after 123.666 msecs
[ 1937.260252] PM: resume of drv: dev:ep_00 complete after 123.716 msecs
[ 1937.260265] PM: resume of drv: dev:ep_81 complete after 123.735 msecs
[ 1937.260275] PM: resume of drv:usb dev:usb6 complete after 123.610 msecs
[ 1937.260278] PM: resume of drv: dev:ep_00 complete after 123.633 msecs
[ 1937.260298] PM: resume of drv:usb dev:usb7 complete after 123.542 msecs
[ 1937.260301] PM: resume of drv: dev:ep_00 complete after 123.567 msecs
[ 1937.260311] PM: resume of drv: dev:ep_00 complete after 123.487 msecs
[ 1937.260319] PM: resume of drv:usb dev:usb8 complete after 123.475 msecs
[ 1937.260321] PM: resume of drv:hub dev:7-0:1.0 complete after 123.539 msecs
[ 1937.260326] PM: resume of drv:hub dev:5-0:1.0 complete after 123.727 msecs
[ 1937.260329] PM: resume of drv: dev:ep_81 complete after 123.525 msecs
[ 1937.260333] PM: resume of drv:hub dev:6-0:1.0 complete after 123.643 msecs
[ 1937.260339] PM: resume of drv: dev:ep_81 complete after 123.717 msecs
[ 1937.260341] PM: resume of drv:hub dev:8-0:1.0 complete after 123.472 msecs
[ 1937.260349] PM: resume of drv: dev:ep_81 complete after 123.637 msecs
[ 1937.260351] PM: resume of drv: dev:ep_00 complete after 123.438 msecs
[ 1937.260359] PM: resume of drv: dev:ep_81 complete after 123.467 msecs
[ 1937.370100] PM: resume of drv:usb dev:usb3 complete after 233.621 msecs
[ 1937.370140] PM: resume of drv:hub dev:3-0:1.0 complete after 233.638 msecs
[ 1937.370151] PM: resume of drv: dev:ep_00 complete after 233.643 msecs
[ 1937.370164] PM: resume of drv: dev:ep_81 complete after 233.660 msecs
[ 1937.410095] PM: resume of drv:usb dev:usb1 complete after 273.685 msecs
[ 1937.410128] PM: resume of drv:hub dev:1-0:1.0 complete after 273.694 msecs
[ 1937.410141] PM: resume of drv: dev:ep_00 complete after 273.694 msecs
[ 1937.410155] PM: resume of drv: dev:ep_81 complete after 273.716 msecs
[ 1937.480285] ata6: SATA link down (SStatus 0 SControl 300)
[ 1937.480316] ata5: SATA link down (SStatus 0 SControl 300)
[ 1937.530097] usb 3-1: reset full speed USB device using uhci_hcd and address 2
[ 1937.680103] ata2: SATA link up 1.5 Gbps (SStatus 113 SControl 300)
[ 1937.690076] firewire_core: rediscovered device fw0
[ 1937.712614] ata2.00: configured for UDMA/100
[ 1937.790117] usb 1-6: reset high speed USB device using ehci_hcd and address 3
[ 1937.900099] PM: resume of drv:usb dev:3-1 complete after 762.940 msecs
[ 1937.900126] PM: resume of drv:hub dev:3-1:1.0 complete after 762.944 msecs
[ 1937.900148] PM: resume of drv: dev:ep_00 complete after 762.925 msecs
[ 1937.900152] PM: resume of drv: dev:ep_81 complete after 762.948 msecs
[ 1937.902517] PM: resume of drv:usb dev:3-1.3 complete after 765.103 msecs
[ 1937.902534] PM: resume of drv:btusb dev:3-1.3:1.0 complete after 765.100 msecs
[ 1937.902539] PM: resume of drv:btusb dev:3-1.3:1.1 complete after 765.020 msecs
[ 1937.902552] PM: resume of drv: dev:ep_81 complete after 765.098 msecs
[ 1937.902555] PM: resume of drv:usb dev:3-1.3:1.2 complete after 764.978 msecs
[ 1937.902559] PM: resume of drv: dev:ep_82 complete after 765.086 msecs
[ 1937.902567] PM: resume of drv:usb dev:3-1.3:1.3 complete after 764.929 msecs
[ 1937.902584] PM: resume of drv: dev:ep_04 complete after 764.969 msecs
[ 1937.902588] PM: resume of drv: dev:ep_00 complete after 764.927 msecs
[ 1937.902602] PM: resume of drv: dev:ep_84 complete after 765.006 msecs
[ 1937.902606] PM: resume of drv: dev:ep_83 complete after 765.066 msecs
[ 1937.902618] PM: resume of drv: dev:ep_03 complete after 765.063 msecs
[ 1937.902622] PM: resume of drv: dev:ep_02 complete after 765.123 msecs
[ 1937.946724] PM: resume of drv:usb dev:1-6 complete after 809.750 msecs
[ 1937.946750] PM: resume of drv: dev:ep_00 complete after 809.692 msecs
[ 1937.946755] PM: resume of drv:uvcvideo dev:1-6:1.0 complete after 809.756 msecs
[ 1937.946768] PM: resume of drv:uvcvideo dev:1-6:1.1 complete after 809.730 msecs
[ 1937.946782] PM: resume of drv: dev:ep_81 complete after 809.766 msecs
[ 1938.021514] usb 3-1.1: reset full speed USB device using uhci_hcd and address 3
[ 1938.138506] PM: resume of drv:usb dev:3-1.1 complete after 1001.262 msecs
[ 1938.138532] PM: resume of drv:usbhid dev:3-1.1:1.0 complete after 1001.267 msecs
[ 1938.138536] PM: resume of drv: dev:ep_00 complete after 1001.226 msecs
[ 1938.138552] PM: resume of drv: dev:ep_81 complete after 1001.267 msecs
[ 1938.201511] usb 3-1.2: reset full speed USB device using uhci_hcd and address 4
[ 1938.320515] PM: resume of drv:usb dev:3-1.2 complete after 1183.186 msecs
[ 1938.320539] PM: resume of drv: dev:ep_00 complete after 1183.146 msecs
[ 1938.320544] PM: resume of drv:usb dev:3-1.2:1.0 complete after 1183.190 msecs
[ 1938.320562] PM: resume of drv: dev:ep_81 complete after 1183.193 msecs
[ 1940.020102] ata1: SATA link up 3.0 Gbps (SStatus 123 SControl 300)
[ 1940.027730] ata1.00: configured for UDMA/133
[ 1940.047418] PM: resume of drv:sd dev:0:0:0:0 complete after 2910.334 msecs
[ 1940.047446] PM: resume of drv:scsi_device dev:0:0:0:0 complete after 2910.321 msecs
[ 1940.047451] PM: resume of drv:scsi_disk dev:0:0:0:0 complete after 2782.095 msecs
[ 1949.080135] PM: resume of drv:radeon dev:0000:01:00.0 complete after 11976.404 msecs
[ 1949.080173] PM: resume of drv:drm dev:controlD64 complete after 8998.779 msecs
[ 1949.080325] PM: resume of devices complete after 11977.115 msecs
[ 1949.100418] PM: resume devices took 12.000 seconds
[ 1949.100420] ------------[ cut here ]------------
[ 1949.100425] WARNING: at /build/buildd/linux-2.6.38/kernel/power/suspend_test.c:53 suspend_test_finish+0x86/0x90()
[ 1949.100427] Hardware name: Studio 1537
[ 1949.100429] Component: resume devices, time: 12000
[ 1949.100430] Modules linked in: michael_mic arc4 hidp binfmt_misc rfcomm sco bnep l2cap vboxnetadp vboxnetflt vboxdrv parport_pc ppdev snd_hda_codec_hdmi btusb bluetooth snd_hda_codec_idt joydev radeon snd_hda_intel uvcvideo snd_hda_codec videodev v4l2_compat_ioctl32 snd_hwdep snd_pcm ttm snd_seq_midi drm_kms_helper dell_wmi sparse_keymap snd_rawmidi snd_seq_midi_event snd_seq snd_timer snd_seq_device lib80211_crypt_tkip wl(P) r852 sm_common dell_laptop dcdbas nand nand_ids nand_ecc snd psmouse drm mtd soundcore i2c_algo_bit lib80211 serio_raw snd_page_alloc video lp parport usbhid hid ahci sdhci_pci firewire_ohci firewire_core tg3 sdhci crc_itu_t libahci
[ 1949.100472] Pid: 2414, comm: pm-suspend Tainted: P            2.6.38-8-generic #42-Ubuntu
[ 1949.100474] Call Trace:
[ 1949.100479]  [<ffffffff81065cef>] ? warn_slowpath_common+0x7f/0xc0
[ 1949.100482]  [<ffffffff81065de6>] ? warn_slowpath_fmt+0x46/0x50
[ 1949.100484]  [<ffffffff810a7556>] ? suspend_test_finish+0x86/0x90
[ 1949.100487]  [<ffffffff810a726c>] ? suspend_devices_and_enter+0xac/0x170
[ 1949.100489]  [<ffffffff810a7450>] ? enter_state+0x120/0x150
[ 1949.100493]  [<ffffffff810a68a6>] ? state_store+0xc6/0x100
[ 1949.100497]  [<ffffffff812dcae7>] ? kobj_attr_store+0x17/0x20
[ 1949.100500]  [<ffffffff811d3cce>] ? sysfs_write_file+0xde/0x160
[ 1949.100503]  [<ffffffff81164df6>] ? vfs_write+0xc6/0x180
[ 1949.100506]  [<ffffffff81165111>] ? sys_write+0x51/0x90
[ 1949.100509]  [<ffffffff8100c002>] ? system_call_fastpath+0x16/0x1b
[ 1949.100511] ---[ end trace 41fac857d319bb5c ]---
[ 1949.100561] PM: Finishing wakeup.
[ 1949.100562] Restarting tasks ... 
[ 1949.109271] usb 3-1.3: USB disconnect, address 5
[ 1949.116707] done.
[ 1949.116716] video LNXVIDEO:00: Restoring backlight state
[ 1949.130179] [drm:drm_mode_getfb] *ERROR* invalid framebuffer id
[ 1949.427982] tg3 0000:08:00.0: irq 49 for MSI/MSI-X
[ 1949.530840] ADDRCONF(NETDEV_UP): eth0: link is not ready
[ 1949.711513] usb 3-1.3: new full speed USB device using uhci_hcd and address 6
[ 1950.618936] EXT4-fs (sda2): re-mounted. Opts: errors=remount-ro,commit=0
[ 1959.660116] eth1: no IPv6 routers present
[ 3197.723169] EXT4-fs (sda2): re-mounted. Opts: errors=remount-ro,commit=600
[ 3233.830074] usb 2-2: new high speed USB device using ehci_hcd and address 2
[ 3234.041216] usblp0: USB Bidirectional printer dev 2 if 0 alt 0 proto 2 vid 0x132B pid 0x2033
[ 3234.041473] usbcore: registered new interface driver usblp
[ 3235.453549] usb 2-2: usbfs: interface 0 claimed by usblp while 'usb' sets config #1
[ 3275.200902] usb 2-2: USB disconnect, address 2
[ 3275.201150] usblp0: removed
[ 3316.184519] EXT4-fs (sda2): re-mounted. Opts: errors=remount-ro,commit=0
[ 4720.642017] warning: `VirtualBox' uses 32-bit capabilities (legacy support in use)
[ 7476.357152] EXT4-fs (sda2): re-mounted. Opts: errors=remount-ro,commit=0
[ 7477.238153] PM: Syncing filesystems ... done.
[ 7477.243140] PM: Preparing system for mem sleep
[ 7477.930448] Freezing user space processes ... (elapsed 0.01 seconds) done.
[ 7477.950162] Freezing remaining freezable tasks ... (elapsed 0.01 seconds) done.
[ 7477.970144] PM: Entering mem sleep
[ 7477.970194] Suspending console(s) (use no_console_suspend to debug)
[ 7477.971111] sd 0:0:0:0: [sda] Synchronizing SCSI cache
[ 7477.971222] sd 0:0:0:0: [sda] Stopping disk
[ 7477.985315] ACPI handle has no context!
[ 7477.985324] sdhci-pci 0000:09:01.1: PCI INT B disabled
[ 7477.985331] ACPI handle has no context!
[ 7477.985400] ACPI handle has no context!
[ 7477.985678] wl 0000:04:00.0: PCI INT A disabled
[ 7477.985741] ehci_hcd 0000:00:1d.7: PCI INT A disabled
[ 7477.985766] uhci_hcd 0000:00:1d.2: PCI INT C disabled
[ 7477.985773] uhci_hcd 0000:00:1d.1: PCI INT B disabled
[ 7477.985782] uhci_hcd 0000:00:1d.0: PCI INT A disabled
[ 7477.986626] ehci_hcd 0000:00:1a.7: PCI INT C disabled
[ 7477.986650] uhci_hcd 0000:00:1a.2: PCI INT C disabled
[ 7477.986657] uhci_hcd 0000:00:1a.1: PCI INT B disabled
[ 7478.010059] uhci_hcd 0000:00:1a.0: PCI INT A disabled
[ 7478.090046] HDA Intel 0000:01:00.1: PCI INT B disabled
[ 7478.090095] ACPI handle has no context!
[ 7478.110018] PM: suspend of drv:HDA Intel dev:0000:01:00.1 complete after 124.423 msecs
[ 7478.110286] HDA Intel 0000:00:1b.0: PCI INT A disabled
[ 7478.130017] PM: suspend of drv:HDA Intel dev:0000:00:1b.0 complete after 144.223 msecs
[ 7478.463775] PM: suspend of drv:sd dev:0:0:0:0 complete after 492.668 msecs
[ 7478.463793] PM: suspend of drv:scsi dev:target0:0:0 complete after 492.630 msecs
[ 7478.463802] PM: suspend of drv:scsi dev:host0 complete after 492.532 msecs
[ 7478.480027] PM: suspend of drv:ahci dev:0000:00:1f.2 complete after 494.356 msecs
[ 7479.311297] [drm] Disabling audio support
[ 7479.410026] PM: suspend of drv:radeon dev:0000:01:00.0 complete after 1424.401 msecs
[ 7479.410044] PM: suspend of drv:pcieport dev:0000:00:01.0 complete after 1423.379 msecs
[ 7479.410073] PM: suspend of drv: dev:pci0000:00 complete after 1423.376 msecs
[ 7479.410082] PM: suspend of devices complete after 1439.408 msecs
[ 7479.410085] PM: suspend devices took 1.440 seconds
[ 7479.470256] PM: late suspend of devices complete after 60.166 msecs
[ 7479.470580] ACPI: Preparing to enter system sleep state S3
[ 7479.500460] PM: Saving platform NVS memory
[ 7479.501427] Disabling non-boot CPUs ...
[ 7479.610029] CPU 1 is now offline
[ 7479.610409] Extended CMOS year: 2000
[ 7479.610409] Back to C!
[ 7479.610409] PM: Restoring platform NVS memory
[ 7479.610409] Extended CMOS year: 2000
[ 7479.610409] Enabling non-boot CPUs ...
[ 7479.610409] Booting Node 0 Processor 1 APIC 0x1
[ 7479.780024] Switched to NOHz mode on CPU #1
[ 7479.780415] CPU1 is up
[ 7479.781088] ACPI: Waking up from system sleep state S3
[ 7489.878831] pcieport 0000:00:01.0: restoring config space at offset 0x6 (was 0x0, writing 0x10100)
[ 7489.878842] pcieport 0000:00:01.0: restoring config space at offset 0x3 (was 0x10000, writing 0x10010)
[ 7489.878846] pcieport 0000:00:01.0: restoring config space at offset 0x1 (was 0x100107, writing 0x100507)
[ 7489.878897] uhci_hcd 0000:00:1a.0: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 7489.878943] uhci_hcd 0000:00:1a.1: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 7489.878968] uhci_hcd 0000:00:1a.2: restoring config space at offset 0xf (was 0x300, writing 0x30a)
[ 7489.878982] uhci_hcd 0000:00:1a.2: restoring config space at offset 0x8 (was 0x1, writing 0x1841)
[ 7489.878996] uhci_hcd 0000:00:1a.2: restoring config space at offset 0x1 (was 0x2900000, writing 0x2900001)
[ 7489.879046] ehci_hcd 0000:00:1a.7: restoring config space at offset 0x1 (was 0x2900106, writing 0x2900102)
[ 7489.879084] HDA Intel 0000:00:1b.0: restoring config space at offset 0xf (was 0x100, writing 0x10b)
[ 7489.879110] HDA Intel 0000:00:1b.0: restoring config space at offset 0x3 (was 0x0, writing 0x10)
[ 7489.879118] HDA Intel 0000:00:1b.0: restoring config space at offset 0x1 (was 0x100106, writing 0x100102)
[ 7489.879154] pcieport 0000:00:1c.0: restoring config space at offset 0xf (was 0x40100, writing 0x4010a)
[ 7489.879167] pcieport 0000:00:1c.0: restoring config space at offset 0x9 (was 0x10001, writing 0xf1f1f001)
[ 7489.879173] pcieport 0000:00:1c.0: restoring config space at offset 0x8 (was 0x0, writing 0xf7f0f600)
[ 7489.879178] pcieport 0000:00:1c.0: restoring config space at offset 0x7 (was 0x0, writing 0x3030)
[ 7489.879184] pcieport 0000:00:1c.0: restoring config space at offset 0x6 (was 0x0, writing 0x30200)
[ 7489.879192] pcieport 0000:00:1c.0: restoring config space at offset 0x3 (was 0x810000, writing 0x810010)
[ 7489.879198] pcieport 0000:00:1c.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 7489.879255] pcieport 0000:00:1c.1: restoring config space at offset 0xf (was 0x40200, writing 0x40205)
[ 7489.879271] pcieport 0000:00:1c.1: restoring config space at offset 0x7 (was 0x3030, writing 0x4040)
[ 7489.879281] pcieport 0000:00:1c.1: restoring config space at offset 0x3 (was 0x810000, writing 0x810010)
[ 7489.879288] pcieport 0000:00:1c.1: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 7489.879345] pcieport 0000:00:1c.3: restoring config space at offset 0xf (was 0x40400, writing 0x4040a)
[ 7489.879358] pcieport 0000:00:1c.3: restoring config space at offset 0x9 (was 0x10001, writing 0xf5f1f401)
[ 7489.879364] pcieport 0000:00:1c.3: restoring config space at offset 0x7 (was 0x20000000, writing 0x20005050)
[ 7489.879374] pcieport 0000:00:1c.3: restoring config space at offset 0x3 (was 0x810000, writing 0x810010)
[ 7489.879380] pcieport 0000:00:1c.3: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 7489.879437] pcieport 0000:00:1c.5: restoring config space at offset 0xf (was 0x40200, writing 0x40205)
[ 7489.879450] pcieport 0000:00:1c.5: restoring config space at offset 0x9 (was 0x10001, writing 0xc011c001)
[ 7489.879456] pcieport 0000:00:1c.5: restoring config space at offset 0x7 (was 0x20000000, writing 0x20006060)
[ 7489.879466] pcieport 0000:00:1c.5: restoring config space at offset 0x3 (was 0x810000, writing 0x810010)
[ 7489.879472] pcieport 0000:00:1c.5: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 7489.879543] uhci_hcd 0000:00:1d.0: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 7489.879585] uhci_hcd 0000:00:1d.1: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 7489.879630] uhci_hcd 0000:00:1d.2: restoring config space at offset 0x1 (was 0x2900005, writing 0x2900001)
[ 7489.879682] ehci_hcd 0000:00:1d.7: restoring config space at offset 0x1 (was 0x2900106, writing 0x2900102)
[ 7489.879713] pci 0000:00:1e.0: restoring config space at offset 0xf (was 0x40000, writing 0x400ff)
[ 7489.879726] pci 0000:00:1e.0: restoring config space at offset 0x9 (was 0x10001, writing 0x1fff1)
[ 7489.879731] pci 0000:00:1e.0: restoring config space at offset 0x8 (was 0x0, writing 0xfc10fc10)
[ 7489.879736] pci 0000:00:1e.0: restoring config space at offset 0x7 (was 0x22800000, writing 0x228000f0)
[ 7489.879749] pci 0000:00:1e.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100107)
[ 7489.879834] ahci 0000:00:1f.2: restoring config space at offset 0xf (was 0x200, writing 0x20a)
[ 7489.879858] ahci 0000:00:1f.2: restoring config space at offset 0x1 (was 0x2b00007, writing 0x2b00407)
[ 7489.879916] pci 0000:00:1f.3: restoring config space at offset 0x4 (was 0x4, writing 0xc0200004)
[ 7489.879954] radeon 0000:01:00.0: restoring config space at offset 0xf (was 0x1ff, writing 0x105)
[ 7489.879972] radeon 0000:01:00.0: restoring config space at offset 0x6 (was 0x0, writing 0xcfef0000)
[ 7489.879977] radeon 0000:01:00.0: restoring config space at offset 0x5 (was 0x1, writing 0x2001)
[ 7489.879983] radeon 0000:01:00.0: restoring config space at offset 0x4 (was 0x8, writing 0xd0000008)
[ 7489.879988] radeon 0000:01:00.0: restoring config space at offset 0x3 (was 0x800000, writing 0x800010)
[ 7489.879994] radeon 0000:01:00.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100507)
[ 7489.880073] HDA Intel 0000:01:00.1: restoring config space at offset 0xf (was 0x2ff, writing 0x20a)
[ 7489.880094] HDA Intel 0000:01:00.1: restoring config space at offset 0x4 (was 0x0, writing 0xcfeec000)
[ 7489.880099] HDA Intel 0000:01:00.1: restoring config space at offset 0x3 (was 0x800000, writing 0x800010)
[ 7489.880106] HDA Intel 0000:01:00.1: restoring config space at offset 0x1 (was 0x100000, writing 0x100103)
[ 7489.880184] wl 0000:04:00.0: restoring config space at offset 0xf (was 0x100, writing 0x10a)
[ 7489.880229] wl 0000:04:00.0: restoring config space at offset 0x4 (was 0x4, writing 0xf8000004)
[ 7489.880237] wl 0000:04:00.0: restoring config space at offset 0x3 (was 0x0, writing 0x10)
[ 7489.880251] wl 0000:04:00.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100106)
[ 7489.880429] tg3 0000:08:00.0: restoring config space at offset 0x3 (was 0x0, writing 0x10)
[ 7489.880441] tg3 0000:08:00.0: restoring config space at offset 0x1 (was 0x100000, writing 0x100106)
[ 7489.880515] firewire_ohci 0000:09:01.0: restoring config space at offset 0xf (was 0x4020100, writing 0x402010a)
[ 7489.880546] firewire_ohci 0000:09:01.0: restoring config space at offset 0x4 (was 0x0, writing 0xfc100000)
[ 7489.880551] firewire_ohci 0000:09:01.0: restoring config space at offset 0x3 (was 0x800000, writing 0x802010)
[ 7489.880559] firewire_ohci 0000:09:01.0: restoring config space at offset 0x1 (was 0x2100000, writing 0x2100106)
[ 7489.880583] firewire_ohci 0000:09:01.0: proprietary Ricoh MMC controller disabled (via firewire function)
[ 7489.880584] firewire_ohci 0000:09:01.0: MMC cards are now supported by standard SDHCI controller
[ 7489.880602] sdhci-pci 0000:09:01.1: restoring config space at offset 0xf (was 0x200, writing 0x20a)
[ 7489.880631] sdhci-pci 0000:09:01.1: restoring config space at offset 0x4 (was 0x0, writing 0xfc100800)
[ 7489.880637] sdhci-pci 0000:09:01.1: restoring config space at offset 0x3 (was 0x804000, writing 0x804010)
[ 7489.880647] sdhci-pci 0000:09:01.1: restoring config space at offset 0x1 (was 0x2100000, writing 0x2100106)
[ 7489.880675] pci 0000:09:01.2: restoring config space at offset 0xf (was 0x200, writing 0x20a)
[ 7489.880719] pci 0000:09:01.2: restoring config space at offset 0x4 (was 0x0, writing 0xfc101000)
[ 7489.880730] pci 0000:09:01.2: restoring config space at offset 0x3 (was 0x804000, writing 0x804010)
[ 7489.880737] pci 0000:09:01.2: restoring config space at offset 0x1 (was 0x2100000, writing 0x2100106)
[ 7489.880766] r852 0000:09:01.3: restoring config space at offset 0xf (was 0x200, writing 0x20a)
[ 7489.880792] r852 0000:09:01.3: restoring config space at offset 0x4 (was 0x0, writing 0xfc101400)
[ 7489.880798] r852 0000:09:01.3: restoring config space at offset 0x3 (was 0x804000, writing 0x804010)
[ 7489.880807] r852 0000:09:01.3: restoring config space at offset 0x1 (was 0x2100000, writing 0x2100106)
[ 7489.881612] PM: early resume of devices complete after 2.943 msecs
[ 7489.881760] uhci_hcd 0000:00:1a.0: PCI INT A -> GSI 16 (level, low) -> IRQ 16
[ 7489.881767] uhci_hcd 0000:00:1a.0: setting latency timer to 64
[ 7489.881797] usb usb3: root hub lost power or was reset
[ 7489.881812] uhci_hcd 0000:00:1a.1: PCI INT B -> GSI 21 (level, low) -> IRQ 21
[ 7489.881818] uhci_hcd 0000:00:1a.1: setting latency timer to 64
[ 7489.881844] usb usb4: root hub lost power or was reset
[ 7489.881859] uhci_hcd 0000:00:1a.2: PCI INT C -> GSI 19 (level, low) -> IRQ 19
[ 7489.881866] uhci_hcd 0000:00:1a.2: setting latency timer to 64
[ 7489.881892] usb usb5: root hub lost power or was reset
[ 7489.881910] ehci_hcd 0000:00:1a.7: PCI INT C -> GSI 19 (level, low) -> IRQ 19
[ 7489.881918] ehci_hcd 0000:00:1a.7: setting latency timer to 64
[ 7489.881969] HDA Intel 0000:00:1b.0: PCI INT A -> GSI 22 (level, low) -> IRQ 22
[ 7489.881979] HDA Intel 0000:00:1b.0: setting latency timer to 64
[ 7489.882034] HDA Intel 0000:00:1b.0: irq 46 for MSI/MSI-X
[ 7489.882093] uhci_hcd 0000:00:1d.0: PCI INT A -> GSI 23 (level, low) -> IRQ 23
[ 7489.882100] uhci_hcd 0000:00:1d.0: setting latency timer to 64
[ 7489.882129] usb usb6: root hub lost power or was reset
[ 7489.882142] uhci_hcd 0000:00:1d.1: PCI INT B -> GSI 19 (level, low) -> IRQ 19
[ 7489.882150] uhci_hcd 0000:00:1d.1: setting latency timer to 64
[ 7489.882179] usb usb7: root hub lost power or was reset
[ 7489.882193] uhci_hcd 0000:00:1d.2: PCI INT C -> GSI 18 (level, low) -> IRQ 18
[ 7489.882200] uhci_hcd 0000:00:1d.2: setting latency timer to 64
[ 7489.882230] usb usb8: root hub lost power or was reset
[ 7489.882246] ehci_hcd 0000:00:1d.7: PCI INT A -> GSI 23 (level, low) -> IRQ 23
[ 7489.882252] ehci_hcd 0000:00:1d.7: setting latency timer to 64
[ 7489.882301] pci 0000:00:1e.0: setting latency timer to 64
[ 7489.882320] ahci 0000:00:1f.2: setting latency timer to 64
[ 7489.882387] radeon 0000:01:00.0: setting latency timer to 64
[ 7489.883535] HDA Intel 0000:01:00.1: PCI INT B -> GSI 17 (level, low) -> IRQ 17
[ 7489.883542] HDA Intel 0000:01:00.1: setting latency timer to 64
[ 7489.883597] HDA Intel 0000:01:00.1: irq 48 for MSI/MSI-X
[ 7489.883640] wl 0000:04:00.0: PCI INT A -> GSI 17 (level, low) -> IRQ 17
[ 7489.883649] wl 0000:04:00.0: setting latency timer to 64
[ 7489.891670] radeon 0000:01:00.0: WB enabled
[ 7489.914508] sdhci-pci 0000:09:01.1: PCI INT B -> GSI 18 (level, low) -> IRQ 18
[ 7489.916454] sd 0:0:0:0: [sda] Starting disk
[ 7489.924048] [drm] ring test succeeded in 1 usecs
[ 7489.924066] [drm] ib test succeeded in 0 usecs
[ 7489.924068] [drm] Enabling audio support
[ 7489.977641] firewire_core: skipped bus generations, destroying all nodes
[ 7490.040197] PM: resume of drv:usb dev:usb4 complete after 124.401 msecs
[ 7490.040227] PM: resume of drv:hub dev:4-0:1.0 complete after 124.420 msecs
[ 7490.040232] PM: resume of drv:usb dev:usb5 complete after 124.404 msecs
[ 7490.040240] PM: resume of drv: dev:ep_00 complete after 124.418 msecs
[ 7490.040248] PM: resume of drv: dev:ep_81 complete after 124.435 msecs
[ 7490.040261] PM: resume of drv:usb dev:usb6 complete after 124.356 msecs
[ 7490.040267] PM: resume of drv: dev:ep_00 complete after 124.385 msecs
[ 7490.040284] PM: resume of drv: dev:ep_00 complete after 124.265 msecs
[ 7490.040290] PM: resume of drv:usb dev:usb7 complete after 124.250 msecs
[ 7490.040302] PM: resume of drv:hub dev:6-0:1.0 complete after 124.326 msecs
[ 7490.040313] PM: resume of drv: dev:ep_81 complete after 124.315 msecs
[ 7490.040321] PM: resume of drv:usb dev:usb8 complete after 124.190 msecs
[ 7490.040330] PM: resume of drv: dev:ep_00 complete after 124.221 msecs
[ 7490.040335] PM: resume of drv:hub dev:5-0:1.0 complete after 124.497 msecs
[ 7490.040351] PM: resume of drv: dev:ep_00 complete after 124.147 msecs
[ 7490.040353] PM: resume of drv:hub dev:7-0:1.0 complete after 124.290 msecs
[ 7490.040361] PM: resume of drv: dev:ep_81 complete after 124.521 msecs
[ 7490.040363] PM: resume of drv:hub dev:8-0:1.0 complete after 124.207 msecs
[ 7490.040372] PM: resume of drv: dev:ep_81 complete after 124.287 msecs
[ 7490.040374] PM: resume of drv: dev:ep_81 complete after 124.196 msecs
[ 7490.150045] PM: resume of drv:usb dev:usb3 complete after 234.296 msecs
[ 7490.150079] PM: resume of drv:hub dev:3-0:1.0 complete after 234.309 msecs
[ 7490.150090] PM: resume of drv: dev:ep_00 complete after 234.304 msecs
[ 7490.150104] PM: resume of drv: dev:ep_81 complete after 234.326 msecs
[ 7490.190046] PM: resume of drv:usb dev:usb1 complete after 274.476 msecs
[ 7490.190076] PM: resume of drv:hub dev:1-0:1.0 complete after 274.497 msecs
[ 7490.190088] PM: resume of drv: dev:ep_00 complete after 274.368 msecs
[ 7490.190102] PM: resume of drv: dev:ep_81 complete after 274.401 msecs
[ 7490.240075] ata6: SATA link down (SStatus 0 SControl 300)
[ 7490.240107] ata5: SATA link down (SStatus 0 SControl 300)
[ 7490.310043] usb 3-1: reset full speed USB device using uhci_hcd and address 2
[ 7490.440049] ata1: SATA link up 3.0 Gbps (SStatus 123 SControl 300)
[ 7490.440075] ata2: SATA link up 1.5 Gbps (SStatus 113 SControl 300)
[ 7490.442417] ata1.00: configured for UDMA/133
[ 7490.468250] ata2.00: configured for UDMA/100
[ 7490.470067] firewire_core: rediscovered device fw0
[ 7490.570051] usb 1-6: reset high speed USB device using ehci_hcd and address 3
[ 7490.680045] PM: resume of drv:usb dev:3-1 complete after 763.507 msecs
[ 7490.680083] PM: resume of drv:hub dev:3-1:1.0 complete after 763.525 msecs
[ 7490.680103] PM: resume of drv: dev:ep_81 complete after 763.524 msecs
[ 7490.680107] PM: resume of drv: dev:ep_00 complete after 763.506 msecs
[ 7490.682788] PM: resume of drv:usb dev:3-1.3 complete after 765.999 msecs
[ 7490.682808] PM: resume of drv:btusb dev:3-1.3:1.0 complete after 765.998 msecs
[ 7490.682813] PM: resume of drv:btusb dev:3-1.3:1.1 complete after 765.913 msecs
[ 7490.682826] PM: resume of drv: dev:ep_81 complete after 765.995 msecs
[ 7490.682829] PM: resume of drv:usb dev:3-1.3:1.2 complete after 765.865 msecs
[ 7490.682833] PM: resume of drv: dev:ep_82 complete after 765.977 msecs
[ 7490.682841] PM: resume of drv: dev:ep_02 complete after 765.965 msecs
[ 7490.682845] PM: resume of drv:usb dev:3-1.3:1.3 complete after 765.819 msecs
[ 7490.682861] PM: resume of drv: dev:ep_04 complete after 765.858 msecs
[ 7490.682865] PM: resume of drv: dev:ep_00 complete after 765.818 msecs
[ 7490.682877] PM: resume of drv: dev:ep_84 complete after 765.895 msecs
[ 7490.682881] PM: resume of drv: dev:ep_83 complete after 765.960 msecs
[ 7490.682894] PM: resume of drv: dev:ep_03 complete after 765.955 msecs
[ 7490.726759] PM: resume of drv:usb dev:1-6 complete after 810.498 msecs
[ 7490.726787] PM: resume of drv: dev:ep_00 complete after 810.351 msecs
[ 7490.726792] PM: resume of drv:uvcvideo dev:1-6:1.0 complete after 810.506 msecs
[ 7490.726805] PM: resume of drv:uvcvideo dev:1-6:1.1 complete after 810.391 msecs
[ 7490.726820] PM: resume of drv: dev:ep_81 complete after 810.428 msecs
[ 7490.801784] usb 3-1.2: reset full speed USB device using uhci_hcd and address 4
[ 7490.804063] PM: resume of drv:sd dev:0:0:0:0 complete after 887.602 msecs
[ 7490.804091] PM: resume of drv:scsi_device dev:0:0:0:0 complete after 887.589 msecs
[ 7490.804096] PM: resume of drv:scsi_disk dev:0:0:0:0 complete after 758.573 msecs
[ 7490.920794] PM: resume of drv:usb dev:3-1.2 complete after 1004.091 msecs
[ 7490.920818] PM: resume of drv: dev:ep_00 complete after 1004.052 msecs
[ 7490.920823] PM: resume of drv:usb dev:3-1.2:1.0 complete after 1004.096 msecs
[ 7490.920841] PM: resume of drv: dev:ep_81 complete after 1004.096 msecs
[ 7490.981783] usb 3-1.1: reset full speed USB device using uhci_hcd and address 3
[ 7491.098789] PM: resume of drv:usb dev:3-1.1 complete after 1182.170 msecs
[ 7491.098812] PM: resume of drv: dev:ep_00 complete after 1182.131 msecs
[ 7491.098817] PM: resume of drv:usbhid dev:3-1.1:1.0 complete after 1182.176 msecs
[ 7491.098841] PM: resume of drv: dev:ep_81 complete after 1182.180 msecs
[ 7491.098845] PM: resume of drv:generic-usb dev:0003:413C:8157.0001 complete after 294.697 msecs
[ 7501.860134] PM: resume of drv:radeon dev:0000:01:00.0 complete after 11977.748 msecs
[ 7501.860171] PM: resume of drv:drm dev:controlD64 complete after 10728.286 msecs
[ 7501.860324] PM: resume of devices complete after 11978.673 msecs
[ 7501.880418] PM: resume devices took 12.000 seconds
[ 7501.880420] ------------[ cut here ]------------
[ 7501.880425] WARNING: at /build/buildd/linux-2.6.38/kernel/power/suspend_test.c:53 suspend_test_finish+0x86/0x90()
[ 7501.880427] Hardware name: Studio 1537
[ 7501.880428] Component: resume devices, time: 12000
[ 7501.880430] Modules linked in: usblp michael_mic arc4 hidp binfmt_misc rfcomm sco bnep l2cap vboxnetadp vboxnetflt vboxdrv parport_pc ppdev snd_hda_codec_hdmi btusb bluetooth snd_hda_codec_idt joydev radeon snd_hda_intel uvcvideo snd_hda_codec videodev v4l2_compat_ioctl32 snd_hwdep snd_pcm ttm snd_seq_midi drm_kms_helper dell_wmi sparse_keymap snd_rawmidi snd_seq_midi_event snd_seq snd_timer snd_seq_device lib80211_crypt_tkip wl(P) r852 sm_common dell_laptop dcdbas nand nand_ids nand_ecc snd psmouse drm mtd soundcore i2c_algo_bit lib80211 serio_raw snd_page_alloc video lp parport usbhid hid ahci sdhci_pci firewire_ohci firewire_core tg3 sdhci crc_itu_t libahci
[ 7501.880471] Pid: 5398, comm: pm-suspend Tainted: P        W   2.6.38-8-generic #42-Ubuntu
[ 7501.880473] Call Trace:
[ 7501.880478]  [<ffffffff81065cef>] ? warn_slowpath_common+0x7f/0xc0
[ 7501.880481]  [<ffffffff81065de6>] ? warn_slowpath_fmt+0x46/0x50
[ 7501.880484]  [<ffffffff810a7556>] ? suspend_test_finish+0x86/0x90
[ 7501.880486]  [<ffffffff810a726c>] ? suspend_devices_and_enter+0xac/0x170
[ 7501.880489]  [<ffffffff810a7450>] ? enter_state+0x120/0x150
[ 7501.880492]  [<ffffffff810a68a6>] ? state_store+0xc6/0x100
[ 7501.880496]  [<ffffffff812dcae7>] ? kobj_attr_store+0x17/0x20
[ 7501.880499]  [<ffffffff811d3cce>] ? sysfs_write_file+0xde/0x160
[ 7501.880503]  [<ffffffff81164df6>] ? vfs_write+0xc6/0x180
[ 7501.880505]  [<ffffffff81165111>] ? sys_write+0x51/0x90
[ 7501.880508]  [<ffffffff8100c002>] ? system_call_fastpath+0x16/0x1b
[ 7501.880510] ---[ end trace 41fac857d319bb5d ]---
[ 7501.880561] PM: Finishing wakeup.
[ 7501.880563] Restarting tasks ... 
[ 7501.887724] usb 3-1.3: USB disconnect, address 6
[ 7501.915872] done.
[ 7501.915888] video LNXVIDEO:00: Restoring backlight state
[ 7501.916150] [drm:drm_mode_getfb] *ERROR* invalid framebuffer id
[ 7502.221929] tg3 0000:08:00.0: irq 49 for MSI/MSI-X
[ 7502.341146] ADDRCONF(NETDEV_UP): eth0: link is not ready
[ 7502.512777] usb 3-1.3: new full speed USB device using uhci_hcd and address 7
[ 7503.804616] EXT4-fs (sda2): re-mounted. Opts: errors=remount-ro,commit=0
[ 7512.790040] eth1: no IPv6 routers present