[77.609682] Initializing watchdogs
[77.609855]   /dev/watchdog0
[77.633526] [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)
[77.641723] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[77.645477] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[77.648598] [001/132] (960s left) gem_sync (basic-all)
[77.768208] Starting subtest: basic-all
[79.808325] Subtest basic-all: SUCCESS (2.042s)
[80.009300] [002/132] (958s left) gem_mmap_gtt (zero-extend)
[80.063549] Starting subtest: zero-extend
[80.064245] Subtest zero-extend: SUCCESS (0.000s)
[80.167269] [003/132] (958s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-msflip-blt)
[80.658047] Starting subtest: fbc-2p-primscrn-indfb-msflip-blt
[82.615686] Subtest fbc-2p-primscrn-indfb-msflip-blt: SUCCESS (1.956s)
[82.758902] [004/132] (955s left) prime_self_import (basic-with_two_bos)
[82.818462] Starting subtest: basic-with_two_bos
[82.821307] Subtest basic-with_two_bos: SUCCESS (0.004s)
[82.922119] [005/132] (955s left) gem_readwrite (read-bad-handle)
[82.981277] Starting subtest: read-bad-handle
[82.982819] Subtest read-bad-handle: SUCCESS (0.000s)
[83.076133] [006/132] (955s left) gem_exec_parallel (fds)
[83.143187] Starting subtest: fds
[83.144087] Starting dynamic subtest: rcs0
[84.917355] Dynamic subtest rcs0: SUCCESS (1.773s)
[84.927652] Starting dynamic subtest: bcs0
[86.550539] Dynamic subtest bcs0: SUCCESS (1.633s)
[86.551884] Subtest fds: SUCCESS (3.408s)
[86.762264] [007/132] (951s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt)
[87.257845] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt
[87.260334] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[87.365324] [008/132] (951s left) gem_exec_schedule (u-fairslice)
[87.434653] Subtest u-fairslice: SKIP (0.000s)
[87.637564] [009/132] (950s left) kms_plane_multiple (2x-tiling-yf)
[88.128590] Starting subtest: 2x-tiling-yf
[88.130809] Subtest 2x-tiling-yf: SKIP (0.000s)
[88.214780] [010/132] (950s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc)
[88.711891] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc
[88.713475] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[88.811299] [011/132] (949s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-blt)
[89.294762] Starting subtest: psr-2p-primscrn-spr-indfb-draw-blt
[89.296329] Subtest psr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[89.408838] [012/132] (949s left) gem_lmem_swapping (basic)
[89.474387] Subtest basic: SKIP (0.000s)
[89.523461] [013/132] (949s left) gem_mmap_wc (bad-size)
[89.583094] Starting subtest: bad-size
[89.583707] Subtest bad-size: SUCCESS (0.001s)
[89.693847] [014/132] (949s left) kms_psr (pr-sprite-plane-onoff)
[90.171884] Subtest pr-sprite-plane-onoff: SKIP (0.000s)
[90.255251] [015/132] (948s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[90.749853] Starting subtest: 4-tiled-16bpp-rotate-0
[90.751310] Subtest 4-tiled-16bpp-rotate-0: SKIP (0.000s)
[90.849046] [016/132] (948s left) syncobj_timeline (etime-single-wait-submitted)
[90.905712] Starting subtest: etime-single-wait-submitted
[91.012031] Subtest etime-single-wait-submitted: SUCCESS (0.105s)
[91.100842] [017/132] (947s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[91.592594] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[91.594616] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[91.703253] [018/132] (947s left) kms_plane (plane-position-hole-dpms)
[92.188281] Starting subtest: plane-position-hole-dpms
[92.531810] Starting dynamic subtest: pipe-A-plane-1
[92.992844] Dynamic subtest pipe-A-plane-1: SUCCESS (0.461s)
[93.002760] Starting dynamic subtest: pipe-A-plane-2
[93.004181] Dynamic subtest pipe-A-plane-2: SUCCESS (0.004s)
[93.282930] Starting dynamic subtest: pipe-B-plane-1
[93.853855] Dynamic subtest pipe-B-plane-1: SUCCESS (0.580s)
[93.863418] Starting dynamic subtest: pipe-B-plane-2
[93.866357] Dynamic subtest pipe-B-plane-2: SUCCESS (0.010s)
[93.867018] Subtest plane-position-hole-dpms: SUCCESS (1.678s)
[94.133577] [019/132] (944s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted)
[94.198811] Starting subtest: multi-wait-for-submit-unsubmitted-submitted
[94.307424] Subtest multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.107s)
[94.401172] [020/132] (944s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-pgflip-blt)
[94.893512] Starting subtest: fbc-2p-primscrn-indfb-pgflip-blt
[96.897921] Subtest fbc-2p-primscrn-indfb-pgflip-blt: SUCCESS (2.003s)
[97.037506] [021/132] (942s left) gem_mmap_wc (set-cache-level)
[97.099009] Starting subtest: set-cache-level
[97.099635] Subtest set-cache-level: SUCCESS (0.001s)
[97.208327] [022/132] (941s left) kms_vblank (query-busy-hang)
[97.685080] Starting subtest: query-busy-hang
[97.686036] Starting dynamic subtest: pipe-A-VGA-1
[103.904374] Dynamic subtest pipe-A-VGA-1: SUCCESS (6.217s)
[103.914421] Starting dynamic subtest: pipe-A-HDMI-A-1
[109.953656] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.049s)
[109.969514] Starting dynamic subtest: pipe-B-VGA-1
[115.934207] Dynamic subtest pipe-B-VGA-1: SUCCESS (5.978s)
[115.946122] Starting dynamic subtest: pipe-B-HDMI-A-1
[121.918253] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (5.983s)
[121.918920] Subtest query-busy-hang: SUCCESS (24.234s)
[122.187704] [023/132] (916s left) gem_partial_pwrite_pread (write-display)
[122.266566] Starting subtest: write-display
[126.132021] Subtest write-display: SUCCESS (3.866s)
[126.242253] [024/132] (912s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc)
[126.737252] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc
[128.160826] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (1.423s)
[128.389224] [025/132] (910s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping)
[128.879548] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping
[128.881526] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[128.973833] [026/132] (910s left) gem_ccs (block-multicopy-compressed)
[129.033782] Subtest block-multicopy-compressed: SKIP (0.000s)
[129.082458] [027/132] (910s left) kms_flip (wf_vblank-ts-check-interruptible)
[129.570486] Starting subtest: wf_vblank-ts-check-interruptible
[129.572129] Starting dynamic subtest: A-VGA1
[137.695136] Dynamic subtest A-VGA1: SUCCESS (8.123s)
[137.706365] Starting dynamic subtest: B-VGA1
[145.685281] Dynamic subtest B-VGA1: SUCCESS (7.989s)
[145.696509] Starting dynamic subtest: A-HDMI-A1
[153.824582] Dynamic subtest A-HDMI-A1: SUCCESS (8.138s)
[153.836328] Starting dynamic subtest: B-HDMI-A1
[162.012784] Dynamic subtest B-HDMI-A1: SUCCESS (8.184s)
[162.018301] Subtest wf_vblank-ts-check-interruptible: SUCCESS (32.442s)
[162.186918] [028/132] (877s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[162.674536] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[162.675329] Starting dynamic subtest: pipe-A
[162.678137] Dynamic subtest pipe-A: SKIP (0.002s)
[162.689977] Starting dynamic subtest: pipe-B
[162.694107] Dynamic subtest pipe-B: SKIP (0.001s)
[162.696236] Subtest plane-upscale-factor-0-25-with-modifiers: SKIP (0.004s)
[162.775811] [029/132] (876s left) kms_flip (2x-busy-flip)
[163.262165] Starting subtest: 2x-busy-flip
[163.262905] Starting dynamic subtest: AB-VGA1-HDMI-A1
[164.638335] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (1.375s)
[164.641118] Subtest 2x-busy-flip: SUCCESS (1.378s)
[164.899560] [030/132] (874s left) kms_ccs (bad-rotation-90-4-tiled-dg2-mc-ccs)
[164.959569] Subtest bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.000s)
[165.009094] [031/132] (874s left) kms_chamelium_frames (dp-crc-fast)
[165.589130] Subtest dp-crc-fast: SKIP (0.000s)
[165.794837] [032/132] (873s left) kms_big_fb (linear-8bpp-rotate-270)
[166.292221] Starting subtest: linear-8bpp-rotate-270
[166.385869] Subtest linear-8bpp-rotate-270: SKIP (0.094s)
[166.602469] [033/132] (873s left) gem_madvise (dontneed-before-pwrite)
[166.657248] Starting subtest: dontneed-before-pwrite
[166.661226] Subtest dontneed-before-pwrite: SUCCESS (0.004s)
[166.764804] [034/132] (872s left) kms_rotation_crc (primary-4-tiled-reflect-x-0)
[167.246581] Starting subtest: primary-4-tiled-reflect-x-0
[167.248452] Subtest primary-4-tiled-reflect-x-0: SKIP (0.001s)
[167.332449] [035/132] (872s left) kms_flip (absolute-wf_vblank)
[167.818791] Starting subtest: absolute-wf_vblank
[167.819500] Starting dynamic subtest: A-VGA1
[175.620348] Dynamic subtest A-VGA1: SUCCESS (7.801s)
[175.631946] Starting dynamic subtest: B-VGA1
[183.345360] Dynamic subtest B-VGA1: SUCCESS (7.723s)
[183.359834] Starting dynamic subtest: A-HDMI-A1
[191.239111] Dynamic subtest A-HDMI-A1: SUCCESS (7.891s)
[191.250855] Starting dynamic subtest: B-HDMI-A1
[199.159319] Dynamic subtest B-HDMI-A1: SUCCESS (7.918s)
[199.161895] Subtest absolute-wf_vblank: SUCCESS (31.343s)
[199.352267] [036/132] (840s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-downscaling)
[199.412158] Subtest flip-64bpp-4tile-to-32bpp-4tile-downscaling: SKIP (0.000s)
[199.464356] [037/132] (840s left) kms_async_flips (async-flip-with-page-flip-events-linear)
[199.945858] Starting subtest: async-flip-with-page-flip-events-linear
[200.191340] Subtest async-flip-with-page-flip-events-linear: SKIP (0.246s)
[200.437584] [038/132] (839s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[200.929322] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[202.776862] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (1.846s)
[202.907449] [039/132] (836s left) kms_psr2_sf (fbc-pr-cursor-plane-update-sf)
[203.399914] Subtest fbc-pr-cursor-plane-update-sf: SKIP (0.000s)
[203.447280] [040/132] (836s left) gem_softpin (full)
[203.506891] Subtest full: SKIP (0.000s)
[203.592190] [041/132] (836s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs)
[203.650719] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[203.699378] [042/132] (836s left) kms_cursor_crc (cursor-offscreen-128x42)
[204.189201] Starting subtest: cursor-offscreen-128x42
[204.265063] Subtest cursor-offscreen-128x42: SKIP (0.069s)
[204.377967] [043/132] (835s left) kms_color_pipeline (plane-ctm3x4)
[204.865883] Starting subtest: plane-ctm3x4
[205.504904] Subtest plane-ctm3x4: SKIP (0.639s)
[205.742103] [044/132] (834s left) gem_mmap (bad-size)
[205.799832] Starting subtest: bad-size
[205.801839] Subtest bad-size: SUCCESS (0.002s)
[205.912270] [045/132] (834s left) prime_vgem (basic-fence-mmap)
[206.050793] Starting subtest: basic-fence-mmap
[206.082255] Subtest basic-fence-mmap: SUCCESS (0.031s)
[206.192847] [FACT prime_vgem (basic-fence-mmap)] new: kernel.kmod_is_loaded.vgem: true
[206.196195] [046/132] (834s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[206.679099] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[208.704196] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (2.023s)
[208.851285] [047/132] (831s left) kms_frontbuffer_tracking (psr-suspend)
[209.350762] Starting subtest: psr-suspend
[209.352253] Subtest psr-suspend: SKIP (0.000s)
[209.452083] [048/132] (830s left) gem_exec_params (cliprects-invalid)
[209.513154] Starting subtest: cliprects-invalid
[209.513978] Subtest cliprects-invalid: SUCCESS (0.000s)
[209.618101] [049/132] (830s left) kms_pipe_stress (stress-xrgb8888-xtiled)
[210.092185] Starting subtest: stress-xrgb8888-xtiled
[220.874395] Subtest stress-xrgb8888-xtiled: SUCCESS (10.782s)
[221.158587] [050/132] (819s left) prime_self_import (reimport-vs-gem_close-race)
[221.220087] Starting subtest: reimport-vs-gem_close-race
[226.250108] Subtest reimport-vs-gem_close-race: SUCCESS (5.030s)
[226.337039] [051/132] (814s left) gem_mmap_gtt (hang)
[226.393222] Starting subtest: hang
[231.867347] Subtest hang: SUCCESS (5.469s)
[232.004667] [052/132] (808s left) gem_ctx_param (invalid-ctx-get)
[232.072748] Starting subtest: invalid-ctx-get
[232.073711] Subtest invalid-ctx-get: SUCCESS (0.000s)
[232.175567] [053/132] (808s left) syncobj_timeline (single-wait-signaled)
[232.232227] Starting subtest: single-wait-signaled
[232.232999] Subtest single-wait-signaled: SUCCESS (0.001s)
[232.320707] [054/132] (808s left) gem_exec_balancer (parallel)
[232.382360] Subtest parallel: SKIP (0.000s)
[232.473897] [055/132] (808s left) kms_psr (fbc-psr-cursor-plane-move)
[232.945265] Subtest fbc-psr-cursor-plane-move: SKIP (0.000s)
[233.001329] [056/132] (807s left) gem_ctx_engines (execute-one)
[233.068470] Starting subtest: execute-one
[233.447809] Subtest execute-one: SUCCESS (0.380s)
[233.651905] [057/132] (807s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0)
[234.130623] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0
[234.131938] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[234.244742] [058/132] (806s left) syncobj_eventfd (timeline-wait)
[234.307752] Starting subtest: timeline-wait
[234.318312] Subtest timeline-wait: SUCCESS (0.011s)
[234.419671] [059/132] (806s left) gem_exec_fence (submit-chain)
[234.593294] Subtest submit-chain: SKIP (0.000s)
[234.983494] [060/132] (805s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy)
[235.058590] Starting subtest: map-fixed-invalidate-overlap-busy
[235.059459] Starting dynamic subtest: gtt
[236.178579] Dynamic subtest gtt: SUCCESS (1.119s)
[236.190469] Starting dynamic subtest: wb
[237.241724] Dynamic subtest wb: SUCCESS (1.062s)
[237.254032] Starting dynamic subtest: wc
[238.366834] Dynamic subtest wc: SUCCESS (1.123s)
[238.378091] Starting dynamic subtest: uc
[239.439938] Dynamic subtest uc: SUCCESS (1.072s)
[239.440877] Subtest map-fixed-invalidate-overlap-busy: SUCCESS (4.382s)
[239.575024] [061/132] (801s left) kms_fbcon_fbt (psr-suspend)
[239.631546] Starting subtest: psr-suspend
[239.633127] Subtest psr-suspend: SKIP (0.000s)
[239.790289] [062/132] (801s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled)
[239.845614] Starting subtest: multi-wait-for-submit-unsubmitted-signaled
[239.846485] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.001s)
[239.941400] [063/132] (801s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[240.413652] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[240.415699] Subtest psr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[240.545054] [064/132] (800s left) kms_chamelium_color (ctm-blue-to-red)
[241.012117] Subtest ctm-blue-to-red: SKIP (0.000s)
[241.074357] [065/132] (800s left) core_setmaster (master-drop-set-user)
[241.200965] Starting subtest: master-drop-set-user
[241.230866] Subtest master-drop-set-user: SUCCESS (0.030s)
[241.279427] [066/132] (799s left) syncobj_wait (wait-all-complex)
[241.339241] Starting subtest: wait-all-complex
[241.553317] Subtest wait-all-complex: SUCCESS (0.214s)
[241.656329] [067/132] (799s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted-signaled)
[241.711816] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[241.712648] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[241.802213] [068/132] (799s left) gem_exec_parallel (userptr)
[241.885059] Starting subtest: userptr
[241.885679] Starting dynamic subtest: rcs0
[245.805702] Dynamic subtest rcs0: SUCCESS (3.921s)
[245.818054] Starting dynamic subtest: bcs0
[247.431489] Dynamic subtest bcs0: SUCCESS (1.624s)
[247.432215] Subtest userptr: SUCCESS (5.548s)
[247.632234] [069/132] (793s left) kms_pm_rpm (pm-tiling)
[259.372732] Subtest pm-tiling: SKIP (0.000s)
[259.432604] [070/132] (781s left) kms_psr2_sf (fbc-psr2-plane-move-sf-dmg-area)
[259.912847] Subtest fbc-psr2-plane-move-sf-dmg-area: SKIP (0.000s)
[259.978863] [071/132] (781s left) kms_psr (psr2-cursor-mmap-gtt)
[260.458581] Subtest psr2-cursor-mmap-gtt: SKIP (0.000s)
[260.519525] [072/132] (781s left) i915_pm_rps (waitboost)
[260.582619] Starting subtest: waitboost
[264.116112] Subtest waitboost: SUCCESS (3.533s)
[264.244590] [073/132] (777s left) gem_ctx_persistence (hang)
[264.311250] Subtest hang: SKIP (0.000s)
[264.374435] [074/132] (777s left) kms_psr (fbc-psr2-sprite-blt)
[264.850441] Subtest fbc-psr2-sprite-blt: SKIP (0.000s)
[264.914185] [075/132] (776s left) kms_lease (empty-lease)
[265.392495] Starting subtest: empty-lease
[265.393298] Starting dynamic subtest: pipe-A-VGA-1
[265.394161] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.001s)
[265.406772] Starting dynamic subtest: pipe-A-HDMI-A-1
[265.407671] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.000s)
[265.418278] Starting dynamic subtest: pipe-B-VGA-1
[265.418989] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.000s)
[265.430067] Starting dynamic subtest: pipe-B-HDMI-A-1
[265.431065] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.000s)
[265.432184] Subtest empty-lease: SUCCESS (0.010s)
[265.490526] [076/132] (776s left) syncobj_wait (wait-all-for-submit-complex)
[265.556691] Starting subtest: wait-all-for-submit-complex
[265.773629] Subtest wait-all-for-submit-complex: SUCCESS (0.216s)
[265.876872] [077/132] (775s left) api_intel_bb (reset-bb)
[265.933919] Starting subtest: reset-bb
[265.935958] Subtest reset-bb: SUCCESS (0.001s)
[266.055732] [078/132] (775s left) kms_chamelium_hpd (hdmi-hpd-storm)
[266.642212] Subtest hdmi-hpd-storm: SKIP (0.000s)
[266.854612] [079/132] (775s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite)
[267.337677] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite
[267.338928] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[267.453364] [080/132] (774s left) gem_exec_schedule (u-submit-late-slice)
[267.525681] Subtest u-submit-late-slice: SKIP (0.000s)
[267.719437] [081/132] (774s left) kms_invalid_mode (int-max-clock)
[268.190730] Starting subtest: int-max-clock
[268.193408] Starting dynamic subtest: pipe-A-VGA-1
[268.304289] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.112s)
[268.317753] Starting dynamic subtest: pipe-A-HDMI-A-1
[268.318933] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.001s)
[268.334391] Starting dynamic subtest: pipe-B-VGA-1
[268.335250] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.000s)
[268.349313] Starting dynamic subtest: pipe-B-HDMI-A-1
[268.350166] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.000s)
[268.351016] Subtest int-max-clock: SUCCESS (0.121s)
[268.599512] [082/132] (773s left) sriov_basic (enable-vfs-bind-unbind-each-numvfs-all)
[268.660086] Subtest enable-vfs-bind-unbind-each-numvfs-all: SKIP (0.000s)
[268.726415] [083/132] (773s left) gem_exec_suspend (basic-s3)
[268.792700] Starting subtest: basic-S3
[268.793509] Starting dynamic subtest: smem
[286.363039] Dynamic subtest smem: SUCCESS (1.565s)
[286.364654] Subtest basic-S3: SUCCESS (1.567s)
[292.580933] [084/132] (755s left) gem_pxp (verify-pxp-key-change-after-suspend-resume)
[295.192225] Starting subtest: verify-pxp-key-change-after-suspend-resume
[295.193694] Subtest verify-pxp-key-change-after-suspend-resume: SKIP (0.000s)
[295.296617] [085/132] (752s left) gem_exec_schedule (pi-common)
[295.374336] Subtest pi-common: SKIP (0.000s)
[295.580891] [086/132] (752s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-blt)
[296.061385] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-blt
[296.062728] Subtest psr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[296.175657] [087/132] (752s left) gem_exec_balancer (parallel-contexts)
[296.237743] Subtest parallel-contexts: SKIP (0.000s)
[296.339098] [088/132] (752s left) i915_hangman (gt-engine-error)
[296.404776] Starting subtest: gt-engine-error
[296.406332] Subtest gt-engine-error: SKIP (0.000s)
[296.487539] [089/132] (751s left) kms_cursor_crc (cursor-random-512x512)
[296.979455] Starting subtest: cursor-random-512x512
[296.980853] Subtest cursor-random-512x512: SKIP (0.001s)
[297.092707] [090/132] (751s left) kms_dither (fb-8bpc-vs-panel-6bpc)
[297.570365] Starting subtest: fb-8bpc-vs-panel-6bpc
[297.572073] Starting dynamic subtest: pipe-A-HDMI-A-1
[297.677998] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.105s)
[297.679462] Subtest fb-8bpc-vs-panel-6bpc: SKIP (0.108s)
[297.939743] [091/132] (750s left) perf_pmu (busy-start)
[298.003952] Starting subtest: busy-start
[298.004821] Starting dynamic subtest: rcs0
[300.521039] Dynamic subtest rcs0: SUCCESS (2.508s)
[300.538468] Starting dynamic subtest: bcs0
[303.036988] Dynamic subtest bcs0: SUCCESS (2.505s)
[303.054632] Starting dynamic subtest: vcs0
[306.058017] Dynamic subtest vcs0: SUCCESS (3.011s)
[306.062093] Subtest busy-start: SUCCESS (8.035s)
[306.166861] [092/132] (742s left) gem_fence_thrash (bo-write-verify-threaded-x)
[306.229701] Starting subtest: bo-write-verify-threaded-x
[308.022439] Subtest bo-write-verify-threaded-x: SUCCESS (1.791s)
[308.146007] [093/132] (740s left) kms_frontbuffer_tracking (fbcpsr-2p-shrfb-fliptrack-mmap-gtt)
[308.627767] Starting subtest: fbcpsr-2p-shrfb-fliptrack-mmap-gtt
[308.629116] Subtest fbcpsr-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[308.752423] [094/132] (739s left) kms_flip (2x-plain-flip-interruptible)
[309.241364] Starting subtest: 2x-plain-flip-interruptible
[309.244080] Starting dynamic subtest: AB-VGA1-HDMI-A1
[311.627843] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (2.381s)
[311.637190] Subtest 2x-plain-flip-interruptible: SUCCESS (2.386s)
[311.888974] [095/132] (736s left) gem_exec_reloc (basic-cpu-wc-active)
[311.954741] Starting subtest: basic-cpu-wc-active
[312.065443] Subtest basic-cpu-wc-active: SUCCESS (0.110s)
[312.587920] [096/132] (736s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc)
[312.646720] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.000s)
[312.721878] [097/132] (736s left) kms_vrr (lobf)
[313.202325] Starting subtest: lobf
[313.204218] Subtest lobf: SKIP (0.000s)
[313.303618] [098/132] (735s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[313.796295] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[313.797606] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[313.907095] [099/132] (735s left) kms_busy (extended-modeset-hang-oldfb)
[314.391341] Starting subtest: extended-modeset-hang-oldfb
[314.392182] Starting dynamic subtest: pipe-A
[321.095106] Dynamic subtest pipe-A: SUCCESS (6.696s)
[321.114689] Starting dynamic subtest: pipe-B
[327.159083] Dynamic subtest pipe-B: SUCCESS (6.058s)
[327.162949] Subtest extended-modeset-hang-oldfb: SUCCESS (12.760s)
[327.444727] [100/132] (721s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-y-tiled)
[327.529808] Starting subtest: yf-tiled-mc-ccs-to-vebox-y-tiled
[327.532363] Subtest yf-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[327.741984] [101/132] (721s left) sw_sync (sync_multi_producer_single_consumer)
[327.801546] Starting subtest: sync_multi_producer_single_consumer
[328.877806] Subtest sync_multi_producer_single_consumer: SUCCESS (1.076s)
[328.959862] [102/132] (720s left) kms_content_protection (dp-mst-type-1)
[329.452942] Starting subtest: dp-mst-type-1
[329.454296] Subtest dp-mst-type-1: SKIP (0.000s)
[329.564790] [103/132] (719s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc)
[330.052124] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc
[331.952800] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (1.898s)
[332.194987] [104/132] (717s left) gem_ctx_isolation (preservation-reset)
[332.379217] Starting subtest: preservation-reset
[332.379966] Starting dynamic subtest: rcs0
[332.862907] Dynamic subtest rcs0: SUCCESS (0.484s)
[332.863988] Subtest preservation-reset: SUCCESS (0.487s)
[332.993546] [105/132] (716s left) gem_userptr_blits (probe)
[333.086255] Starting subtest: probe
[333.279064] Subtest probe: SUCCESS (0.194s)
[333.393961] [106/132] (715s left) kms_rotation_crc (exhaust-fences)
[333.870191] Starting subtest: exhaust-fences
[333.871916] Subtest exhaust-fences: SKIP (0.000s)
[333.972003] [107/132] (715s left) kms_feature_discovery (display-4x)
[334.451373] Starting subtest: display-4x
[334.453171] Subtest display-4x: SKIP (0.000s)
[334.546436] [108/132] (714s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[335.025329] Starting subtest: psr-farfromfence-mmap-gtt
[335.026574] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[335.139377] [109/132] (714s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-wc)
[335.620398] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-wc
[335.621618] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[335.740831] [110/132] (713s left) kms_big_fb (y-tiled-64bpp-rotate-0)
[336.229336] Starting subtest: y-tiled-64bpp-rotate-0
[336.230954] Subtest y-tiled-64bpp-rotate-0: SKIP (0.000s)
[336.341490] [111/132] (713s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[336.818504] Starting subtest: cursorA-vs-flipB-legacy
[347.767062] Subtest cursorA-vs-flipB-legacy: SUCCESS (10.942s)
[348.061546] [112/132] (701s left) kms_pm_lpsp (screens-disabled)
[359.585375] Starting subtest: screens-disabled
[359.824193] Subtest screens-disabled: SKIP (0.238s)
[360.086979] [113/132] (689s left) syncobj_wait (reset-signaled)
[360.153012] Starting subtest: reset-signaled
[360.154252] Subtest reset-signaled: SUCCESS (0.000s)
[360.255106] [114/132] (689s left) i915_drm_fdinfo (memory-info-resident)
[360.315909] Subtest memory-info-resident: SKIP (0.000s)
[360.381708] [115/132] (689s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-signaled)
[360.437994] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[360.438740] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.001s)
[360.538138] [116/132] (689s left) i915_pm_rpm (gem-evict-pwrite)
[372.314551] Subtest gem-evict-pwrite: SKIP (0.000s)
[372.382953] [117/132] (677s left) gem_eio (in-flight-internal-immediate)
[372.457112] Starting subtest: in-flight-internal-immediate
[372.496108] Subtest in-flight-internal-immediate: SUCCESS (0.038s)
[373.017086] [118/132] (677s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling)
[373.074674] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.000s)
[373.140514] [119/132] (676s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs)
[373.197666] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[373.264776] [120/132] (676s left) vgem_basic (dmabuf-mmap)
[373.336563] Starting subtest: dmabuf-mmap
[373.366667] Subtest dmabuf-mmap: SUCCESS (0.032s)
[373.451693] [121/132] (676s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite)
[373.933522] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite
[373.935027] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[374.049136] [122/132] (676s left) gem_exec_async (forked-writes)
[374.124170] Starting subtest: forked-writes
[374.125150] Starting dynamic subtest: rcs0
[374.141756] Dynamic subtest rcs0: SUCCESS (0.017s)
[374.159646] Starting dynamic subtest: bcs0
[374.160664] Dynamic subtest bcs0: SUCCESS (0.015s)
[374.176197] Starting dynamic subtest: vcs0
[374.184291] Dynamic subtest vcs0: SUCCESS (0.023s)
[374.185310] Subtest forked-writes: SUCCESS (0.060s)
[374.418073] [123/132] (675s left) gem_exec_alignment (single)
[374.487409] Starting subtest: single
[374.490379] Subtest single: SUCCESS (0.003s)
[374.621435] [124/132] (675s left) api_intel_allocator (reserve-simple)
[374.676325] Starting subtest: reserve-simple
[374.681119] Subtest reserve-simple: SUCCESS (0.005s)
[374.800124] [125/132] (675s left) syncobj_timeline (multi-wait-for-submit-available-signaled)
[374.857860] Starting subtest: multi-wait-for-submit-available-signaled
[374.859974] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.001s)
[374.957120] [126/132] (675s left) gen7_exec_parse (batch-without-end)
[375.017336] Subtest batch-without-end: SKIP (0.000s)
[375.080510] [127/132] (675s left) kms_vblank (wait-forked-busy-hang)
[375.555854] Starting subtest: wait-forked-busy-hang
[375.556924] Starting dynamic subtest: pipe-A-VGA-1
[381.927610] Dynamic subtest pipe-A-VGA-1: SUCCESS (6.367s)
[381.950671] Starting dynamic subtest: pipe-A-HDMI-A-1
[387.968443] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.042s)
[387.989799] Starting dynamic subtest: pipe-B-VGA-1
[393.945766] Dynamic subtest pipe-B-VGA-1: SUCCESS (5.981s)
[393.963010] Starting dynamic subtest: pipe-B-HDMI-A-1
[399.944150] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (6.000s)
[399.947094] Subtest wait-forked-busy-hang: SUCCESS (24.402s)
[400.240188] [128/132] (650s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[400.739254] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip
[400.834133] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.092s)
[401.055901] [129/132] (649s left) gen3_render_mixed_blits
[401.183694] [130/132] (649s left) kms_psr (fbc-pr-primary-mmap-gtt)
[401.664347] Subtest fbc-pr-primary-mmap-gtt: SKIP (0.000s)
[401.743974] [131/132] (649s left) kms_cursor_crc (cursor-suspend)
[402.219110] Starting subtest: cursor-suspend
[402.220364] Starting dynamic subtest: pipe-A-VGA-1
[437.194315] Dynamic subtest pipe-A-VGA-1: SUCCESS (1.992s)
[437.215354] Starting dynamic subtest: pipe-B-HDMI-A-1
[472.263731] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (1.959s)
[472.266462] Subtest cursor-suspend: SUCCESS (3.957s)
[480.592429] [132/132] (578s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180)
[481.105060] Starting subtest: linear-max-hw-stride-64bpp-rotate-180
[482.263132] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (1.153s)
[482.503650] Closing watchdogs
results: parsing output: 0/ for test: gem_sync
results: parsing output: 1/ for test: gem_mmap_gtt
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: prime_self_import
results: parsing output: 4/ for test: gem_readwrite
results: parsing output: 5/ for test: gem_exec_parallel
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: gem_exec_schedule
results: parsing output: 8/ for test: kms_plane_multiple
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: gem_lmem_swapping
results: parsing output: 12/ for test: gem_mmap_wc
results: parsing output: 13/ for test: kms_psr
results: parsing output: 14/ for test: kms_big_fb
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: kms_big_fb
results: parsing output: 17/ for test: kms_plane
results: parsing output: 18/ for test: syncobj_wait
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: gem_mmap_wc
results: parsing output: 21/ for test: kms_vblank
results: parsing output: 22/ for test: gem_partial_pwrite_pread
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: kms_plane
results: parsing output: 25/ for test: gem_ccs
results: parsing output: 26/ for test: kms_flip
results: parsing output: 27/ for test: kms_plane_scaling
results: parsing output: 28/ for test: kms_flip
results: parsing output: 29/ for test: kms_ccs
results: parsing output: 30/ for test: kms_chamelium_frames
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: gem_madvise
results: parsing output: 33/ for test: kms_rotation_crc
results: parsing output: 34/ for test: kms_flip
results: parsing output: 35/ for test: kms_flip_scaled_crc
results: parsing output: 36/ for test: kms_async_flips
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_psr2_sf
results: parsing output: 39/ for test: gem_softpin
results: parsing output: 40/ for test: kms_ccs
results: parsing output: 41/ for test: kms_cursor_crc
results: parsing output: 42/ for test: kms_color_pipeline
results: parsing output: 43/ for test: gem_mmap
results: parsing output: 44/ for test: prime_vgem
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: gem_exec_params
results: parsing output: 48/ for test: kms_pipe_stress
results: parsing output: 49/ for test: prime_self_import
results: parsing output: 50/ for test: gem_mmap_gtt
results: parsing output: 51/ for test: gem_ctx_param
results: parsing output: 52/ for test: syncobj_timeline
results: parsing output: 53/ for test: gem_exec_balancer
results: parsing output: 54/ for test: kms_psr
results: parsing output: 55/ for test: gem_ctx_engines
results: parsing output: 56/ for test: kms_big_fb
results: parsing output: 57/ for test: syncobj_eventfd
results: parsing output: 58/ for test: gem_exec_fence
results: parsing output: 59/ for test: gem_userptr_blits
results: parsing output: 60/ for test: kms_fbcon_fbt
results: parsing output: 61/ for test: syncobj_wait
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_chamelium_color
results: parsing output: 64/ for test: core_setmaster
results: parsing output: 65/ for test: syncobj_wait
results: parsing output: 66/ for test: syncobj_timeline
results: parsing output: 67/ for test: gem_exec_parallel
results: parsing output: 68/ for test: kms_pm_rpm
results: parsing output: 69/ for test: kms_psr2_sf
results: parsing output: 70/ for test: kms_psr
results: parsing output: 71/ for test: i915_pm_rps
results: parsing output: 72/ for test: gem_ctx_persistence
results: parsing output: 73/ for test: kms_psr
results: parsing output: 74/ for test: kms_lease
results: parsing output: 75/ for test: syncobj_wait
results: parsing output: 76/ for test: api_intel_bb
results: parsing output: 77/ for test: kms_chamelium_hpd
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: gem_exec_schedule
results: parsing output: 80/ for test: kms_invalid_mode
results: parsing output: 81/ for test: sriov_basic
results: parsing output: 82/ for test: gem_exec_suspend
results: parsing output: 83/ for test: gem_pxp
results: parsing output: 84/ for test: gem_exec_schedule
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: gem_exec_balancer
results: parsing output: 87/ for test: i915_hangman
results: parsing output: 88/ for test: kms_cursor_crc
results: parsing output: 89/ for test: kms_dither
results: parsing output: 90/ for test: perf_pmu
results: parsing output: 91/ for test: gem_fence_thrash
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_flip
results: parsing output: 94/ for test: gem_exec_reloc
results: parsing output: 95/ for test: kms_ccs
results: parsing output: 96/ for test: kms_vrr
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_busy
results: parsing output: 99/ for test: gem_render_copy
results: parsing output: 100/ for test: sw_sync
results: parsing output: 101/ for test: kms_content_protection
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: gem_ctx_isolation
results: parsing output: 104/ for test: gem_userptr_blits
results: parsing output: 105/ for test: kms_rotation_crc
results: parsing output: 106/ for test: kms_feature_discovery
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_big_fb
results: parsing output: 110/ for test: kms_cursor_legacy
results: parsing output: 111/ for test: kms_pm_lpsp
results: parsing output: 112/ for test: syncobj_wait
results: parsing output: 113/ for test: i915_drm_fdinfo
results: parsing output: 114/ for test: syncobj_wait
results: parsing output: 115/ for test: i915_pm_rpm
results: parsing output: 116/ for test: gem_eio
results: parsing output: 117/ for test: kms_flip_scaled_crc
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: vgem_basic
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_exec_async
results: parsing output: 122/ for test: gem_exec_alignment
results: parsing output: 123/ for test: api_intel_allocator
results: parsing output: 124/ for test: syncobj_timeline
results: parsing output: 125/ for test: gen7_exec_parse
results: parsing output: 126/ for test: kms_vblank
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: gen3_render_mixed_blits
results: parsing output: 129/ for test: kms_psr
results: parsing output: 130/ for test: kms_cursor_crc
results: parsing output: 131/ for test: kms_big_fb
Done.