[71.324853] Initializing watchdogs
[71.325000]   /dev/watchdog0
[71.349329] [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)
[71.357172] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[71.360942] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[71.363763] [001/133] (960s left) gem_exec_whisper (basic-sync-all)
[71.444471] Starting subtest: basic-sync-all
[72.464890] Subtest basic-sync-all: SUCCESS (1.018s)
[72.655925] [002/133] (959s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen)
[73.150992] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen
[73.152672] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[73.762306] [003/133] (958s left) kms_flip (plain-flip-interruptible)
[74.263621] Starting subtest: plain-flip-interruptible
[74.264728] Starting dynamic subtest: A-VGA1
[75.044028] Dynamic subtest A-VGA1: SUCCESS (0.779s)
[75.054433] Starting dynamic subtest: B-VGA1
[75.712059] Dynamic subtest B-VGA1: SUCCESS (0.666s)
[75.723067] Starting dynamic subtest: A-HDMI-A1
[76.453454] Dynamic subtest A-HDMI-A1: SUCCESS (0.740s)
[76.464701] Starting dynamic subtest: B-HDMI-A1
[77.222529] Dynamic subtest B-HDMI-A1: SUCCESS (0.767s)
[77.223953] Subtest plain-flip-interruptible: SUCCESS (2.958s)
[78.018831] [004/133] (953s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-fully-sf)
[78.512471] Subtest fbc-pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[78.809340] [005/133] (953s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt)
[79.303878] Starting subtest: fbcpsr-rgb565-draw-blt
[79.304863] Subtest fbcpsr-rgb565-draw-blt: SKIP (0.000s)
[79.897579] [006/133] (952s left) kms_rotation_crc (bad-tiling)
[80.384816] Starting subtest: bad-tiling
[80.386099] Subtest bad-tiling: SKIP (0.001s)
[80.980112] [007/133] (951s left) api_intel_allocator (two-level-inception)
[81.032769] Starting subtest: two-level-inception
[86.472584] Subtest two-level-inception: SUCCESS (5.438s)
[86.587535] [008/133] (945s left) gem_exec_reloc (basic-wc-gtt-active)
[86.642862] Starting subtest: basic-wc-gtt-active
[86.754143] Subtest basic-wc-gtt-active: SUCCESS (0.111s)
[87.787218] [009/133] (944s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[88.284337] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[88.286091] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[88.885785] [010/133] (943s left) gem_mmap_gtt (cpuset-basic-small-copy-odd)
[88.939728] Starting subtest: cpuset-basic-small-copy-odd
[90.225742] Subtest cpuset-basic-small-copy-odd: SUCCESS (1.285s)
[90.369541] [011/133] (941s left) gem_mmap_wc (pf-nonblock)
[90.504977] Starting subtest: pf-nonblock
[90.506293] Subtest pf-nonblock: SUCCESS (0.001s)
[90.662826] [012/133] (941s left) gem_exec_create (legacy)
[90.727526] Starting subtest: legacy
[90.728184] Starting dynamic subtest: smem
[92.777555] Dynamic subtest smem: SUCCESS (2.050s)
[92.778529] Subtest legacy: SUCCESS (2.051s)
[93.008864] [013/133] (939s left) kms_dither (fb-8bpc-vs-panel-6bpc)
[93.514334] Starting subtest: fb-8bpc-vs-panel-6bpc
[93.515951] Starting dynamic subtest: pipe-A-HDMI-A-1
[93.602082] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.086s)
[93.603176] Subtest fb-8bpc-vs-panel-6bpc: SKIP (0.088s)
[94.304051] [014/133] (938s left) kms_big_fb (x-tiled-8bpp-rotate-0)
[94.804591] Starting subtest: x-tiled-8bpp-rotate-0
[95.974284] Subtest x-tiled-8bpp-rotate-0: SUCCESS (1.169s)
[96.615626] [015/133] (935s left) kms_cursor_crc (cursor-onscreen-128x42)
[97.114418] Starting subtest: cursor-onscreen-128x42
[97.174572] Subtest cursor-onscreen-128x42: SKIP (0.059s)
[97.780538] [016/133] (934s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[97.843667] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[97.950404] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.106s)
[98.081837] [017/133] (934s left) syncobj_wait (wait-all-interrupted)
[98.136331] Starting subtest: wait-all-interrupted
[98.238385] Subtest wait-all-interrupted: SUCCESS (0.102s)
[98.371393] [018/133] (934s left) kms_busy (extended-modeset-hang-newfb)
[98.866047] Starting subtest: extended-modeset-hang-newfb
[98.866860] Starting dynamic subtest: pipe-A
[111.088063] Dynamic subtest pipe-A: SUCCESS (12.219s)
[111.100030] Starting dynamic subtest: pipe-B
[123.055874] Dynamic subtest pipe-B: SUCCESS (11.966s)
[123.057551] Subtest extended-modeset-hang-newfb: SUCCESS (24.189s)
[123.777909] [019/133] (908s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[124.275927] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[124.276879] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[124.893228] [020/133] (907s left) syncobj_timeline (reset-multiple-signaled)
[124.948632] Starting subtest: reset-multiple-signaled
[124.949919] Subtest reset-multiple-signaled: SUCCESS (0.001s)
[125.074844] [021/133] (907s left) gem_exec_schedule (wide)
[125.140041] Subtest wide: SKIP (0.000s)
[125.358931] [022/133] (907s left) gem_ctx_engines (none)
[125.422686] Starting subtest: none
[125.424706] Subtest none: SUCCESS (0.002s)
[125.656317] [023/133] (907s left) gen7_exec_parse (batch-without-end)
[125.712826] Subtest batch-without-end: SKIP (0.000s)
[125.771207] [024/133] (907s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[125.824085] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[125.888902] [025/133] (907s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[126.380328] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt
[126.381417] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[126.971437] [026/133] (905s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-submi
[127.028412] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-submitted
[127.134533] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-submitted: SUCCESS (0.106s)
[127.241696] [027/133] (905s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[127.737207] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[127.738327] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[128.335996] [028/133] (904s left) gem_exec_schedule (promotion)
[128.402465] Subtest promotion: SKIP (0.000s)
[128.638009] [029/133] (904s left) gem_exec_schedule (independent)
[128.702756] Starting subtest: independent
[128.703461] Starting dynamic subtest: rcs0
[128.768582] Dynamic subtest rcs0: SUCCESS (0.065s)
[128.781925] Starting dynamic subtest: bcs0
[128.815550] Dynamic subtest bcs0: SUCCESS (0.046s)
[128.816657] Subtest independent: SUCCESS (0.113s)
[129.052936] [030/133] (904s left) prime_self_import (basic-llseek-size)
[129.101772] Starting subtest: basic-llseek-size
[129.105968] Subtest basic-llseek-size: SUCCESS (0.004s)
[129.217605] [031/133] (903s left) gem_exec_reloc (basic-gtt-wc)
[129.272538] Starting subtest: basic-gtt-wc
[129.276412] Subtest basic-gtt-wc: SUCCESS (0.004s)
[130.318199] [032/133] (902s left) i915_hangman (engine-error-state-capture)
[130.379816] Subtest engine-error-state-capture: SKIP (0.000s)
[130.441791] [033/133] (902s left) kms_plane_cursor (overlay)
[130.935333] Starting subtest: overlay
[130.936486] Starting dynamic subtest: pipe-A-HDMI-A-1-size-64
[133.615313] Dynamic subtest pipe-A-HDMI-A-1-size-64: SUCCESS (2.679s)
[133.678934] Starting dynamic subtest: pipe-A-HDMI-A-1-size-128
[136.376523] Dynamic subtest pipe-A-HDMI-A-1-size-128: SUCCESS (2.711s)
[136.437709] Starting dynamic subtest: pipe-A-HDMI-A-1-size-256
[139.137830] Dynamic subtest pipe-A-HDMI-A-1-size-256: SUCCESS (2.711s)
[139.282634] Starting dynamic subtest: pipe-B-HDMI-A-1-size-64
[142.064813] Dynamic subtest pipe-B-HDMI-A-1-size-64: SUCCESS (2.793s)
[142.126913] Starting dynamic subtest: pipe-B-HDMI-A-1-size-128
[144.825788] Dynamic subtest pipe-B-HDMI-A-1-size-128: SUCCESS (2.711s)
[144.886997] Starting dynamic subtest: pipe-B-HDMI-A-1-size-256
[147.570077] Dynamic subtest pipe-B-HDMI-A-1-size-256: SUCCESS (2.694s)
[147.706203] Subtest overlay: SUCCESS (16.768s)
[148.418512] [034/133] (884s left) sysfs_timeslice_duration (timeout)
[148.475209] Starting subtest: timeout
[148.476560] Starting dynamic subtest: vcs0
[148.477553] Dynamic subtest vcs0: SKIP (0.000s)
[148.491418] Starting dynamic subtest: bcs0
[148.493802] Dynamic subtest bcs0: SKIP (0.000s)
[148.510932] Starting dynamic subtest: rcs0
[148.512821] Dynamic subtest rcs0: SKIP (0.000s)
[148.514516] Subtest timeout: SKIP (0.003s)
[148.600259] [035/133] (884s left) dumb_buffer (invalid-bpp)
[148.650720] Starting subtest: invalid-bpp
[148.651228] Subtest invalid-bpp: SUCCESS (0.000s)
[148.767706] [036/133] (884s left) gem_exec_nop (basic-parallel)
[148.828568] Starting subtest: basic-parallel
[151.625853] Subtest basic-parallel: SUCCESS (2.798s)
[151.894982] [037/133] (881s left) kms_addfb_basic (bad-pitch-256)
[151.950838] Starting subtest: bad-pitch-256
[151.951450] Subtest bad-pitch-256: SUCCESS (0.000s)
[152.998435] [038/133] (880s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-cpu)
[153.496343] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-cpu
[155.326421] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (1.830s)
[155.970699] [039/133] (877s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen)
[156.462872] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen
[156.463801] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[157.066761] [040/133] (876s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-pwrite)
[157.557992] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-pwrite
[157.558997] Subtest fbc-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[158.167215] [041/133] (875s left) gem_exec_balancer (bonded-sync)
[158.227161] Subtest bonded-sync: SKIP (0.000s)
[158.316463] [042/133] (875s left) i915_drm_fdinfo (busy)
[158.372861] Subtest busy: SKIP (0.000s)
[158.423058] [043/133] (875s left) gem_exec_create (forked)
[158.486674] Starting subtest: forked
[158.487373] Starting dynamic subtest: smem
[178.585984] Dynamic subtest smem: SUCCESS (20.099s)
[178.586808] Subtest forked: SUCCESS (20.100s)
[178.822831] [044/133] (854s left) kms_pm_rpm (modeset-non-lpsp)
[190.619126] Subtest modeset-non-lpsp: SKIP (0.000s)
[190.910781] [045/133] (842s left) gem_render_copy (yf-tiled-ccs-to-x-tiled)
[190.973290] Starting subtest: yf-tiled-ccs-to-x-tiled
[190.973853] Starting dynamic subtest: smem
[190.975210] Dynamic subtest smem: SKIP (0.000s)
[190.976236] Subtest yf-tiled-ccs-to-x-tiled: SKIP (0.001s)
[191.198253] [046/133] (842s left) gem_userptr_blits (nohangcheck)
[191.279813] Starting subtest: nohangcheck
[191.327155] Subtest nohangcheck: SUCCESS (0.048s)
[191.448541] [047/133] (842s left) gem_spin_batch (legacy)
[191.510751] Starting subtest: legacy
[191.511533] Starting dynamic subtest: default
[194.821993] Dynamic subtest default: SUCCESS (3.311s)
[194.833188] Starting dynamic subtest: render
[198.132946] Dynamic subtest render: SUCCESS (3.310s)
[198.144301] Starting dynamic subtest: bsd
[201.443991] Dynamic subtest bsd: SUCCESS (3.310s)
[201.455579] Starting dynamic subtest: bsd1
[204.755582] Dynamic subtest bsd1: SUCCESS (3.311s)
[204.766969] Starting dynamic subtest: blt
[208.067526] Dynamic subtest blt: SUCCESS (3.311s)
[208.068275] Subtest legacy: SUCCESS (16.557s)
[208.330796] [048/133] (825s left) kms_content_protection (dp-mst-lic-type-0)
[208.840800] Starting subtest: dp-mst-lic-type-0
[208.842090] Subtest dp-mst-lic-type-0: SKIP (0.000s)
[209.445215] [049/133] (824s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc)
[209.934693] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc
[209.936880] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[210.543250] [050/133] (823s left) kms_plane (pixel-format-y-tiled-modifier)
[211.029675] Starting subtest: pixel-format-y-tiled-modifier
[211.032484] Subtest pixel-format-y-tiled-modifier: SKIP (0.000s)
[211.635407] [051/133] (822s left) prime_vgem (fence-flip-hang)
[211.753304] Subtest fence-flip-hang: SKIP (0.000s)
[211.908165] [FACT prime_vgem (fence-flip-hang)] new: kernel.kmod_is_loaded.vgem: true
[211.910835] [052/133] (822s left) syncobj_basic (bad-fd-to-handle)
[211.965729] Starting subtest: bad-fd-to-handle
[211.966541] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[212.094227] [053/133] (822s left) kms_chamelium_hpd (vga-hpd)
[212.661860] Subtest vga-hpd: SKIP (0.000s)
[213.065671] [054/133] (821s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[213.559822] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[213.560900] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[214.173571] [055/133] (820s left) kms_selftest (drm_dp_mst_helper)
[214.232739] Starting subtest: drm_dp_mst_helper
[214.239196] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[214.331295] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.092s)
[214.343869] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[214.421152] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.088s)
[214.433736] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[214.518251] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.095s)
[214.518900] Subtest drm_dp_mst_helper: SUCCESS (0.286s)
[214.717603] [056/133] (819s left) prime_self_import (reimport-vs-gem_close-race)
[214.769182] Starting subtest: reimport-vs-gem_close-race
[219.796841] Subtest reimport-vs-gem_close-race: SUCCESS (5.028s)
[219.929174] [057/133] (814s left) kms_flip (blocking-absolute-wf_vblank)
[220.414015] Starting subtest: blocking-absolute-wf_vblank
[220.414753] Starting dynamic subtest: A-VGA1
[228.175705] Dynamic subtest A-VGA1: SUCCESS (7.760s)
[228.188179] Starting dynamic subtest: B-VGA1
[235.898048] Dynamic subtest B-VGA1: SUCCESS (7.720s)
[235.910781] Starting dynamic subtest: A-HDMI-A1
[243.788822] Dynamic subtest A-HDMI-A1: SUCCESS (7.888s)
[243.801798] Starting dynamic subtest: B-HDMI-A1
[251.707683] Dynamic subtest B-HDMI-A1: SUCCESS (7.916s)
[251.712397] Subtest blocking-absolute-wf_vblank: SUCCESS (31.296s)
[252.493421] [058/133] (781s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted)
[252.552351] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted
[252.654442] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.102s)
[252.778465] [059/133] (781s left) gem_reg_read (timestamp-monotonic)
[252.833419] Starting subtest: timestamp-monotonic
[257.576866] Subtest timestamp-monotonic: SUCCESS (4.743s)
[257.701804] [060/133] (776s left) gem_ctx_param (invalid-set-ringsize)
[257.758401] Starting subtest: invalid-set-ringsize
[257.758873] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[257.882078] [061/133] (776s left) kms_chamelium_color (ctm-blue-to-red)
[258.368947] Subtest ctm-blue-to-red: SKIP (0.000s)
[258.657879] [062/133] (776s left) gem_ctx_param (invalid-size-get)
[258.711374] Starting subtest: invalid-size-get
[258.711910] Subtest invalid-size-get: SUCCESS (0.000s)
[258.816661] [063/133] (775s left) perf_pmu (busy-idle-no-semaphores)
[258.872961] Starting subtest: busy-idle-no-semaphores
[258.873728] Starting dynamic subtest: rcs0
[259.496506] Dynamic subtest rcs0: SUCCESS (0.623s)
[259.511540] Starting dynamic subtest: bcs0
[260.118823] Dynamic subtest bcs0: SUCCESS (0.621s)
[260.135635] Starting dynamic subtest: vcs0
[261.247623] Dynamic subtest vcs0: SUCCESS (1.127s)
[261.248241] Subtest busy-idle-no-semaphores: SUCCESS (2.375s)
[261.375443] [064/133] (773s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[261.862482] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[261.863414] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[262.457937] [065/133] (772s left) gem_exec_async (forked-writes)
[262.524442] Starting subtest: forked-writes
[262.525227] Starting dynamic subtest: rcs0
[262.541316] Dynamic subtest rcs0: SUCCESS (0.016s)
[262.557447] Starting dynamic subtest: bcs0
[262.560207] Dynamic subtest bcs0: SUCCESS (0.015s)
[262.571812] Starting dynamic subtest: vcs0
[262.581418] Dynamic subtest vcs0: SUCCESS (0.022s)
[262.584961] Subtest forked-writes: SUCCESS (0.058s)
[262.858139] [066/133] (771s left) kms_psr (fbc-pr-basic)
[263.343789] Subtest fbc-pr-basic: SKIP (0.000s)
[263.648951] [067/133] (771s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[264.137990] Starting subtest: basic-flip-before-cursor-varying-size
[265.121092] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.984s)
[265.832260] [068/133] (769s left) kms_addfb_basic (invalid-set-prop-any)
[265.888680] Starting subtest: invalid-set-prop-any
[265.889155] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[266.928835] [069/133] (768s left) kms_psr (fbc-psr2-cursor-plane-move)
[267.412828] Subtest fbc-psr2-cursor-plane-move: SKIP (0.000s)
[267.707468] [070/133] (767s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[268.193673] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[268.195575] Starting dynamic subtest: pipe-A
[268.197216] Dynamic subtest pipe-A: SKIP (0.001s)
[268.208885] Starting dynamic subtest: pipe-B
[268.210696] Dynamic subtest pipe-B: SKIP (0.001s)
[268.211775] Subtest plane-upscale-factor-0-25-with-modifiers: SKIP (0.006s)
[268.808573] [071/133] (766s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt)
[269.299615] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt
[271.271953] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (1.973s)
[271.903748] [072/133] (763s left) gem_render_copy (yf-tiled-ccs-to-y-tiled-ccs)
[271.964219] Starting subtest: yf-tiled-ccs-to-y-tiled-ccs
[271.964851] Starting dynamic subtest: smem
[271.966058] Dynamic subtest smem: SKIP (0.000s)
[271.967692] Subtest yf-tiled-ccs-to-y-tiled-ccs: SKIP (0.002s)
[272.202444] [073/133] (762s left) kms_hdr (bpc-switch)
[272.688712] Starting subtest: bpc-switch
[278.586133] Subtest bpc-switch: SKIP (5.898s)
[279.365275] [074/133] (755s left) gem_tiled_wb
[287.666332] [075/133] (747s left) gem_workarounds (basic-read-context)
[287.732871] Starting subtest: basic-read-context
[287.736744] Subtest basic-read-context: SUCCESS (0.004s)
[287.915770] [076/133] (747s left) prime_vgem (basic-blt)
[287.971199] Starting subtest: basic-blt
[287.994236] Subtest basic-blt: SUCCESS (0.023s)
[288.164329] [077/133] (747s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[288.655670] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[288.656640] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[289.251237] [078/133] (746s left) kms_big_fb (y-tiled-8bpp-rotate-180)
[289.737237] Starting subtest: y-tiled-8bpp-rotate-180
[289.738394] Subtest y-tiled-8bpp-rotate-180: SKIP (0.000s)
[290.348499] [079/133] (745s left) i915_pm_rpm (reg-read-ioctl)
[302.132543] Subtest reg-read-ioctl: SKIP (0.000s)
[302.429783] [080/133] (733s left) gem_exec_alignment (single)
[302.489054] Starting subtest: single
[302.491461] Subtest single: SUCCESS (0.003s)
[302.648300] [081/133] (732s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[302.703546] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SKIP (0.000s)
[302.763390] [082/133] (732s left) gem_userptr_blits (unsync-overlap)
[302.819874] Subtest unsync-overlap: SKIP (0.000s)
[302.981644] [083/133] (732s left) kms_psr (psr-sprite-mmap-gtt)
[303.457565] Subtest psr-sprite-mmap-gtt: SKIP (0.000s)
[303.761545] [084/133] (731s left) kms_atomic_interruptible (legacy-cursor)
[304.246815] Starting subtest: legacy-cursor
[304.261417] Starting dynamic subtest: pipe-A-HDMI-A-1
[310.572502] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.323s)
[310.572984] Subtest legacy-cursor: SUCCESS (6.326s)
[311.282238] [085/133] (724s left) kms_psr (fbc-psr-primary-page-flip)
[311.764844] Subtest fbc-psr-primary-page-flip: SKIP (0.000s)
[312.074578] [086/133] (723s left) kms_addfb_basic (invalid-smem-bo-on-discrete)
[312.128918] Starting subtest: invalid-smem-bo-on-discrete
[312.129926] Subtest invalid-smem-bo-on-discrete: SKIP (0.000s)
[313.167341] [087/133] (722s left) gem_busy (close-race)
[313.231273] Starting subtest: close-race
[335.136883] Subtest close-race: SUCCESS (21.906s)
[335.526415] [088/133] (700s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[336.105768] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[336.107665] Starting dynamic subtest: AB-VGA1-HDMI-A1
[366.571468] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (30.463s)
[366.573752] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SUCCESS (30.468s)
[367.406750] [089/133] (668s left) kms_color (degamma)
[367.886822] Starting subtest: degamma
[367.887680] Starting dynamic subtest: pipe-A-HDMI-A-1
[367.888916] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[367.900800] Starting dynamic subtest: pipe-B-HDMI-A-1
[367.901933] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[367.902895] Subtest degamma: SKIP (0.005s)
[368.485945] [090/133] (667s left) perf_pmu (all-busy-idle-check-all)
[368.543160] Starting subtest: all-busy-idle-check-all
[369.168260] Subtest all-busy-idle-check-all: SUCCESS (0.625s)
[369.304723] [091/133] (666s left) perf (gen12-mi-rpc)
[369.496628] Subtest gen12-mi-rpc: SKIP (0.000s)
[369.554282] [092/133] (666s left) kms_dsc (dsc-with-output-formats)
[370.037087] Subtest dsc-with-output-formats: SKIP (0.000s)
[370.330588] [093/133] (665s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier)
[370.812192] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier
[370.814386] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier: SKIP (0.000s)
[371.420414] [094/133] (664s left) gem_exec_fence (syncobj-timeline-wait)
[371.730696] Starting subtest: syncobj-timeline-wait
[371.761760] Subtest syncobj-timeline-wait: SUCCESS (0.031s)
[372.021631] [095/133] (664s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[372.074341] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[372.134345] [096/133] (664s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc)
[372.188900] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.000s)
[372.249341] [097/133] (664s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[372.732566] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[375.170804] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (2.438s)
[375.821478] [098/133] (660s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-mc-ccs)
[375.876550] Subtest ccs-on-another-bo-y-tiled-gen12-mc-ccs: SKIP (0.000s)
[375.931917] [099/133] (660s left) kms_psr2_sf (pr-cursor-plane-update-sf)
[376.416192] Subtest pr-cursor-plane-update-sf: SKIP (0.000s)
[376.718819] [100/133] (659s left) i915_suspend (sysfs-reader)
[376.772346] Starting subtest: sysfs-reader
[396.073042] Subtest sysfs-reader: SUCCESS (3.340s)
[403.127269] [101/133] (640s left) kms_lease (lease-revoke)
[403.616476] Starting subtest: lease-revoke
[403.617097] Starting dynamic subtest: pipe-A-HDMI-A-1
[403.663318] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.042s)
[403.677693] Starting dynamic subtest: pipe-B-HDMI-A-1
[403.699742] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.038s)
[403.700502] Subtest lease-revoke: SUCCESS (0.085s)
[404.303643] [102/133] (639s left) kms_invalid_mode (bad-hsync-start)
[404.785432] Starting subtest: bad-hsync-start
[404.789038] Starting dynamic subtest: pipe-A-HDMI-A-1
[404.874691] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.087s)
[404.895079] Starting dynamic subtest: pipe-B-HDMI-A-1
[404.895693] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[404.896410] Subtest bad-hsync-start: SUCCESS (0.094s)
[405.346974] [103/133] (638s left) kms_psr (psr2-sprite-plane-onoff)
[405.838537] Subtest psr2-sprite-plane-onoff: SKIP (0.000s)
[406.147011] [104/133] (637s left) vgem_slow (nohang)
[406.212372] Starting subtest: nohang
[416.667187] Subtest nohang: SUCCESS (10.455s)
[416.778840] [105/133] (627s left) syncobj_timeline (single-wait-all-for-submit-available-submitted)
[416.836926] Starting subtest: single-wait-all-for-submit-available-submitted
[416.837446] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s)
[416.961221] [106/133] (626s left) gem_exec_reloc (basic-gtt)
[417.017428] Starting subtest: basic-gtt
[417.021446] Subtest basic-gtt: SUCCESS (0.004s)
[418.030598] [107/133] (625s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[418.528428] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[418.531264] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[419.133268] [108/133] (624s left) syncobj_wait (invalid-signal-one-illegal-handle)
[419.190048] Starting subtest: invalid-signal-one-illegal-handle
[419.190687] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[419.344365] [109/133] (624s left) kms_atomic (atomic-invalid-params)
[419.829318] Starting subtest: atomic-invalid-params
[419.830017] Starting dynamic subtest: pipe-A-HDMI-A-1
[420.063196] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.233s)
[420.064989] Subtest atomic-invalid-params: SUCCESS (0.236s)
[420.765225] [110/133] (623s left) kms_cursor_crc (cursor-sliding-128x42)
[421.256890] Starting subtest: cursor-sliding-128x42
[421.314794] Subtest cursor-sliding-128x42: SKIP (0.055s)
[421.930604] [111/133] (622s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-blt)
[422.423743] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-blt
[422.424805] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[423.031575] [112/133] (621s left) kms_vblank (crtc-id)
[423.516334] Starting subtest: crtc-id
[423.517807] Starting dynamic subtest: pipe-A-HDMI-A-1
[423.782645] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.264s)
[423.799089] Starting dynamic subtest: pipe-B-HDMI-A-1
[424.069660] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.284s)
[424.070255] Subtest crtc-id: SUCCESS (0.555s)
[424.756249] [113/133] (619s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[425.248333] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[425.249340] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[425.861766] [114/133] (618s left) kms_plane_cursor (primary)
[426.341602] Starting subtest: primary
[426.342930] Starting dynamic subtest: pipe-A-HDMI-A-1-size-64
[428.769133] Dynamic subtest pipe-A-HDMI-A-1-size-64: SUCCESS (2.425s)
[428.819326] Starting dynamic subtest: pipe-A-HDMI-A-1-size-128
[431.235212] Dynamic subtest pipe-A-HDMI-A-1-size-128: SUCCESS (2.432s)
[431.286840] Starting dynamic subtest: pipe-A-HDMI-A-1-size-256
[433.718172] Dynamic subtest pipe-A-HDMI-A-1-size-256: SUCCESS (2.449s)
[433.856299] Starting dynamic subtest: pipe-B-HDMI-A-1-size-64
[436.370433] Dynamic subtest pipe-B-HDMI-A-1-size-64: SUCCESS (2.528s)
[436.419754] Starting dynamic subtest: pipe-B-HDMI-A-1-size-128
[438.853436] Dynamic subtest pipe-B-HDMI-A-1-size-128: SUCCESS (2.448s)
[438.906502] Starting dynamic subtest: pipe-B-HDMI-A-1-size-256
[441.319802] Dynamic subtest pipe-B-HDMI-A-1-size-256: SUCCESS (2.432s)
[441.441846] Subtest primary: SUCCESS (15.101s)
[442.138140] [115/133] (602s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[442.193474] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[442.262468] [116/133] (602s left) kms_big_fb (linear-16bpp-rotate-180)
[442.751478] Starting subtest: linear-16bpp-rotate-180
[444.096576] Subtest linear-16bpp-rotate-180: SUCCESS (1.345s)
[444.751695] [117/133] (599s left) kms_vrr (flip-basic)
[445.239530] Starting subtest: flip-basic
[445.241299] Subtest flip-basic: SKIP (0.000s)
[445.851260] [118/133] (598s left) kms_chamelium_edid (vga-edid-read)
[446.420079] Subtest vga-edid-read: SKIP (0.000s)
[446.814510] [119/133] (597s left) kms_pm_dc (dc5-dpms-negative)
[457.916805] Subtest dc5-dpms-negative: SKIP (0.000s)
[457.990528] [120/133] (586s left) kms_cursor_crc (cursor-sliding-256x85)
[458.481913] Starting subtest: cursor-sliding-256x85
[458.536842] Subtest cursor-sliding-256x85: SKIP (0.054s)
[459.155223] [121/133] (585s left) gem_blits (basic)
[459.210049] Starting subtest: basic
[461.189716] Subtest basic: SUCCESS (1.980s)
[461.355748] [122/133] (583s left) gem_mmap_offset (blt-coherency)
[461.410669] Starting subtest: blt-coherency
[461.415421] Subtest blt-coherency: SUCCESS (0.005s)
[461.568532] [123/133] (583s left) syncobj_timeline (invalid-signal-bad-pad)
[461.625236] Starting subtest: invalid-signal-bad-pad
[461.626304] Subtest invalid-signal-bad-pad: SUCCESS (0.000s)
[461.752991] [124/133] (583s left) kms_ccs (bad-pixel-format-y-tiled-ccs)
[461.806037] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.000s)
[461.867714] [125/133] (583s left) gem_exec_fence (syncobj-channel)
[462.070043] Starting subtest: syncobj-channel
[463.095958] Subtest syncobj-channel: SUCCESS (1.026s)
[463.485429] [126/133] (581s left) gem_userptr_blits (forbidden-operations)
[463.543838] Starting subtest: forbidden-operations
[463.544550] Subtest forbidden-operations: SUCCESS (0.001s)
[463.719100] [127/133] (581s left) gem_flink_basic (double-flink)
[463.773490] Starting subtest: double-flink
[463.774136] Subtest double-flink: SUCCESS (0.000s)
[463.918966] [128/133] (581s left) gem_ctx_persistence (heartbeat-hang)
[463.976270] Subtest heartbeat-hang: SKIP (0.000s)
[464.047627] [129/133] (581s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[464.544551] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[464.546275] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[465.171765] [130/133] (580s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[465.669639] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[465.671758] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.001s)
[466.270166] [131/133] (579s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[466.753146] Starting subtest: basic-flip-before-cursor-legacy
[467.752927] Subtest basic-flip-before-cursor-legacy: SUCCESS (0.998s)
[468.464336] [132/133] (576s left) api_intel_bb (reset-flags)
[468.520922] Starting subtest: reset-flags
[468.525965] Subtest reset-flags: SUCCESS (0.006s)
[468.710595] [133/133] (576s left) kms_psr (pr-sprite-render)
[469.193175] Subtest pr-sprite-render: SKIP (0.000s)
[469.486264] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_whisper
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_flip
results: parsing output: 3/ for test: kms_psr2_sf
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_rotation_crc
results: parsing output: 6/ for test: api_intel_allocator
results: parsing output: 7/ for test: gem_exec_reloc
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: gem_mmap_gtt
results: parsing output: 10/ for test: gem_mmap_wc
results: parsing output: 11/ for test: gem_exec_create
results: parsing output: 12/ for test: kms_dither
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: kms_cursor_crc
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: syncobj_wait
results: parsing output: 17/ for test: kms_busy
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: syncobj_timeline
results: parsing output: 20/ for test: gem_exec_schedule
results: parsing output: 21/ for test: gem_ctx_engines
results: parsing output: 22/ for test: gen7_exec_parse
results: parsing output: 23/ for test: kms_flip_scaled_crc
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: syncobj_timeline
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: gem_exec_schedule
results: parsing output: 28/ for test: gem_exec_schedule
results: parsing output: 29/ for test: prime_self_import
results: parsing output: 30/ for test: gem_exec_reloc
results: parsing output: 31/ for test: i915_hangman
results: parsing output: 32/ for test: kms_plane_cursor
results: parsing output: 33/ for test: sysfs_timeslice_duration
results: parsing output: 34/ for test: dumb_buffer
results: parsing output: 35/ for test: gem_exec_nop
results: parsing output: 36/ for test: kms_addfb_basic
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: gem_exec_balancer
results: parsing output: 41/ for test: i915_drm_fdinfo
results: parsing output: 42/ for test: gem_exec_create
results: parsing output: 43/ for test: kms_pm_rpm
results: parsing output: 44/ for test: gem_render_copy
results: parsing output: 45/ for test: gem_userptr_blits
results: parsing output: 46/ for test: gem_spin_batch
results: parsing output: 47/ for test: kms_content_protection
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_plane
results: parsing output: 50/ for test: prime_vgem
results: parsing output: 51/ for test: syncobj_basic
results: parsing output: 52/ for test: kms_chamelium_hpd
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_selftest
results: parsing output: 55/ for test: prime_self_import
results: parsing output: 56/ for test: kms_flip
results: parsing output: 57/ for test: syncobj_wait
results: parsing output: 58/ for test: gem_reg_read
results: parsing output: 59/ for test: gem_ctx_param
results: parsing output: 60/ for test: kms_chamelium_color
results: parsing output: 61/ for test: gem_ctx_param
results: parsing output: 62/ for test: perf_pmu
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: gem_exec_async
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_cursor_legacy
results: parsing output: 67/ for test: kms_addfb_basic
results: parsing output: 68/ for test: kms_psr
results: parsing output: 69/ for test: kms_plane_scaling
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_render_copy
results: parsing output: 72/ for test: kms_hdr
results: parsing output: 73/ for test: gem_tiled_wb
results: parsing output: 74/ for test: gem_workarounds
results: parsing output: 75/ for test: prime_vgem
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: i915_pm_rpm
results: parsing output: 79/ for test: gem_exec_alignment
results: parsing output: 80/ for test: kms_ccs
results: parsing output: 81/ for test: gem_userptr_blits
results: parsing output: 82/ for test: kms_psr
results: parsing output: 83/ for test: kms_atomic_interruptible
results: parsing output: 84/ for test: kms_psr
results: parsing output: 85/ for test: kms_addfb_basic
results: parsing output: 86/ for test: gem_busy
results: parsing output: 87/ for test: kms_flip
results: parsing output: 88/ for test: kms_color
results: parsing output: 89/ for test: perf_pmu
results: parsing output: 90/ for test: perf
results: parsing output: 91/ for test: kms_dsc
results: parsing output: 92/ for test: kms_plane
results: parsing output: 93/ for test: gem_exec_fence
results: parsing output: 94/ for test: kms_flip_scaled_crc
results: parsing output: 95/ for test: kms_ccs
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_ccs
results: parsing output: 98/ for test: kms_psr2_sf
results: parsing output: 99/ for test: i915_suspend
results: parsing output: 100/ for test: kms_lease
results: parsing output: 101/ for test: kms_invalid_mode
results: parsing output: 102/ for test: kms_psr
results: parsing output: 103/ for test: vgem_slow
results: parsing output: 104/ for test: syncobj_timeline
results: parsing output: 105/ for test: gem_exec_reloc
results: parsing output: 106/ for test: kms_big_fb
results: parsing output: 107/ for test: syncobj_wait
results: parsing output: 108/ for test: kms_atomic
results: parsing output: 109/ for test: kms_cursor_crc
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_vblank
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_plane_cursor
results: parsing output: 114/ for test: kms_flip_scaled_crc
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: kms_vrr
results: parsing output: 117/ for test: kms_chamelium_edid
results: parsing output: 118/ for test: kms_pm_dc
results: parsing output: 119/ for test: kms_cursor_crc
results: parsing output: 120/ for test: gem_blits
results: parsing output: 121/ for test: gem_mmap_offset
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: kms_ccs
results: parsing output: 124/ for test: gem_exec_fence
results: parsing output: 125/ for test: gem_userptr_blits
results: parsing output: 126/ for test: gem_flink_basic
results: parsing output: 127/ for test: gem_ctx_persistence
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: kms_big_fb
results: parsing output: 130/ for test: kms_cursor_legacy
results: parsing output: 131/ for test: api_intel_bb
results: parsing output: 132/ for test: kms_psr
Done.