[73.692119] Initializing watchdogs
[73.692275]   /dev/watchdog0
[73.714871] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300)
[73.722813] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[73.726639] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[73.729823] [001/133] (960s left) i915_suspend (debugfs-reader)
[73.817236] Starting subtest: debugfs-reader
[92.857351] Subtest debugfs-reader: SUCCESS (2.606s)
[99.916430] [002/133] (941s left) syncobj_timeline (single-wait-available-signaled)
[100.010118] Starting subtest: single-wait-available-signaled
[100.010953] Subtest single-wait-available-signaled: SUCCESS (0.001s)
[100.107050] [003/133] (941s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[100.599507] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc
[100.602666] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[100.706852] [004/133] (940s left) kms_dp_link_training (uhbr-sst)
[101.188483] Starting subtest: uhbr-sst
[101.190723] Subtest uhbr-sst: SKIP (0.000s)
[101.279657] [005/133] (940s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted)
[101.342786] Starting subtest: multi-wait-all-for-submit-available-submitted
[101.343815] Subtest multi-wait-all-for-submit-available-submitted: SUCCESS (0.001s)
[101.440587] [006/133] (940s left) gem_partial_pwrite_pread (write-display)
[101.505872] Starting subtest: write-display
[105.459805] Subtest write-display: SUCCESS (3.954s)
[105.575912] [007/133] (935s left) kms_psr_stress_test (invalidate-primary-flip-overlay)
[105.636267] Subtest invalidate-primary-flip-overlay: SKIP (0.000s)
[105.704971] [008/133] (935s left) gem_mmap (basic-small-bo)
[105.762198] Starting subtest: basic-small-bo
[106.298313] Subtest basic-small-bo: SUCCESS (0.535s)
[106.404571] [009/133] (935s left) gem_exec_schedule (timeslicing)
[106.611670] Subtest timeslicing: SKIP (0.000s)
[106.815218] [010/133] (934s left) vgem_basic (sysfs)
[106.936666] Starting subtest: sysfs
[106.938485] Subtest sysfs: SUCCESS (0.001s)
[107.015718] [FACT vgem_basic (sysfs)] new: kernel.kmod_is_loaded.vgem: true
[107.018127] [011/133] (934s left) gem_softpin (evict-active)
[107.078191] Starting subtest: evict-active
[107.081906] Subtest evict-active: SUCCESS (0.005s)
[107.202915] [012/133] (934s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc)
[107.261693] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc: SKIP (0.000s)
[107.323371] [013/133] (934s left) syncobj_wait (invalid-wait-illegal-handle)
[107.384644] Starting subtest: invalid-wait-illegal-handle
[107.385408] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s)
[107.484836] [014/133] (934s left) syncobj_timeline (reset-multiple-signaled)
[107.543852] Starting subtest: reset-multiple-signaled
[107.544561] Subtest reset-multiple-signaled: SUCCESS (0.001s)
[107.637409] [015/133] (934s left) gem_ctx_engines (independent)
[107.709189] Starting subtest: independent
[107.711544] Subtest independent: SKIP (0.000s)
[107.913299] [016/133] (934s left) kms_plane_multiple (tiling-4)
[108.405440] Starting subtest: tiling-4
[108.407325] Subtest tiling-4: SKIP (0.000s)
[108.505691] [017/133] (933s left) syncobj_wait (invalid-reset-bad-pad)
[108.564952] Starting subtest: invalid-reset-bad-pad
[108.565826] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[108.659358] [018/133] (933s left) gem_ctx_persistence (engines-hostile-preempt)
[108.723320] Subtest engines-hostile-preempt: SKIP (0.000s)
[108.802201] [019/133] (933s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs)
[108.857532] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[108.920557] [020/133] (933s left) syncobj_wait (invalid-signal-one-illegal-handle)
[108.977088] Starting subtest: invalid-signal-one-illegal-handle
[108.977976] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[109.079855] [021/133] (933s left) kms_psr (fbc-pr-basic)
[109.563958] Subtest fbc-pr-basic: SKIP (0.000s)
[109.619340] [022/133] (932s left) kms_lease (lease-again)
[110.107653] Starting subtest: lease-again
[110.108727] Starting dynamic subtest: pipe-A-VGA-1
[110.113460] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.003s)
[110.125711] Starting dynamic subtest: pipe-A-HDMI-A-1
[110.126437] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.001s)
[110.138501] Starting dynamic subtest: pipe-B-VGA-1
[110.139234] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.001s)
[110.150883] Starting dynamic subtest: pipe-B-HDMI-A-1
[110.151762] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[110.152567] Subtest lease-again: SUCCESS (0.011s)
[110.209222] [023/133] (932s left) i915_pm_freq_api (freq-suspend)
[110.270234] Subtest freq-suspend: SKIP (0.000s)
[110.337686] [024/133] (932s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing)
[110.820318] Starting subtest: plane-use-after-nonblocking-unbind-fencing
[110.821416] Starting dynamic subtest: pipe-A-VGA-1
[111.014507] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.193s)
[111.064706] Starting dynamic subtest: pipe-A-HDMI-A-1
[111.315494] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.262s)
[111.413804] Starting dynamic subtest: pipe-B-VGA-1
[111.594927] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.195s)
[111.645909] Starting dynamic subtest: pipe-B-HDMI-A-1
[111.896128] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.261s)
[111.981174] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (1.159s)
[112.239031] [025/133] (930s left) kms_flip (flip-vs-dpms-on-nop)
[112.735859] Starting subtest: flip-vs-dpms-on-nop
[112.736763] Starting dynamic subtest: A-VGA1
[113.872557] Dynamic subtest A-VGA1: SUCCESS (1.136s)
[113.885578] Starting dynamic subtest: B-VGA1
[114.863543] Dynamic subtest B-VGA1: SUCCESS (0.989s)
[114.877858] Starting dynamic subtest: A-HDMI-A1
[115.902125] Dynamic subtest A-HDMI-A1: SUCCESS (1.037s)
[115.915962] Starting dynamic subtest: B-HDMI-A1
[116.968950] Dynamic subtest B-HDMI-A1: SUCCESS (1.066s)
[116.970595] Subtest flip-vs-dpms-on-nop: SUCCESS (4.235s)
[117.159107] [026/133] (925s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180-hflip)
[117.660679] Starting subtest: linear-max-hw-stride-32bpp-rotate-180-hflip
[117.662258] Subtest linear-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[117.769083] [027/133] (924s left) kms_tiled_display (basic-test-pattern-with-chamelium)
[118.476910] Subtest basic-test-pattern-with-chamelium: SKIP (0.000s)
[118.542551] [028/133] (924s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[119.027363] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc
[119.029136] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[119.137720] [029/133] (923s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[119.732070] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[119.950482] [030/133] (922s left) gem_exec_balancer (parallel-contexts)
[120.013990] Subtest parallel-contexts: SKIP (0.000s)
[120.103642] [031/133] (922s left) gem_exec_reloc (basic-cpu-gtt-noreloc)
[120.164097] Starting subtest: basic-cpu-gtt-noreloc
[120.166226] Subtest basic-cpu-gtt-noreloc: SUCCESS (0.003s)
[120.696015] [032/133] (922s left) gem_ctx_persistence (heartbeat-many)
[120.758334] Subtest heartbeat-many: SKIP (0.000s)
[120.812379] [033/133] (922s left) prime_vgem (busy)
[120.892656] Starting subtest: busy
[120.893618] Starting dynamic subtest: rcs0
[120.913273] Dynamic subtest rcs0: SUCCESS (0.020s)
[120.927823] Starting dynamic subtest: bcs0
[120.931487] Dynamic subtest bcs0: SUCCESS (0.018s)
[120.932778] Subtest busy: SUCCESS (0.039s)
[121.056611] [034/133] (921s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-submi
[121.112609] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-submitted
[121.220639] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-submitted: SUCCESS (0.107s)
[121.322128] [035/133] (921s left) gem_ccs (block-copy-compressed)
[121.382616] Subtest block-copy-compressed: SKIP (0.000s)
[121.447547] [036/133] (921s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-gtt)
[121.941605] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-gtt
[123.795478] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-gtt: SUCCESS (1.853s)
[123.928828] [037/133] (919s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-pwrite)
[124.426613] Starting subtest: psr-1p-primscrn-cur-indfb-draw-pwrite
[124.428031] Subtest psr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[124.547146] [038/133] (918s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render)
[125.028601] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render
[125.030670] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[125.150457] [039/133] (918s left) kms_cursor_legacy (torture-move)
[125.643309] Starting subtest: torture-move
[125.644147] Starting dynamic subtest: pipe-A
[131.193475] Dynamic subtest pipe-A: SUCCESS (5.547s)
[131.213203] Starting dynamic subtest: pipe-B
[136.737793] Dynamic subtest pipe-B: SUCCESS (5.544s)
[136.764827] Starting dynamic subtest: all-pipes
[143.280731] Dynamic subtest all-pipes: SUCCESS (6.542s)
[143.281528] Subtest torture-move: SUCCESS (17.638s)
[143.390380] [040/133] (899s left) kms_vblank (ts-continuation-dpms-rpm)
[143.872610] Starting subtest: ts-continuation-dpms-rpm
[143.873607] Starting dynamic subtest: pipe-A-VGA-1
[155.168502] Dynamic subtest pipe-A-VGA-1: SKIP (11.294s)
[155.181967] Starting dynamic subtest: pipe-A-HDMI-A-1
[166.460358] Dynamic subtest pipe-A-HDMI-A-1: SKIP (11.290s)
[166.473869] Starting dynamic subtest: pipe-B-VGA-1
[177.754047] Dynamic subtest pipe-B-VGA-1: SKIP (11.291s)
[177.767687] Starting dynamic subtest: pipe-B-HDMI-A-1
[189.044809] Dynamic subtest pipe-B-HDMI-A-1: SKIP (11.289s)
[189.046426] Subtest ts-continuation-dpms-rpm: SKIP (45.172s)
[189.250164] [041/133] (854s left) kms_joiner (basic-ultra-joiner)
[189.738176] Starting subtest: basic-ultra-joiner
[189.740181] Subtest basic-ultra-joiner: SKIP (0.000s)
[189.834971] [042/133] (853s left) kms_pm_rpm (modeset-lpsp-stress)
[201.619569] Subtest modeset-lpsp-stress: SKIP (0.000s)
[201.681555] [043/133] (841s left) gem_linear_blits (interruptible)
[201.888721] Starting subtest: interruptible
[203.967754] Subtest interruptible: SUCCESS (2.081s)
[204.062536] [044/133] (839s left) gem_eio (reset-stress)
[204.235319] Starting subtest: reset-stress
[204.237451] Starting dynamic subtest: render
[205.864704] Dynamic subtest render: SUCCESS (1.628s)
[205.878165] Starting dynamic subtest: bsd
[207.064350] Dynamic subtest bsd: FAIL (1.175s)
[207.079085] Starting dynamic subtest: blt
[208.603641] Dynamic subtest blt: SUCCESS (1.563s)
[208.609329] Subtest reset-stress: FAIL (4.368s)
[209.177976] [045/133] (834s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[209.669186] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[210.167996] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SUCCESS (0.499s)
[210.438046] [046/133] (833s left) kms_prop_blob (invalid-get-prop)
[210.498065] Starting subtest: invalid-get-prop
[210.498965] Subtest invalid-get-prop: SUCCESS (0.000s)
[210.601720] [047/133] (833s left) kms_frontbuffer_tracking (fbcpsr-2p-shrfb-fliptrack-mmap-gtt)
[211.093579] Starting subtest: fbcpsr-2p-shrfb-fliptrack-mmap-gtt
[211.095348] Subtest fbcpsr-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[211.204577] [048/133] (832s left) gem_ringfill (engines-basic)
[211.373770] Starting subtest: engines-basic
[211.374658] Starting dynamic subtest: rcs0
[211.398851] Dynamic subtest rcs0: SUCCESS (0.026s)
[211.418809] Starting dynamic subtest: bcs0
[211.420047] Dynamic subtest bcs0: SUCCESS (0.014s)
[211.421005] Subtest engines-basic: SUCCESS (0.043s)
[211.519780] [049/133] (832s left) syncobj_wait (multi-wait-all-for-submit-submitted-signaled)
[211.589896] Starting subtest: multi-wait-all-for-submit-submitted-signaled
[211.692544] Subtest multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.103s)
[211.785392] [050/133] (831s left) kms_flip (2x-plain-flip)
[212.268994] Starting subtest: 2x-plain-flip
[212.269840] Starting dynamic subtest: AB-VGA1-HDMI-A1
[214.652818] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (2.383s)
[214.656444] Subtest 2x-plain-flip: SUCCESS (2.387s)
[214.910993] [051/133] (828s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-downscaling)
[214.977403] Subtest flip-64bpp-xtile-to-16bpp-xtile-downscaling: SKIP (0.000s)
[215.038883] [052/133] (828s left) gem_ctx_shared (q-out-order)
[215.097440] Subtest Q-out-order: SKIP (0.000s)
[215.194768] [053/133] (828s left) kms_plane (pixel-format-y-tiled-ccs-modifier)
[215.670859] Starting subtest: pixel-format-y-tiled-ccs-modifier
[215.672850] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s)
[215.773173] [054/133] (828s left) sysfs_heartbeat_interval (precise)
[215.837410] Starting subtest: precise
[215.838402] Starting dynamic subtest: vcs0
[215.840083] Dynamic subtest vcs0: SKIP (0.000s)
[215.854015] Starting dynamic subtest: bcs0
[215.856330] Dynamic subtest bcs0: SKIP (0.000s)
[215.871212] Starting dynamic subtest: rcs0
[215.873579] Dynamic subtest rcs0: SKIP (0.000s)
[215.875764] Subtest precise: SKIP (0.003s)
[215.946433] [055/133] (828s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt)
[216.434681] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt
[218.447898] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SUCCESS (2.012s)
[218.582454] [056/133] (825s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping)
[219.068342] Starting subtest: pixel-format-y-tiled-modifier-source-clamping
[219.070065] Subtest pixel-format-y-tiled-modifier-source-clamping: SKIP (0.000s)
[219.166430] [057/133] (824s left) gem_mmap_wc (bad-object)
[219.228967] Starting subtest: bad-object
[219.233247] Subtest bad-object: SUCCESS (0.000s)
[219.337490] [058/133] (824s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[219.819753] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-wc
[219.821369] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[219.938414] [059/133] (824s left) kms_cursor_legacy (flip-vs-cursor-toggle)
[220.424755] Starting subtest: flip-vs-cursor-toggle
[234.850066] Subtest flip-vs-cursor-toggle: SUCCESS (14.426s)
[235.107939] [060/133] (809s left) kms_flip (2x-flip-vs-expired-vblank-interruptible)
[235.599773] Starting subtest: 2x-flip-vs-expired-vblank-interruptible
[235.602144] Starting dynamic subtest: AB-VGA1-HDMI-A1
[265.976530] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (30.374s)
[265.984211] Subtest 2x-flip-vs-expired-vblank-interruptible: SUCCESS (30.379s)
[266.254518] [061/133] (778s left) gem_exec_whisper (basic-queues-forked)
[266.336687] Starting subtest: basic-queues-forked
[266.339082] Subtest basic-queues-forked: SKIP (0.004s)
[266.549147] [062/133] (777s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[266.608683] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[266.609439] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[266.710544] [063/133] (777s left) api_intel_bb (reset-bb)
[266.768145] Starting subtest: reset-bb
[266.769098] Subtest reset-bb: SUCCESS (0.001s)
[266.898567] [064/133] (777s left) kms_rotation_crc (cursor-rotation-180)
[267.381390] Starting subtest: cursor-rotation-180
[268.804343] Subtest cursor-rotation-180: SUCCESS (1.422s)
[269.009847] [065/133] (775s left) gem_eio (throttle)
[269.081897] Starting subtest: throttle
[269.098975] Subtest throttle: SUCCESS (0.017s)
[269.621941] [066/133] (775s left) kms_psr (fbc-psr-sprite-plane-onoff)
[270.104761] Subtest fbc-psr-sprite-plane-onoff: SKIP (0.000s)
[270.172191] [067/133] (774s left) kms_atomic (plane-immutable-zpos)
[270.647037] Starting subtest: plane-immutable-zpos
[270.649403] Starting dynamic subtest: pipe-A-VGA-1
[271.017896] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.369s)
[271.018761] Subtest plane-immutable-zpos: SUCCESS (0.371s)
[271.300902] [068/133] (773s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[271.785722] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[271.787541] Starting dynamic subtest: AB-VGA1-HDMI-A1
[302.550680] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (30.761s)
[302.552023] Subtest 2x-flip-vs-absolute-wf_vblank: SUCCESS (30.765s)
[302.810750] [069/133] (741s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[303.292234] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[314.268049] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SUCCESS (10.976s)
[314.542656] [070/133] (730s left) gem_tiled_fence_blits (normal)
[314.736167] Starting subtest: normal
[315.040622] Subtest normal: SUCCESS (0.306s)
[315.145648] [071/133] (729s left) kms_psr (pr-dpms)
[315.754831] Subtest pr-dpms: SKIP (0.000s)
[315.817235] [072/133] (729s left) kms_cursor_crc (cursor-onscreen-64x64)
[316.321034] Starting subtest: cursor-onscreen-64x64
[316.337691] Starting dynamic subtest: pipe-A-VGA-1
[318.669035] Dynamic subtest pipe-A-VGA-1: SUCCESS (2.330s)
[318.710519] Starting dynamic subtest: pipe-B-HDMI-A-1
[320.923463] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.226s)
[320.924111] Subtest cursor-onscreen-64x64: SUCCESS (4.603s)
[321.196584] [073/133] (723s left) gem_exec_balancer (full)
[321.263719] Subtest full: SKIP (0.000s)
[321.365115] [074/133] (723s left) perf_pmu (pmu-read)
[321.423254] Starting subtest: pmu-read
[321.426969] Subtest pmu-read: SUCCESS (0.004s)
[321.528635] [075/133] (723s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[322.008800] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[322.012064] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.001s)
[322.126593] [076/133] (723s left) syncobj_basic (bad-fd-to-handle)
[322.195652] Starting subtest: bad-fd-to-handle
[322.196426] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[322.311024] [077/133] (722s left) kms_big_fb (y-tiled-8bpp-rotate-180)
[322.803103] Starting subtest: y-tiled-8bpp-rotate-180
[322.804698] Subtest y-tiled-8bpp-rotate-180: SKIP (0.000s)
[322.912220] [078/133] (722s left) gem_wait (busy)
[322.995060] Starting subtest: busy
[322.995906] Starting dynamic subtest: all-engines
[323.510827] Dynamic subtest all-engines: SUCCESS (0.516s)
[323.526777] Starting dynamic subtest: rcs0
[324.031899] Dynamic subtest rcs0: SUCCESS (0.519s)
[324.047819] Starting dynamic subtest: bcs0
[324.545832] Dynamic subtest bcs0: SUCCESS (0.511s)
[324.561805] Starting dynamic subtest: vcs0
[325.066834] Dynamic subtest vcs0: SUCCESS (0.519s)
[325.067916] Subtest busy: SUCCESS (2.074s)
[325.302229] [079/133] (720s left) gem_userptr_blits (unsync-unmap)
[325.363965] Subtest unsync-unmap: SKIP (0.000s)
[325.504828] [080/133] (719s left) api_intel_bb (blit-reloc-purge-cache)
[325.561374] Starting subtest: blit-reloc-purge-cache
[325.565273] Subtest blit-reloc-purge-cache: SUCCESS (0.005s)
[325.687011] [081/133] (719s left) kms_fbcon_fbt (psr)
[325.754935] Starting subtest: psr
[325.756400] Subtest psr: SKIP (0.000s)
[325.922503] [082/133] (719s left) gem_mmap_offset (bad-flags)
[325.979226] Starting subtest: bad-flags
[325.980039] Subtest bad-flags: SUCCESS (0.000s)
[326.088068] [083/133] (719s left) i915_drm_fdinfo (busy-idle-check-all)
[326.144411] Subtest busy-idle-check-all: SKIP (0.000s)
[326.200038] [084/133] (719s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-onoff)
[326.683200] Starting subtest: psr-2p-primscrn-cur-indfb-onoff
[326.684718] Subtest psr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[326.795505] [085/133] (718s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-render)
[327.281832] Starting subtest: fbcpsr-rgb565-draw-render
[327.283352] Subtest fbcpsr-rgb565-draw-render: SKIP (0.000s)
[327.399980] [086/133] (718s left) prime_mmap (test_correct_cpu_write)
[327.457260] Starting subtest: test_correct_cpu_write
[327.458043] Starting dynamic subtest: test_correct_cpu_write-smem
[327.458666] Dynamic subtest test_correct_cpu_write-smem: SUCCESS (0.000s)
[327.459479] Subtest test_correct_cpu_write: SUCCESS (0.001s)
[327.577810] [087/133] (718s left) kms_cursor_crc (cursor-sliding-256x85)
[328.069904] Starting subtest: cursor-sliding-256x85
[328.123551] Subtest cursor-sliding-256x85: SKIP (0.053s)
[328.233560] [088/133] (717s left) kms_color (deep-color)
[328.719148] Starting subtest: deep-color
[328.720709] Subtest deep-color: SKIP (0.000s)
[328.816169] [089/133] (717s left) kms_plane_scaling (planes-downscale-factor-0-5)
[329.290303] Starting subtest: planes-downscale-factor-0-5
[329.291142] Starting dynamic subtest: pipe-A
[329.294209] Dynamic subtest pipe-A: SKIP (0.002s)
[329.309921] Starting dynamic subtest: pipe-B
[329.314192] Dynamic subtest pipe-B: SKIP (0.001s)
[329.316126] Subtest planes-downscale-factor-0-5: SKIP (0.006s)
[329.401228] [090/133] (716s left) kms_force_connector_basic (force-connector-state)
[329.475272] Starting subtest: force-connector-state
[330.148318] Subtest force-connector-state: SUCCESS (0.668s)
[330.927224] [091/133] (715s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt)
[331.415686] Starting subtest: psr-rgb101010-draw-mmap-gtt
[331.418169] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[331.530368] [092/133] (714s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[332.012418] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[332.014049] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[332.134810] [093/133] (713s left) gem_render_copy (mixed-tiled-to-y-tiled-ccs)
[332.209519] Starting subtest: mixed-tiled-to-y-tiled-ccs
[332.210574] Starting dynamic subtest: smem
[332.212947] Dynamic subtest smem: SKIP (0.000s)
[332.214985] Subtest mixed-tiled-to-y-tiled-ccs: SKIP (0.001s)
[332.415188] [094/133] (713s left) kms_pm_backlight (fade-with-dpms)
[332.892021] Subtest fade-with-dpms: SKIP (0.000s)
[332.963154] [095/133] (713s left) kms_cursor_crc (cursor-random-256x85)
[333.454047] Starting subtest: cursor-random-256x85
[333.509281] Subtest cursor-random-256x85: SKIP (0.054s)
[333.627235] [096/133] (712s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-pwrite)
[334.113350] Starting subtest: psr-2p-primscrn-pri-indfb-draw-pwrite
[334.114912] Subtest psr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[334.238009] [097/133] (712s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0)
[334.725155] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0
[334.726988] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[334.844994] [098/133] (711s left) kms_tv_load_detect (load-detect)
[334.906477] Subtest load-detect: SKIP (0.000s)
[334.969973] [099/133] (711s left) kms_draw_crc (fill-fb)
[335.446654] Starting subtest: fill-fb
[335.791279] Subtest fill-fb: SUCCESS (0.345s)
[336.001863] [100/133] (710s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[336.494340] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[336.495752] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[336.615204] [101/133] (709s left) gem_spin_batch (resubmit)
[336.687177] Starting subtest: resubmit
[336.688107] Starting dynamic subtest: rcs0
[336.690128] Dynamic subtest rcs0: SUCCESS (0.002s)
[336.704228] Starting dynamic subtest: bcs0
[336.705109] Dynamic subtest bcs0: SUCCESS (0.001s)
[336.718444] Starting dynamic subtest: vcs0
[336.719325] Dynamic subtest vcs0: SUCCESS (0.001s)
[336.720061] Subtest resubmit: SUCCESS (0.008s)
[336.898006] [102/133] (709s left) gem_exec_fence (submit)
[337.075075] Subtest submit: SKIP (0.000s)
[337.446872] [103/133] (709s left) gem_exec_whisper (basic-normal-all)
[337.514034] Starting subtest: basic-normal-all
[338.534495] Subtest basic-normal-all: SUCCESS (1.018s)
[338.744258] [104/133] (707s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc)
[339.221153] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc
[340.625139] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (1.404s)
[340.863734] [105/133] (705s left) gem_fence_thrash (bo-write-verify-x)
[340.924478] Starting subtest: bo-write-verify-x
[342.071951] Subtest bo-write-verify-x: SUCCESS (1.148s)
[342.184171] [106/133] (704s left) gem_exec_schedule (preempt-queue-contexts)
[342.267264] Subtest preempt-queue-contexts: SKIP (0.000s)
[342.479708] [107/133] (704s left) kms_psr (psr2-cursor-mmap-gtt)
[342.953636] Subtest psr2-cursor-mmap-gtt: SKIP (0.000s)
[343.021855] [108/133] (703s left) dmabuf_sync_file (export-basic)
[343.095003] Starting subtest: export-basic
[343.095756] Subtest export-basic: SUCCESS (0.002s)
[343.184031] [109/133] (703s left) kms_async_flips (crc)
[343.659470] Starting subtest: crc
[343.906035] Starting dynamic subtest: pipe-A-VGA-1
[346.096036] Dynamic subtest pipe-A-VGA-1: SUCCESS (2.189s)
[346.220339] Starting dynamic subtest: pipe-A-HDMI-A-1
[348.451668] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.245s)
[348.619174] Starting dynamic subtest: pipe-B-VGA-1
[350.803153] Dynamic subtest pipe-B-VGA-1: SUCCESS (2.199s)
[350.926848] Starting dynamic subtest: pipe-B-HDMI-A-1
[353.157326] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.247s)
[353.158742] Subtest crc: SUCCESS (9.500s)
[353.573749] [110/133] (693s left) syncobj_timeline (etime-single-wait-all-available-unsubmitted)
[353.642370] Starting subtest: etime-single-wait-all-available-unsubmitted
[353.748479] Subtest etime-single-wait-all-available-unsubmitted: SUCCESS (0.106s)
[353.858941] [111/133] (693s left) gen9_exec_parse (batch-invalid-length)
[353.919099] Subtest batch-invalid-length: SKIP (0.000s)
[353.983852] [112/133] (693s left) kms_vrr (seamless-rr-switch-virtual)
[354.456316] Starting subtest: seamless-rr-switch-virtual
[354.460125] Subtest seamless-rr-switch-virtual: SKIP (0.000s)
[354.555146] [113/133] (692s left) gem_mmap_gtt (cpuset-basic-small-copy)
[354.619195] Starting subtest: cpuset-basic-small-copy
[355.436827] Subtest cpuset-basic-small-copy: SUCCESS (0.819s)
[355.553933] [114/133] (691s left) kms_ccs (bad-rotation-90-4-tiled-mtl-mc-ccs)
[355.726230] Subtest bad-rotation-90-4-tiled-mtl-mc-ccs: SKIP (0.000s)
[355.795028] [115/133] (691s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[356.293840] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[356.295225] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.001s)
[356.415130] [116/133] (690s left) gem_exec_gttfill (engines)
[356.492737] Starting subtest: engines
[356.493555] Starting dynamic subtest: rcs0
[380.458467] Dynamic subtest rcs0: SUCCESS (23.964s)
[380.478465] Starting dynamic subtest: bcs0
[404.900481] Dynamic subtest bcs0: SUCCESS (24.440s)
[404.902466] Subtest engines: SUCCESS (48.408s)
[405.107391] [117/133] (642s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[405.700447] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu
[405.704419] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[405.808179] [118/133] (641s left) gem_exec_reloc (basic-softpin)
[405.878535] Starting subtest: basic-softpin
[405.879172] Subtest basic-softpin: SUCCESS (0.001s)
[406.431876] [119/133] (641s left) kms_ccs (bad-rotation-90-y-tiled-ccs)
[406.496515] Subtest bad-rotation-90-y-tiled-ccs: SKIP (0.000s)
[406.576203] [120/133] (640s left) kms_flip (wf_vblank-ts-check-interruptible)
[407.058868] Starting subtest: wf_vblank-ts-check-interruptible
[407.061864] Starting dynamic subtest: A-VGA1
[415.196104] Dynamic subtest A-VGA1: SUCCESS (8.135s)
[415.215771] Starting dynamic subtest: B-VGA1
[423.186150] Dynamic subtest B-VGA1: SUCCESS (7.987s)
[423.203873] Starting dynamic subtest: A-HDMI-A1
[431.345442] Dynamic subtest A-HDMI-A1: SUCCESS (8.153s)
[431.364690] Starting dynamic subtest: B-HDMI-A1
[439.529858] Dynamic subtest B-HDMI-A1: SUCCESS (8.183s)
[439.534039] Subtest wf_vblank-ts-check-interruptible: SUCCESS (32.473s)
[439.721954] [121/133] (607s left) kms_chamelium_color (ctm-0-25)
[440.200312] Subtest ctm-0-25: SKIP (0.000s)
[440.266236] [122/133] (607s left) kms_psr2_sf (pr-cursor-plane-update-sf)
[440.747808] Subtest pr-cursor-plane-update-sf: SKIP (0.000s)
[440.822611] [123/133] (606s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-gtt)
[441.299079] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-gtt
[443.078103] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-gtt: SUCCESS (1.779s)
[443.317943] [124/133] (604s left) gem_mmap_gtt (basic-small-bo-tiledx)
[443.384512] Starting subtest: basic-small-bo-tiledX
[443.588160] Subtest basic-small-bo-tiledX: SUCCESS (0.203s)
[443.733208] [125/133] (604s left) kms_content_protection (dp-mst-type-0-hdcp14)
[444.377519] Starting subtest: dp-mst-type-0-hdcp14
[444.379199] Subtest dp-mst-type-0-hdcp14: SKIP (0.000s)
[444.487726] [126/133] (603s left) i915_pm_rc6_residency (rc6-fence)
[444.553051] Starting subtest: rc6-fence
[444.559469] Starting dynamic subtest: gt0
[456.794939] Dynamic subtest gt0: SUCCESS (12.238s)
[456.798269] Subtest rc6-fence: SUCCESS (12.245s)
[456.892170] [127/133] (591s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-onoff)
[457.383832] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-onoff
[457.385669] Subtest fbcpsr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[457.489504] [128/133] (590s left) prime_mmap (test_aperture_limit)
[457.549336] Starting subtest: test_aperture_limit
[457.550082] Starting dynamic subtest: test_aperture_limit-smem
[457.561560] Dynamic subtest test_aperture_limit-smem: SUCCESS (0.012s)
[457.562345] Subtest test_aperture_limit: SUCCESS (0.013s)
[457.674794] [129/133] (590s left) gem_exec_reloc (basic-range)
[457.736027] Starting subtest: basic-range
[457.748764] Subtest basic-range: SUCCESS (0.013s)
[458.293962] [130/133] (589s left) kms_pipe_stress (stress-xrgb8888-4tiled)
[458.774132] Starting subtest: stress-xrgb8888-4tiled
[458.775805] Subtest stress-xrgb8888-4tiled: SKIP (0.000s)
[458.841539] [131/133] (589s left) gem_exec_flush (basic-wb-prw-default)
[458.908426] Starting subtest: basic-wb-prw-default
[464.363062] Subtest basic-wb-prw-default: SUCCESS (5.455s)
[464.561129] [132/133] (583s left) kms_chamelium_frames (dp-crc-fast)
[465.143625] Subtest dp-crc-fast: SKIP (0.000s)
[465.362965] [133/133] (582s left) kms_psr (fbc-pr-sprite-mmap-gtt)
[465.844635] Subtest fbc-pr-sprite-mmap-gtt: SKIP (0.000s)
[465.925027] Closing watchdogs
results: parsing output: 0/ for test: i915_suspend
results: parsing output: 1/ for test: syncobj_timeline
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_dp_link_training
results: parsing output: 4/ for test: syncobj_timeline
results: parsing output: 5/ for test: gem_partial_pwrite_pread
results: parsing output: 6/ for test: kms_psr_stress_test
results: parsing output: 7/ for test: gem_mmap
results: parsing output: 8/ for test: gem_exec_schedule
results: parsing output: 9/ for test: vgem_basic
results: parsing output: 10/ for test: gem_softpin
results: parsing output: 11/ for test: kms_ccs
results: parsing output: 12/ for test: syncobj_wait
results: parsing output: 13/ for test: syncobj_timeline
results: parsing output: 14/ for test: gem_ctx_engines
results: parsing output: 15/ for test: kms_plane_multiple
results: parsing output: 16/ for test: syncobj_wait
results: parsing output: 17/ for test: gem_ctx_persistence
results: parsing output: 18/ for test: kms_ccs
results: parsing output: 19/ for test: syncobj_wait
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: kms_lease
results: parsing output: 22/ for test: i915_pm_freq_api
results: parsing output: 23/ for test: kms_atomic_transition
results: parsing output: 24/ for test: kms_flip
results: parsing output: 25/ for test: kms_big_fb
results: parsing output: 26/ for test: kms_tiled_display
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: kms_chamelium_hpd
results: parsing output: 29/ for test: gem_exec_balancer
results: parsing output: 30/ for test: gem_exec_reloc
results: parsing output: 31/ for test: gem_ctx_persistence
results: parsing output: 32/ for test: prime_vgem
results: parsing output: 33/ for test: syncobj_timeline
results: parsing output: 34/ for test: gem_ccs
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_cursor_legacy
results: parsing output: 39/ for test: kms_vblank
results: parsing output: 40/ for test: kms_joiner
results: parsing output: 41/ for test: kms_pm_rpm
results: parsing output: 42/ for test: gem_linear_blits
results: parsing output: 43/ for test: gem_eio
results: parsing output: 44/ for test: kms_cursor_legacy
results: parsing output: 45/ for test: kms_prop_blob
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: gem_ringfill
results: parsing output: 48/ for test: syncobj_wait
results: parsing output: 49/ for test: kms_flip
results: parsing output: 50/ for test: kms_flip_scaled_crc
results: parsing output: 51/ for test: gem_ctx_shared
results: parsing output: 52/ for test: kms_plane
results: parsing output: 53/ for test: sysfs_heartbeat_interval
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_plane
results: parsing output: 56/ for test: gem_mmap_wc
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_cursor_legacy
results: parsing output: 59/ for test: kms_flip
results: parsing output: 60/ for test: gem_exec_whisper
results: parsing output: 61/ for test: syncobj_wait
results: parsing output: 62/ for test: api_intel_bb
results: parsing output: 63/ for test: kms_rotation_crc
results: parsing output: 64/ for test: gem_eio
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_atomic
results: parsing output: 67/ for test: kms_flip
results: parsing output: 68/ for test: kms_cursor_legacy
results: parsing output: 69/ for test: gem_tiled_fence_blits
results: parsing output: 70/ for test: kms_psr
results: parsing output: 71/ for test: kms_cursor_crc
results: parsing output: 72/ for test: gem_exec_balancer
results: parsing output: 73/ for test: perf_pmu
results: parsing output: 74/ for test: kms_big_fb
results: parsing output: 75/ for test: syncobj_basic
results: parsing output: 76/ for test: kms_big_fb
results: parsing output: 77/ for test: gem_wait
results: parsing output: 78/ for test: gem_userptr_blits
results: parsing output: 79/ for test: api_intel_bb
results: parsing output: 80/ for test: kms_fbcon_fbt
results: parsing output: 81/ for test: gem_mmap_offset
results: parsing output: 82/ for test: i915_drm_fdinfo
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: prime_mmap
results: parsing output: 86/ for test: kms_cursor_crc
results: parsing output: 87/ for test: kms_color
results: parsing output: 88/ for test: kms_plane_scaling
results: parsing output: 89/ for test: kms_force_connector_basic
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: kms_big_fb
results: parsing output: 92/ for test: gem_render_copy
results: parsing output: 93/ for test: kms_pm_backlight
results: parsing output: 94/ for test: kms_cursor_crc
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: kms_tv_load_detect
results: parsing output: 98/ for test: kms_draw_crc
results: parsing output: 99/ for test: kms_big_fb
results: parsing output: 100/ for test: gem_spin_batch
results: parsing output: 101/ for test: gem_exec_fence
results: parsing output: 102/ for test: gem_exec_whisper
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: gem_fence_thrash
results: parsing output: 105/ for test: gem_exec_schedule
results: parsing output: 106/ for test: kms_psr
results: parsing output: 107/ for test: dmabuf_sync_file
results: parsing output: 108/ for test: kms_async_flips
results: parsing output: 109/ for test: syncobj_timeline
results: parsing output: 110/ for test: gen9_exec_parse
results: parsing output: 111/ for test: kms_vrr
results: parsing output: 112/ for test: gem_mmap_gtt
results: parsing output: 113/ for test: kms_ccs
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: gem_exec_gttfill
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: gem_exec_reloc
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: kms_flip
results: parsing output: 120/ for test: kms_chamelium_color
results: parsing output: 121/ for test: kms_psr2_sf
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_mmap_gtt
results: parsing output: 124/ for test: kms_content_protection
results: parsing output: 125/ for test: i915_pm_rc6_residency
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: prime_mmap
results: parsing output: 128/ for test: gem_exec_reloc
results: parsing output: 129/ for test: kms_pipe_stress
results: parsing output: 130/ for test: gem_exec_flush
results: parsing output: 131/ for test: kms_chamelium_frames
results: parsing output: 132/ for test: kms_psr
Done.