[90.749759] Initializing watchdogs
[90.749951]   /dev/watchdog0
[90.791463] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600]
[90.806260] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[90.813715] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[90.819280] [001/156] (960s left) kms_frontbuffer_tracking (fbc-tiling-linear)
[91.049423] Starting subtest: fbc-tiling-linear
[93.417636] Subtest fbc-tiling-linear: SUCCESS (2.368s)
[93.771483] [002/156] (957s left) kms_pipe_b_c_ivb (enable-pipe-c-while-b-has-3-lanes)
[93.882182] Subtest enable-pipe-C-while-B-has-3-lanes: SKIP (0.000s)
[93.978124] [003/156] (957s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[94.179217] Starting subtest: psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[94.182277] Subtest psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.001s)
[94.339134] [004/156] (957s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[94.555857] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[94.559232] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[94.703321] [005/156] (956s left) kms_force_connector_basic (prune-stale-modes)
[94.999048] Starting subtest: prune-stale-modes
[95.175168] Subtest prune-stale-modes: SUCCESS (0.183s)
[95.519414] [006/156] (956s left) perf_pmu (most-busy-check-all)
[95.650331] Starting subtest: most-busy-check-all
[95.653090] Starting dynamic subtest: rcs0
[96.179290] Dynamic subtest rcs0: SUCCESS (0.527s)
[96.208505] Starting dynamic subtest: bcs0
[96.717910] Dynamic subtest bcs0: SUCCESS (0.539s)
[96.739647] Starting dynamic subtest: vcs0
[97.250104] Dynamic subtest vcs0: SUCCESS (0.529s)
[97.275467] Starting dynamic subtest: vecs0
[97.780767] Dynamic subtest vecs0: SUCCESS (0.529s)
[97.782512] Subtest most-busy-check-all: SUCCESS (2.130s)
[97.921989] [007/156] (953s left) gem_ccs (large-ctrl-surf-copy)
[98.047089] Subtest large-ctrl-surf-copy: SKIP (0.000s)
[98.146307] [008/156] (953s left) kms_plane_alpha_blend (coverage-7efc)
[98.325846] Starting subtest: coverage-7efc
[98.533079] Starting dynamic subtest: pipe-A-HDMI-A-1
[99.633229] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.099s)
[99.752798] Starting dynamic subtest: pipe-C-HDMI-A-1
[100.896145] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.170s)
[100.907938] Subtest coverage-7efc: SUCCESS (2.569s)
[101.271245] [009/156] (950s left) gem_mmap_gtt (fault-concurrent)
[101.394901] Starting subtest: fault-concurrent
[104.676871] Subtest fault-concurrent: SUCCESS (3.282s)
[104.837819] [010/156] (947s left) api_intel_allocator (gem-pool)
[104.942423] Starting subtest: gem-pool
[104.959310] Subtest gem-pool: SUCCESS (0.018s)
[105.123299] [011/156] (947s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-fullscreen)
[105.332860] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-fullscreen
[105.338072] Subtest fbchdr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[105.485681] [012/156] (946s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-modifier)
[105.673259] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-modifier
[105.676653] Subtest pixel-format-4-tiled-dg2-rc-ccs-modifier: SKIP (0.000s)
[105.803931] [013/156] (946s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs)
[105.988872] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs
[105.999760] Starting dynamic subtest: pipe-A-HDMI-A-1
[106.593924] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.591s)
[106.625357] Starting dynamic subtest: pipe-A-HDMI-A-2
[107.057720] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.462s)
[107.098375] Starting dynamic subtest: pipe-B-HDMI-A-1
[107.556493] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.494s)
[107.590121] Starting dynamic subtest: pipe-B-HDMI-A-2
[107.988657] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.431s)
[108.029815] Starting dynamic subtest: pipe-C-HDMI-A-1
[108.065778] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.003s)
[108.093325] Starting dynamic subtest: pipe-C-HDMI-A-2
[108.110695] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.003s)
[108.112681] Subtest crc-primary-rotation-180-yf-tiled-ccs: SUCCESS (2.004s)
[108.868481] [014/156] (943s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-mc-ccs)
[109.049176] Starting subtest: ccs-on-another-bo-y-tiled-gen12-mc-ccs
[109.051078] Starting dynamic subtest: pipe-A-HDMI-A-1
[109.074590] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[109.122463] Starting dynamic subtest: pipe-A-HDMI-A-2
[109.164106] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.000s)
[109.189148] Starting dynamic subtest: pipe-B-HDMI-A-1
[109.205897] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[109.225870] Starting dynamic subtest: pipe-B-HDMI-A-2
[109.241426] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.000s)
[109.261795] Starting dynamic subtest: pipe-C-HDMI-A-1
[109.276589] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[109.298205] Starting dynamic subtest: pipe-C-HDMI-A-2
[109.313464] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.001s)
[109.316526] Subtest ccs-on-another-bo-y-tiled-gen12-mc-ccs: SKIP (0.017s)
[110.064794] [015/156] (942s left) kms_frontbuffer_tracking (hdr-rgb565-draw-blt)
[110.268302] Starting subtest: hdr-rgb565-draw-blt
[110.273130] Subtest hdr-rgb565-draw-blt: SKIP (0.000s)
[110.415967] [016/156] (942s left) kms_pm_rpm (legacy-planes-dpms)
[112.356676] Starting subtest: legacy-planes-dpms
[112.359192] Starting dynamic subtest: plane-45
[113.914213] Dynamic subtest plane-45: SUCCESS (1.556s)
[113.938379] Starting dynamic subtest: plane-54
[115.460650] Dynamic subtest plane-54: SUCCESS (1.543s)
[115.497205] Starting dynamic subtest: plane-63
[117.046688] Dynamic subtest plane-63: SUCCESS (1.582s)
[117.048848] Subtest legacy-planes-dpms: SUCCESS (4.692s)
[117.559651] [017/156] (935s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[117.684103] Starting subtest: x-tiled-to-vebox-y-tiled
[117.687364] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[117.932726] [018/156] (934s left) sysfs_heartbeat_interval (invalid)
[118.045252] Starting subtest: invalid
[118.047274] Starting dynamic subtest: vecs0
[118.049210] Dynamic subtest vecs0: SUCCESS (0.001s)
[118.082297] Starting dynamic subtest: vcs0
[118.083958] Dynamic subtest vcs0: SUCCESS (0.001s)
[118.106089] Starting dynamic subtest: bcs0
[118.108116] Dynamic subtest bcs0: SUCCESS (0.001s)
[118.128487] Starting dynamic subtest: rcs0
[118.131089] Dynamic subtest rcs0: SUCCESS (0.001s)
[118.133882] Subtest invalid: SUCCESS (0.011s)
[118.213440] [019/156] (934s left) kms_frontbuffer_tracking (fbc-stridechange)
[118.422072] Starting subtest: fbc-stridechange
[120.372897] Subtest fbc-stridechange: SUCCESS (1.950s)
[120.692683] [020/156] (932s left) gem_ctx_param (basic-default)
[120.801919] Starting subtest: basic-default
[120.804307] Subtest basic-default: SUCCESS (0.000s)
[120.928467] [021/156] (932s left) kms_psr (fbc-pr-primary-mmap-gtt)
[121.115523] Subtest fbc-pr-primary-mmap-gtt: SKIP (0.000s)
[121.219140] [022/156] (931s left) i915_pm_freq_mult (media-freq)
[121.332770] Starting subtest: media-freq
[121.335832] Starting dynamic subtest: gt0
[121.339877] Dynamic subtest gt0: SKIP (0.000s)
[121.342908] Subtest media-freq: SKIP (0.002s)
[121.490134] [023/156] (931s left) prime_busy (before-wait)
[121.609058] Starting subtest: before-wait
[121.621407] Starting dynamic subtest: rcs0
[121.630463] Dynamic subtest rcs0: SUCCESS (0.012s)
[121.656336] Starting dynamic subtest: bcs0
[121.658193] Dynamic subtest bcs0: SUCCESS (0.015s)
[121.683554] Starting dynamic subtest: vcs0
[121.685710] Dynamic subtest vcs0: SUCCESS (0.017s)
[121.707240] Starting dynamic subtest: vecs0
[121.709198] Dynamic subtest vecs0: SUCCESS (0.010s)
[121.792945] Subtest before-wait: SUCCESS (0.188s)
[121.930570] [024/156] (931s left) gem_exec_gttfill (engines)
[122.064190] Starting subtest: engines
[122.067164] Starting dynamic subtest: rcs0
[150.014966] Dynamic subtest rcs0: SUCCESS (27.954s)
[150.043872] Starting dynamic subtest: bcs0
[180.361213] Dynamic subtest bcs0: SUCCESS (30.343s)
[180.388157] Starting dynamic subtest: vcs0
[208.022896] Dynamic subtest vcs0: SUCCESS (27.658s)
[208.047182] Starting dynamic subtest: vecs0
[235.557814] Dynamic subtest vecs0: SUCCESS (27.536s)
[235.559498] Subtest engines: SUCCESS (113.500s)
[235.855787] [025/156] (817s left) syncobj_timeline (etime-multi-wait-all-submitted)
[236.117665] Starting subtest: etime-multi-wait-all-submitted
[236.232087] Subtest etime-multi-wait-all-submitted: SUCCESS (0.112s)
[236.399446] [026/156] (817s left) gem_ctx_param (get-priority-new-ctx)
[236.507743] Starting subtest: get-priority-new-ctx
[236.511293] Subtest get-priority-new-ctx: SUCCESS (0.001s)
[236.650908] [027/156] (816s left) kms_big_fb (linear-32bpp-rotate-90)
[236.877064] Starting subtest: linear-32bpp-rotate-90
[237.259367] Subtest linear-32bpp-rotate-90: SKIP (0.380s)
[237.548085] [028/156] (816s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[237.678830] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[237.784670] [029/156] (816s left) gem_ctx_shared (disjoint-timelines)
[237.913117] Starting subtest: disjoint-timelines
[237.995467] Subtest disjoint-timelines: SUCCESS (0.083s)
[238.286673] [FACT gem_ctx_shared (disjoint-timelines)] new: kernel.kmod_is_loaded.vgem: true
[238.292624] [030/156] (815s left) kms_psr (fbc-psr2-cursor-plane-move)
[238.483377] Subtest fbc-psr2-cursor-plane-move: SKIP (0.000s)
[238.600338] [031/156] (815s left) gem_bad_reloc (negative-reloc-bltcopy)
[238.724833] Starting subtest: negative-reloc-bltcopy
[241.956874] Subtest negative-reloc-bltcopy: SUCCESS (3.228s)
[242.337809] [032/156] (811s left) kms_chamelium_hpd (hdmi-hpd)
[242.904114] Subtest hdmi-hpd: SKIP (0.000s)
[243.261124] [033/156] (810s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-fully-sf)
[243.461124] Subtest pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[243.569138] [034/156] (810s left) gem_eio (wait-10ms)
[243.727298] Starting subtest: wait-10ms
[243.880368] Subtest wait-10ms: SUCCESS (0.154s)
[244.128539] [035/156] (810s left) kms_content_protection (legacy-hdcp14)
[244.363334] Starting subtest: legacy-hdcp14
[244.385901] Subtest legacy-hdcp14: SKIP (0.017s)
[244.546676] [036/156] (810s left) syncobj_wait (reset-signaled)
[244.658918] Starting subtest: reset-signaled
[244.660819] Subtest reset-signaled: SUCCESS (0.001s)
[244.812181] [037/156] (809s left) gem_ctx_isolation (dirty-switch)
[244.950117] Starting subtest: dirty-switch
[244.953036] Starting dynamic subtest: rcs0
[245.533415] Dynamic subtest rcs0: SUCCESS (0.584s)
[245.561223] Starting dynamic subtest: bcs0
[246.494877] Dynamic subtest bcs0: SUCCESS (0.957s)
[246.525315] Starting dynamic subtest: vcs0
[247.096132] Dynamic subtest vcs0: SUCCESS (0.599s)
[247.123806] Starting dynamic subtest: vecs0
[247.682530] Dynamic subtest vecs0: SUCCESS (0.585s)
[247.686457] Subtest dirty-switch: SUCCESS (2.736s)
[247.948720] [038/156] (806s left) gem_flink_basic (bad-open)
[248.052599] Starting subtest: bad-open
[248.054297] Subtest bad-open: SUCCESS (0.000s)
[248.197759] [039/156] (806s left) gem_caching (writes)
[248.323120] Starting subtest: writes
[262.547392] Subtest writes: SUCCESS (14.226s)
[262.732647] [040/156] (792s left) kms_plane_scaling (plane-scaler-unity-scaling-with-modifiers)
[262.922467] Starting subtest: plane-scaler-unity-scaling-with-modifiers
[262.925806] Starting dynamic subtest: pipe-A
[263.841502] Dynamic subtest pipe-A: SUCCESS (0.920s)
[263.872167] Starting dynamic subtest: pipe-B
[264.754973] Dynamic subtest pipe-B: SUCCESS (0.912s)
[264.783437] Starting dynamic subtest: pipe-C
[265.653685] Dynamic subtest pipe-C: SUCCESS (0.894s)
[265.655388] Subtest plane-scaler-unity-scaling-with-modifiers: SUCCESS (2.735s)
[266.283697] [041/156] (788s left) syncobj_timeline (single-wait-all-for-submit-available-submitted)
[266.394685] Starting subtest: single-wait-all-for-submit-available-submitted
[266.399266] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.001s)
[266.554181] [042/156] (788s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-pri-indfb-draw-render)
[266.751043] Starting subtest: fbchdr-2p-primscrn-pri-indfb-draw-render
[266.755775] Subtest fbchdr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[266.905333] [043/156] (788s left) kms_pm_rpm (system-suspend-idle)
[268.867598] Starting subtest: system-suspend-idle
[286.328606] Subtest system-suspend-idle: SUCCESS (1.980s)
[294.825452] [044/156] (768s left) kms_atomic_transition (modeset-transition)
[295.039253] Starting subtest: modeset-transition
[295.041040] Starting dynamic subtest: 1x-outputs
[298.664953] Dynamic subtest 1x-outputs: SUCCESS (3.681s)
[298.694983] Starting dynamic subtest: 2x-outputs
[306.377823] Dynamic subtest 2x-outputs: SUCCESS (7.768s)
[306.379756] Subtest modeset-transition: SUCCESS (11.455s)
[306.788548] [045/156] (756s left) kms_frontbuffer_tracking (pipe-fbc-rte)
[307.004954] Starting subtest: pipe-fbc-rte
[307.017259] Subtest pipe-fbc-rte: SKIP (0.001s)
[307.170834] [046/156] (756s left) gem_spin_batch (resubmit-all)
[307.302428] Starting subtest: resubmit-all
[307.304347] Starting dynamic subtest: rcs0
[307.314314] Dynamic subtest rcs0: SUCCESS (0.012s)
[307.355472] Starting dynamic subtest: bcs0
[307.357936] Dynamic subtest bcs0: SUCCESS (0.010s)
[307.384933] Starting dynamic subtest: vcs0
[307.387379] Dynamic subtest vcs0: SUCCESS (0.005s)
[307.413534] Starting dynamic subtest: vecs0
[307.415391] Dynamic subtest vecs0: SUCCESS (0.005s)
[307.417376] Subtest resubmit-all: SUCCESS (0.041s)
[307.619301] [047/156] (756s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff)
[307.814298] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff
[307.818438] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[307.966134] [048/156] (755s left) syncobj_basic (illegal-fd-to-handle)
[308.069813] Starting subtest: illegal-fd-to-handle
[308.072284] Subtest illegal-fd-to-handle: SUCCESS (0.000s)
[308.245249] [049/156] (755s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-pwrite)
[308.458253] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-pwrite
[311.102264] Subtest fbc-2p-primscrn-spr-indfb-draw-pwrite: SUCCESS (2.656s)
[311.339831] [050/156] (752s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180)
[311.537268] Starting subtest: linear-max-hw-stride-32bpp-rotate-180
[313.295941] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.763s)
[313.616939] [051/156] (750s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[313.724867] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[313.829353] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.103s)
[314.014010] [052/156] (750s left) api_intel_bb (misplaced-blitter)
[314.122007] Starting subtest: misplaced-blitter
[314.139693] Subtest misplaced-blitter: SUCCESS (0.019s)
[314.300350] [053/156] (750s left) kms_atomic_interruptible (universal-setplane-cursor)
[314.497111] Starting subtest: universal-setplane-cursor
[314.501516] Starting dynamic subtest: pipe-A-HDMI-A-1
[321.344381] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.857s)
[321.346563] Subtest universal-setplane-cursor: SUCCESS (6.864s)
[321.697930] [054/156] (742s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[321.905466] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[321.911281] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[322.063099] [055/156] (742s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[322.277485] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[322.281005] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[322.444868] [056/156] (742s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling)
[322.630440] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-downscaling
[322.635828] Starting dynamic subtest: pipe-A-valid-mode
[323.698251] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.073s)
[323.700255] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SUCCESS (1.077s)
[324.095855] [057/156] (740s left) gem_pxp (create-protected-buffer)
[326.745478] Starting subtest: create-protected-buffer
[326.750963] Subtest create-protected-buffer: SKIP (0.000s)
[326.893094] [058/156] (737s left) gem_fence_thrash (bo-write-verify-threaded-x)
[326.997312] Starting subtest: bo-write-verify-threaded-x
[332.078022] Subtest bo-write-verify-threaded-x: SUCCESS (5.077s)
[332.229443] [059/156] (732s left) gen9_exec_parse (allowed-single)
[332.357344] Starting subtest: allowed-single
[332.370521] Subtest allowed-single: SUCCESS (0.014s)
[332.661593] [060/156] (732s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[332.874264] Starting subtest: psrhdr-2p-primscrn-cur-indfb-draw-mmap-cpu
[332.880567] Subtest psrhdr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[333.026981] [061/156] (732s left) gem_exec_balancer (bonded-semaphore)
[333.165299] Starting subtest: bonded-semaphore
[337.450825] Subtest bonded-semaphore: SUCCESS (4.284s)
[337.730774] [062/156] (727s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping)
[337.930436] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping
[337.934329] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping: SKIP (0.000s)
[338.081757] [063/156] (727s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[338.296357] Starting subtest: fbc-rgb565-draw-mmap-wc
[341.074238] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (2.781s)
[341.414140] [064/156] (724s left) kms_pwrite_crc (basic)
[341.617701] Starting subtest: basic
[342.584160] Subtest basic: SUCCESS (0.968s)
[342.933909] [065/156] (722s left) gem_flink_basic (bad-flink)
[343.044532] Starting subtest: bad-flink
[343.046293] Subtest bad-flink: SUCCESS (0.000s)
[343.200527] [066/156] (722s left) kms_frontbuffer_tracking (hdr-2p-primscrn-spr-indfb-move)
[343.411433] Starting subtest: hdr-2p-primscrn-spr-indfb-move
[343.415437] Subtest hdr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[343.580019] [067/156] (722s left) gem_ctx_persistence (legacy-engines-persistence)
[343.697845] Starting subtest: legacy-engines-persistence
[343.700836] Starting dynamic subtest: render
[344.497568] Dynamic subtest render: SUCCESS (0.795s)
[344.528574] Starting dynamic subtest: bsd
[345.266901] Dynamic subtest bsd: SUCCESS (0.766s)
[345.302755] Starting dynamic subtest: blt
[346.035002] Dynamic subtest blt: SUCCESS (0.761s)
[346.069420] Starting dynamic subtest: vebox
[346.787076] Dynamic subtest vebox: SUCCESS (0.745s)
[346.788925] Subtest legacy-engines-persistence: SUCCESS (3.088s)
[346.948767] [068/156] (718s left) gen7_exec_parse (basic-allowed)
[347.070300] Subtest basic-allowed: SKIP (0.000s)
[347.205736] [069/156] (718s left) gem_exec_schedule (reorder-wide)
[347.480368] Starting subtest: reorder-wide
[347.482846] Starting dynamic subtest: rcs0
[347.654910] Dynamic subtest rcs0: SUCCESS (0.164s)
[347.704369] Starting dynamic subtest: bcs0
[347.975632] Dynamic subtest bcs0: SUCCESS (0.313s)
[348.017290] Starting dynamic subtest: vcs0
[348.133940] Dynamic subtest vcs0: SUCCESS (0.169s)
[348.174492] Starting dynamic subtest: vecs0
[348.305415] Dynamic subtest vecs0: SUCCESS (0.166s)
[348.309754] Subtest reorder-wide: SUCCESS (0.829s)
[348.612455] [070/156] (717s left) kms_frontbuffer_tracking (psrhdr-slowdraw)
[348.819082] Starting subtest: psrhdr-slowdraw
[348.824386] Subtest psrhdr-slowdraw: SKIP (0.000s)
[348.980969] [071/156] (717s left) perf (non-zero-reason)
[349.244242] Starting subtest: non-zero-reason
[349.247927] Starting dynamic subtest: 0-rcs0
[399.881390] Dynamic subtest 0-rcs0: SUCCESS (50.647s)
[399.884111] Subtest non-zero-reason: SUCCESS (50.650s)
[400.006867] [072/156] (666s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-spr-indfb-draw-pwrite)
[400.230652] Starting subtest: fbchdr-2p-primscrn-spr-indfb-draw-pwrite
[400.234463] Subtest fbchdr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[400.388959] [073/156] (666s left) i915_drm_fdinfo (all-busy-check-all)
[400.503676] Starting subtest: all-busy-check-all
[401.034171] Subtest all-busy-check-all: SUCCESS (0.528s)
[401.190526] [074/156] (665s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[401.394459] Starting subtest: psrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt
[401.399353] Subtest psrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[401.556573] [075/156] (665s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[401.752085] Starting subtest: compare-crc-sanitycheck-nv12
[401.754518] Starting dynamic subtest: pipe-A-HDMI-A-1
[402.743410] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.980s)
[402.779282] Starting dynamic subtest: pipe-B-HDMI-A-2
[403.461260] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.713s)
[403.499229] Starting dynamic subtest: pipe-C-HDMI-A-1
[404.149464] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.680s)
[404.154451] Subtest compare-crc-sanitycheck-nv12: SUCCESS (2.397s)
[404.479827] [076/156] (662s left) gem_exec_reloc (basic-write-gtt)
[404.606658] Starting subtest: basic-write-gtt
[404.629340] Subtest basic-write-gtt: SUCCESS (0.021s)
[404.878178] [077/156] (661s left) kms_cursor_crc (cursor-rapid-movement-max-size)
[405.104853] Starting subtest: cursor-rapid-movement-max-size
[405.112269] Subtest cursor-rapid-movement-max-size: SKIP (0.000s)
[405.274842] [078/156] (661s left) kms_color_pipeline (plane-lut1d)
[405.475221] Starting subtest: plane-lut1d
[407.408635] Subtest plane-lut1d: SKIP (1.922s)
[407.726653] [079/156] (659s left) kms_big_fb (yf-tiled-16bpp-rotate-180)
[407.934215] Starting subtest: yf-tiled-16bpp-rotate-180
[411.835822] Subtest yf-tiled-16bpp-rotate-180: SUCCESS (3.904s)
[412.224931] [080/156] (654s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0)
[412.443385] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0
[412.447540] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[412.637125] [081/156] (654s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[412.852851] Starting subtest: fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt
[412.856096] Subtest fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[413.006909] [082/156] (654s left) gem_exec_reloc (basic-wc-read)
[413.131647] Starting subtest: basic-wc-read
[413.144599] Subtest basic-wc-read: SUCCESS (0.016s)
[413.409301] [083/156] (654s left) kms_cursor_legacy (short-busy-flip-before-cursor-toggle)
[413.615929] Starting subtest: short-busy-flip-before-cursor-toggle
[413.619391] Subtest short-busy-flip-before-cursor-toggle: SKIP (0.001s)
[413.773564] [084/156] (653s left) kms_flip (2x-plain-flip-fb-recreate-interruptible)
[413.980392] Starting subtest: 2x-plain-flip-fb-recreate-interruptible
[413.988477] Starting dynamic subtest: AB-HDMI-A1-HDMI-A2
[425.125026] Dynamic subtest AB-HDMI-A1-HDMI-A2: SUCCESS (11.135s)
[425.161671] Starting dynamic subtest: AC-HDMI-A1-HDMI-A2
[436.217011] Dynamic subtest AC-HDMI-A1-HDMI-A2: SUCCESS (11.081s)
[436.254247] Starting dynamic subtest: BC-HDMI-A1-HDMI-A2
[447.279137] Dynamic subtest BC-HDMI-A1-HDMI-A2: SUCCESS (11.052s)
[447.282458] Subtest 2x-plain-flip-fb-recreate-interruptible: SUCCESS (33.300s)
[447.915962] [085/156] (619s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[448.127235] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[448.134263] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[448.290002] [086/156] (619s left) kms_draw_crc (draw-method-render)
[448.493208] Starting subtest: draw-method-render
[448.496618] Starting dynamic subtest: xrgb8888-untiled
[449.046074] Dynamic subtest xrgb8888-untiled: SUCCESS (0.556s)
[449.078045] Starting dynamic subtest: rgb565-untiled
[449.347119] Dynamic subtest rgb565-untiled: SUCCESS (0.295s)
[449.377612] Starting dynamic subtest: xrgb2101010-untiled
[449.665323] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.312s)
[449.694252] Starting dynamic subtest: xbgr16161616f-untiled
[450.014768] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.347s)
[450.048744] Starting dynamic subtest: xrgb8888-xtiled
[450.213531] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.194s)
[450.248802] Starting dynamic subtest: rgb565-xtiled
[450.412741] Dynamic subtest rgb565-xtiled: SUCCESS (0.197s)
[450.453419] Starting dynamic subtest: xrgb2101010-xtiled
[450.598072] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.178s)
[450.629716] Starting dynamic subtest: xbgr16161616f-xtiled
[450.798547] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.196s)
[450.830413] Starting dynamic subtest: xrgb8888-ytiled
[450.997664] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.195s)
[451.028909] Starting dynamic subtest: rgb565-ytiled
[451.196068] Dynamic subtest rgb565-ytiled: SUCCESS (0.194s)
[451.230422] Starting dynamic subtest: xrgb2101010-ytiled
[451.380748] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.178s)
[451.426326] Starting dynamic subtest: xbgr16161616f-ytiled
[451.596766] Dynamic subtest xbgr16161616f-ytiled: SUCCESS (0.213s)
[451.599256] Subtest draw-method-render: SUCCESS (3.109s)
[451.886172] [087/156] (616s left) kms_cursor_crc (cursor-sliding-256x85)
[452.087307] Starting subtest: cursor-sliding-256x85
[452.132116] Starting dynamic subtest: pipe-A-HDMI-A-1
[456.199529] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (4.064s)
[456.331284] Starting dynamic subtest: pipe-C-HDMI-A-1
[460.006161] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (3.733s)
[460.008267] Subtest cursor-sliding-256x85: SUCCESS (7.920s)
[460.397050] [088/156] (607s left) kms_cursor_crc (cursor-onscreen-256x256)
[460.619697] Starting subtest: cursor-onscreen-256x256
[460.700876] Starting dynamic subtest: pipe-A-HDMI-A-1
[463.429910] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.723s)
[463.550993] Starting dynamic subtest: pipe-C-HDMI-A-1
[465.911258] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.418s)
[465.914359] Subtest cursor-onscreen-256x256: SUCCESS (5.292s)
[466.317734] [089/156] (601s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-cur-indfb-draw-render)
[466.542508] Starting subtest: fbcpsrhdr-2p-scndscrn-cur-indfb-draw-render
[466.546944] Subtest fbcpsrhdr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[466.714462] [090/156] (601s left) kms_frontbuffer_tracking (fbcpsr-slowdraw)
[466.919885] Starting subtest: fbcpsr-slowdraw
[466.923985] Subtest fbcpsr-slowdraw: SKIP (0.000s)
[467.078065] [091/156] (601s left) kms_lease (cursor-implicit-plane)
[467.269439] Starting subtest: cursor-implicit-plane
[467.273110] Starting dynamic subtest: pipe-A-HDMI-A-1
[468.015168] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.739s)
[468.081775] Starting dynamic subtest: pipe-A-HDMI-A-2
[468.477013] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.449s)
[468.514650] Starting dynamic subtest: pipe-B-HDMI-A-1
[468.917527] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.429s)
[468.954440] Starting dynamic subtest: pipe-B-HDMI-A-2
[469.382251] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.456s)
[469.456635] Starting dynamic subtest: pipe-C-HDMI-A-1
[469.806360] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.424s)
[469.878716] Starting dynamic subtest: pipe-C-HDMI-A-2
[470.238131] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.420s)
[470.240309] Subtest cursor-implicit-plane: SUCCESS (2.971s)
[470.667069] [092/156] (597s left) syncobj_wait (invalid-reset-zero-handles)
[470.782561] Starting subtest: invalid-reset-zero-handles
[470.786545] Subtest invalid-reset-zero-handles: SUCCESS (0.000s)
[470.938657] [093/156] (597s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render)
[471.151545] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render
[473.279678] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SUCCESS (2.129s)
[473.533861] [094/156] (595s left) kms_big_fb (yf-tiled-64bpp-rotate-90)
[473.757840] Starting subtest: yf-tiled-64bpp-rotate-90
[473.766347] Subtest yf-tiled-64bpp-rotate-90: SKIP (0.000s)
[473.917601] [095/156] (594s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-spr-indfb-draw-mmap-wc)
[474.125413] Starting subtest: fbchdr-1p-primscrn-spr-indfb-draw-mmap-wc
[474.129589] Subtest fbchdr-1p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[474.292344] [096/156] (594s left) gem_exec_fence (long-history)
[474.844570] Starting subtest: long-history
[480.547531] Subtest long-history: SUCCESS (5.681s)
[481.171357] [097/156] (587s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-msflip-blt)
[481.390037] Starting subtest: psr-1p-primscrn-indfb-msflip-blt
[481.399596] Subtest psr-1p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[481.582172] [098/156] (587s left) kms_ccs (bad-rotation-90-yf-tiled-ccs)
[481.767759] Starting subtest: bad-rotation-90-yf-tiled-ccs
[481.772244] Starting dynamic subtest: pipe-A-HDMI-A-1
[481.914428] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.125s)
[481.977548] Starting dynamic subtest: pipe-A-HDMI-A-2
[482.007874] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.049s)
[482.069317] Starting dynamic subtest: pipe-B-HDMI-A-1
[482.105803] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.051s)
[482.169193] Starting dynamic subtest: pipe-B-HDMI-A-2
[482.189257] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.048s)
[482.218359] Starting dynamic subtest: pipe-C-HDMI-A-1
[482.239671] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[482.267407] Starting dynamic subtest: pipe-C-HDMI-A-2
[482.282414] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.000s)
[482.284020] Subtest bad-rotation-90-yf-tiled-ccs: SUCCESS (0.304s)
[483.149167] [099/156] (586s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[483.356506] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[490.528679] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (7.174s)
[490.981362] [100/156] (578s left) kms_chamelium_audio (dp-audio-edid)
[491.571109] Subtest dp-audio-edid: SKIP (0.000s)
[492.002126] [101/156] (577s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[492.210398] Starting subtest: addfb25-yf-tiled-legacy
[492.212449] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[492.380255] [102/156] (577s left) kms_frontbuffer_tracking (hdr-1p-primscrn-indfb-pgflip-blt)
[492.583367] Starting subtest: hdr-1p-primscrn-indfb-pgflip-blt
[492.589218] Subtest hdr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[492.733488] [103/156] (576s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-onoff)
[492.950484] Starting subtest: psr-2p-primscrn-cur-indfb-onoff
[492.956512] Subtest psr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[493.117591] [104/156] (576s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw)
[493.332495] Starting subtest: fbc-2p-pri-indfb-multidraw
[510.152879] Subtest fbc-2p-pri-indfb-multidraw: SUCCESS (16.826s)
[510.376605] [105/156] (559s left) kms_sequence (queue-busy)
[510.574690] Starting subtest: queue-busy
[510.578387] Starting dynamic subtest: pipe-A-HDMI-A-1
[513.468593] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.895s)
[513.512515] Starting dynamic subtest: pipe-A-HDMI-A-2
[516.193951] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.718s)
[516.255755] Starting dynamic subtest: pipe-B-HDMI-A-1
[518.853617] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.648s)
[518.910396] Starting dynamic subtest: pipe-B-HDMI-A-2
[521.462213] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (2.608s)
[521.525380] Starting dynamic subtest: pipe-C-HDMI-A-1
[524.082572] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.613s)
[524.136425] Starting dynamic subtest: pipe-C-HDMI-A-2
[526.759556] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.664s)
[526.762646] Subtest queue-busy: SUCCESS (16.184s)
[527.100513] [106/156] (542s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[527.299328] Starting subtest: plane-upscale-20x20-with-rotation
[527.302578] Starting dynamic subtest: pipe-A
[533.074440] Dynamic subtest pipe-A: SKIP (5.768s)
[533.130511] Starting dynamic subtest: pipe-B
[539.999435] Dynamic subtest pipe-B: SKIP (6.919s)
[540.055477] Starting dynamic subtest: pipe-C
[546.801556] Dynamic subtest pipe-C: SKIP (6.796s)
[546.806728] Subtest plane-upscale-20x20-with-rotation: SKIP (19.493s)
[547.399638] [107/156] (522s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-indfb-draw-pwrite)
[547.658570] Starting subtest: psrhdr-1p-primscrn-pri-indfb-draw-pwrite
[547.665491] Subtest psrhdr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[547.817151] [108/156] (522s left) gem_exec_reloc (basic-write-wc)
[547.948964] Starting subtest: basic-write-wc
[547.967731] Subtest basic-write-wc: SUCCESS (0.022s)
[548.246111] [109/156] (522s left) syncobj_timeline (reset-signaled)
[548.365287] Starting subtest: reset-signaled
[548.367167] Subtest reset-signaled: SUCCESS (0.001s)
[548.535676] [110/156] (521s left) kms_psr (pr-cursor-plane-move)
[548.741657] Subtest pr-cursor-plane-move: SKIP (0.000s)
[548.859290] [111/156] (521s left) syncobj_wait (invalid-wait-illegal-handle)
[548.970831] Starting subtest: invalid-wait-illegal-handle
[548.973610] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s)
[549.133531] [112/156] (521s left) kms_busy (extended-pageflip-modeset-hang-oldfb)
[549.348280] Starting subtest: extended-pageflip-modeset-hang-oldfb
[549.351737] Starting dynamic subtest: pipe-A
[553.315984] Dynamic subtest pipe-A: SUCCESS (3.961s)
[553.380547] Starting dynamic subtest: pipe-C
[557.273898] Dynamic subtest pipe-C: SUCCESS (3.944s)
[557.276263] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (7.928s)
[557.732423] [113/156] (512s left) kms_psr (psr2-primary-blt)
[557.937771] Subtest psr2-primary-blt: SKIP (0.000s)
[558.069164] [114/156] (512s left) gem_softpin (evict-snoop-interruptible)
[558.202763] Starting subtest: evict-snoop-interruptible
[558.207202] Subtest evict-snoop-interruptible: SKIP (0.000s)
[558.377786] [115/156] (512s left) kms_force_connector_basic (force-load-detect)
[558.635285] Starting subtest: force-load-detect
[558.642663] Subtest force-load-detect: SKIP (0.000s)
[559.042425] [116/156] (511s left) kms_chamelium_edid (hdmi-mode-timings)
[559.659489] Subtest hdmi-mode-timings: SKIP (0.000s)
[560.075012] [117/156] (511s left) syncobj_timeline (invalid-signal-zero-handles)
[560.193688] Starting subtest: invalid-signal-zero-handles
[560.196061] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[560.384639] [118/156] (510s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-indfb-fliptrack-mmap-gtt)
[560.591948] Starting subtest: fbcpsrhdr-1p-indfb-fliptrack-mmap-gtt
[560.595624] Subtest fbcpsrhdr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[560.769724] [119/156] (510s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[560.988453] Starting subtest: fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[560.992323] Subtest fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[561.155446] [120/156] (510s left) gem_mmap_gtt (fault-concurrent-x)
[561.266277] Starting subtest: fault-concurrent-X
[564.493289] Subtest fault-concurrent-X: SUCCESS (3.228s)
[564.658456] [121/156] (506s left) gem_render_copy (y-tiled-to-vebox-y-tiled)
[564.781534] Starting subtest: y-tiled-to-vebox-y-tiled
[564.785050] Subtest y-tiled-to-vebox-y-tiled: SKIP (0.000s)
[565.056587] [122/156] (506s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-shrfb-plflip-blt)
[565.260463] Starting subtest: psrhdr-2p-scndscrn-shrfb-plflip-blt
[565.263867] Subtest psrhdr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[565.425336] [123/156] (506s left) vgem_basic (debugfs)
[565.558250] Starting subtest: debugfs
[565.560382] Subtest debugfs: SUCCESS (0.001s)
[565.693629] [124/156] (506s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[565.885528] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling
[565.887298] Starting dynamic subtest: pipe-A-valid-mode
[566.907962] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.016s)
[566.909984] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SUCCESS (1.023s)
[567.331682] [125/156] (504s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite)
[567.550889] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite
[571.028686] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (3.477s)
[571.271489] [126/156] (500s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[571.521440] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu
[571.525617] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[571.687670] [127/156] (500s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-blt)
[571.905509] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-blt
[571.909865] Subtest psr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[572.083508] [128/156] (500s left) kms_vblank (wait-forked-hang)
[572.277474] Starting subtest: wait-forked-hang
[572.279314] Starting dynamic subtest: pipe-A-HDMI-A-1
[579.317935] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (7.034s)
[579.377685] Starting dynamic subtest: pipe-A-HDMI-A-2
[586.364310] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (7.035s)
[586.404291] Starting dynamic subtest: pipe-C-HDMI-A-1
[593.309496] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (6.931s)
[593.346666] Starting dynamic subtest: pipe-C-HDMI-A-2
[600.288957] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (6.978s)
[600.295785] Subtest wait-forked-hang: SUCCESS (28.020s)
[600.746675] [129/156] (471s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-downscaling)
[600.940708] Starting subtest: flip-32bpp-linear-to-64bpp-linear-downscaling
[600.943928] Starting dynamic subtest: pipe-A-valid-mode
[601.902771] Dynamic subtest pipe-A-valid-mode: SKIP (0.952s)
[601.906433] Subtest flip-32bpp-linear-to-64bpp-linear-downscaling: SKIP (0.959s)
[602.443397] [130/156] (470s left) gem_ctx_exec (basic-invalid-context)
[602.559392] Starting subtest: basic-invalid-context
[602.569133] Subtest basic-invalid-context: SUCCESS (0.006s)
[602.775518] [131/156] (469s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-indfb-msflip-blt)
[602.992418] Starting subtest: fbcpsrhdr-1p-primscrn-indfb-msflip-blt
[602.997376] Subtest fbcpsrhdr-1p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[603.149139] [132/156] (469s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[603.340241] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (0.000s)
[603.468170] [133/156] (469s left) gem_ppgtt (blt-vs-render-ctxn)
[603.589327] Starting subtest: blt-vs-render-ctxN
[636.603783] Subtest blt-vs-render-ctxN: SUCCESS (33.015s)
[636.785334] [134/156] (436s left) gem_exec_reloc (basic-gtt-cpu-noreloc)
[637.039319] Starting subtest: basic-gtt-cpu-noreloc
[637.049377] Subtest basic-gtt-cpu-noreloc: SUCCESS (0.009s)
[637.320417] [135/156] (435s left) gem_softpin (invalid)
[637.439604] Starting subtest: invalid
[637.455046] Subtest invalid: SUCCESS (0.014s)
[637.656542] [136/156] (435s left) gem_exec_capture (capture)
[637.782030] Starting subtest: capture
[637.783697] Starting dynamic subtest: rcs0-smem
[639.083627] Dynamic subtest rcs0-smem: SUCCESS (1.296s)
[639.121987] Starting dynamic subtest: bcs0-smem
[640.364793] Dynamic subtest bcs0-smem: SUCCESS (1.279s)
[640.397477] Starting dynamic subtest: vcs0-smem
[641.644505] Dynamic subtest vcs0-smem: SUCCESS (1.279s)
[641.676020] Starting dynamic subtest: vecs0-smem
[642.935492] Dynamic subtest vecs0-smem: SUCCESS (1.282s)
[642.937772] Subtest capture: SUCCESS (5.151s)
[643.121338] [137/156] (430s left) gem_tiled_blits (basic)
[643.343692] Starting subtest: basic
[643.376285] Subtest basic: SUCCESS (0.039s)
[643.577124] [138/156] (429s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt)
[643.940730] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt
[643.945412] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[644.108135] [139/156] (429s left) gem_mmap_offset (partial-remap)
[644.222704] Starting subtest: partial-remap
[644.224680] Starting dynamic subtest: smem0
[644.237538] Dynamic subtest smem0: SUCCESS (0.009s)
[644.239324] Subtest partial-remap: SUCCESS (0.013s)
[644.392222] [140/156] (429s left) kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-shrfb-draw-blt)
[644.595930] Starting subtest: fbchdr-1p-offscreen-pri-shrfb-draw-blt
[644.600318] Subtest fbchdr-1p-offscreen-pri-shrfb-draw-blt: SKIP (0.000s)
[644.756108] [141/156] (428s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-cur-indfb-draw-blt)
[644.951634] Starting subtest: hdr-2p-scndscrn-cur-indfb-draw-blt
[644.956262] Subtest hdr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[645.110784] [142/156] (428s left) i915_power (sanity)
[645.221936] Starting subtest: sanity
[649.253029] Subtest sanity: SUCCESS (4.027s)
[649.412828] [143/156] (424s left) gem_exec_schedule (preempt-queue)
[649.572155] Starting subtest: preempt-queue
[649.576081] Starting dynamic subtest: rcs0
[649.873413] Dynamic subtest rcs0: SUCCESS (0.297s)
[649.913602] Starting dynamic subtest: bcs0
[650.166663] Dynamic subtest bcs0: SUCCESS (0.283s)
[650.211799] Starting dynamic subtest: vcs0
[650.455969] Dynamic subtest vcs0: SUCCESS (0.291s)
[650.494922] Starting dynamic subtest: vecs0
[650.744973] Dynamic subtest vecs0: SUCCESS (0.286s)
[650.752023] Subtest preempt-queue: SUCCESS (1.172s)
[651.159570] [144/156] (422s left) kms_cursor_legacy (cursorb-vs-flipa-legacy)
[651.350241] Starting subtest: cursorB-vs-flipA-legacy
[662.731239] Subtest cursorB-vs-flipA-legacy: SUCCESS (11.378s)
[663.158360] [145/156] (411s left) i915_pm_rps (reset)
[663.280093] Starting subtest: reset
[667.867273] Subtest reset: SUCCESS (4.587s)
[668.049097] [146/156] (406s left) kms_psr (fbc-psr-cursor-plane-onoff)
[668.250360] Subtest fbc-psr-cursor-plane-onoff: SKIP (0.000s)
[668.393721] [147/156] (405s left) kms_setmode (clone-exclusive-crtc)
[668.505362] Starting subtest: clone-exclusive-crtc
[669.029278] Starting dynamic subtest: pipe-A-HDMI-A-1-pipe-B-HDMI-A-2
[669.371379] Dynamic subtest pipe-A-HDMI-A-1-pipe-B-HDMI-A-2: SUCCESS (0.340s)
[669.889008] Starting dynamic subtest: pipe-B-HDMI-A-1-pipe-A-HDMI-A-2
[670.170364] Dynamic subtest pipe-B-HDMI-A-1-pipe-A-HDMI-A-2: SUCCESS (0.303s)
[670.618041] Subtest clone-exclusive-crtc: SUCCESS (2.109s)
[670.956054] [148/156] (403s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[671.176754] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu
[671.181374] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[671.336128] [149/156] (403s left) kms_flip (flip-vs-rmfb)
[671.525406] Starting subtest: flip-vs-rmfb
[671.528255] Starting dynamic subtest: A-HDMI-A1
[677.250792] Dynamic subtest A-HDMI-A1: SUCCESS (5.726s)
[677.286014] Starting dynamic subtest: B-HDMI-A1
[682.711796] Dynamic subtest B-HDMI-A1: SUCCESS (5.454s)
[682.745768] Starting dynamic subtest: C-HDMI-A1
[688.138475] Dynamic subtest C-HDMI-A1: SUCCESS (5.421s)
[688.173249] Starting dynamic subtest: A-HDMI-A2
[693.597937] Dynamic subtest A-HDMI-A2: SUCCESS (5.453s)
[693.627674] Starting dynamic subtest: B-HDMI-A2
[699.034932] Dynamic subtest B-HDMI-A2: SUCCESS (5.433s)
[699.068529] Starting dynamic subtest: C-HDMI-A2
[704.465356] Dynamic subtest C-HDMI-A2: SUCCESS (5.422s)
[704.467460] Subtest flip-vs-rmfb: SUCCESS (32.952s)
[705.017890] [150/156] (369s left) gem_exec_whisper (basic-contexts-all)
[705.157349] Starting subtest: basic-contexts-all
[717.074318] Subtest basic-contexts-all: SUCCESS (11.915s)
[717.368172] [151/156] (357s left) dmabuf_sync_file (export-basic)
[717.485414] Starting subtest: export-basic
[717.490809] Subtest export-basic: SUCCESS (0.003s)
[717.631440] [152/156] (357s left) kms_frontbuffer_tracking (hdr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[717.843206] Starting subtest: hdr-2p-primscrn-cur-indfb-draw-mmap-cpu
[717.849331] Subtest hdr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[718.019135] [153/156] (357s left) gem_sync (basic-each)
[718.163283] Starting subtest: basic-each
[720.703126] Subtest basic-each: SUCCESS (2.541s)
[720.987900] [154/156] (354s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs-cc)
[721.173517] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs-cc
[721.175509] Starting dynamic subtest: pipe-A-HDMI-A-1
[721.202353] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[721.267756] Starting dynamic subtest: pipe-A-HDMI-A-2
[721.305782] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.000s)
[721.340799] Starting dynamic subtest: pipe-B-HDMI-A-1
[721.360640] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[721.400873] Starting dynamic subtest: pipe-B-HDMI-A-2
[721.426994] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.001s)
[721.515492] Starting dynamic subtest: pipe-C-HDMI-A-1
[721.532173] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[721.560119] Starting dynamic subtest: pipe-C-HDMI-A-2
[721.576676] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.000s)
[721.579806] Subtest random-ccs-data-4-tiled-dg2-rc-ccs-cc: SKIP (0.035s)
[722.312132] [155/156] (352s left) syncobj_wait (multi-wait-for-submit-submitted)
[722.427414] Starting subtest: multi-wait-for-submit-submitted
[722.531619] Subtest multi-wait-for-submit-submitted: SUCCESS (0.107s)
[722.691173] [156/156] (352s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-gtt)
[722.903925] Starting subtest: fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-gtt
[722.907428] Subtest fbcpsrhdr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.001s)
[723.067941] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_pipe_b_c_ivb
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: kms_force_connector_basic
results: parsing output: 5/ for test: perf_pmu
results: parsing output: 6/ for test: gem_ccs
results: parsing output: 7/ for test: kms_plane_alpha_blend
results: parsing output: 8/ for test: gem_mmap_gtt
results: parsing output: 9/ for test: api_intel_allocator
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_plane
results: parsing output: 12/ for test: kms_ccs
results: parsing output: 13/ for test: kms_ccs
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_pm_rpm
results: parsing output: 16/ for test: gem_render_copy
results: parsing output: 17/ for test: sysfs_heartbeat_interval
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: gem_ctx_param
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: i915_pm_freq_mult
results: parsing output: 22/ for test: prime_busy
results: parsing output: 23/ for test: gem_exec_gttfill
results: parsing output: 24/ for test: syncobj_timeline
results: parsing output: 25/ for test: gem_ctx_param
results: parsing output: 26/ for test: kms_big_fb
results: parsing output: 27/ for test: gem_lmem_swapping
results: parsing output: 28/ for test: gem_ctx_shared
results: parsing output: 29/ for test: kms_psr
results: parsing output: 30/ for test: gem_bad_reloc
results: parsing output: 31/ for test: kms_chamelium_hpd
results: parsing output: 32/ for test: kms_psr2_sf
results: parsing output: 33/ for test: gem_eio
results: parsing output: 34/ for test: kms_content_protection
results: parsing output: 35/ for test: syncobj_wait
results: parsing output: 36/ for test: gem_ctx_isolation
results: parsing output: 37/ for test: gem_flink_basic
results: parsing output: 38/ for test: gem_caching
results: parsing output: 39/ for test: kms_plane_scaling
results: parsing output: 40/ for test: syncobj_timeline
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_pm_rpm
results: parsing output: 43/ for test: kms_atomic_transition
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: gem_spin_batch
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: syncobj_basic
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_big_fb
results: parsing output: 50/ for test: syncobj_timeline
results: parsing output: 51/ for test: api_intel_bb
results: parsing output: 52/ for test: kms_atomic_interruptible
results: parsing output: 53/ for test: kms_big_fb
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_flip_scaled_crc
results: parsing output: 56/ for test: gem_pxp
results: parsing output: 57/ for test: gem_fence_thrash
results: parsing output: 58/ for test: gen9_exec_parse
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: gem_exec_balancer
results: parsing output: 61/ for test: kms_plane
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_pwrite_crc
results: parsing output: 64/ for test: gem_flink_basic
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: gem_ctx_persistence
results: parsing output: 67/ for test: gen7_exec_parse
results: parsing output: 68/ for test: gem_exec_schedule
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: perf
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: i915_drm_fdinfo
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_pipe_crc_basic
results: parsing output: 75/ for test: gem_exec_reloc
results: parsing output: 76/ for test: kms_cursor_crc
results: parsing output: 77/ for test: kms_color_pipeline
results: parsing output: 78/ for test: kms_big_fb
results: parsing output: 79/ for test: kms_big_fb
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: gem_exec_reloc
results: parsing output: 82/ for test: kms_cursor_legacy
results: parsing output: 83/ for test: kms_flip
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_draw_crc
results: parsing output: 86/ for test: kms_cursor_crc
results: parsing output: 87/ for test: kms_cursor_crc
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_lease
results: parsing output: 91/ for test: syncobj_wait
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: gem_exec_fence
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_ccs
results: parsing output: 98/ for test: kms_cursor_legacy
results: parsing output: 99/ for test: kms_chamelium_audio
results: parsing output: 100/ for test: kms_addfb_basic
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: kms_sequence
results: parsing output: 105/ for test: kms_plane_scaling
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: gem_exec_reloc
results: parsing output: 108/ for test: syncobj_timeline
results: parsing output: 109/ for test: kms_psr
results: parsing output: 110/ for test: syncobj_wait
results: parsing output: 111/ for test: kms_busy
results: parsing output: 112/ for test: kms_psr
results: parsing output: 113/ for test: gem_softpin
results: parsing output: 114/ for test: kms_force_connector_basic
results: parsing output: 115/ for test: kms_chamelium_edid
results: parsing output: 116/ for test: syncobj_timeline
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: gem_mmap_gtt
results: parsing output: 120/ for test: gem_render_copy
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: vgem_basic
results: parsing output: 123/ for test: kms_flip_scaled_crc
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: kms_vblank
results: parsing output: 128/ for test: kms_flip_scaled_crc
results: parsing output: 129/ for test: gem_ctx_exec
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: kms_psr2_sf
results: parsing output: 132/ for test: gem_ppgtt
results: parsing output: 133/ for test: gem_exec_reloc
results: parsing output: 134/ for test: gem_softpin
results: parsing output: 135/ for test: gem_exec_capture
results: parsing output: 136/ for test: gem_tiled_blits
results: parsing output: 137/ for test: kms_frontbuffer_tracking
results: parsing output: 138/ for test: gem_mmap_offset
results: parsing output: 139/ for test: kms_frontbuffer_tracking
results: parsing output: 140/ for test: kms_frontbuffer_tracking
results: parsing output: 141/ for test: i915_power
results: parsing output: 142/ for test: gem_exec_schedule
results: parsing output: 143/ for test: kms_cursor_legacy
results: parsing output: 144/ for test: i915_pm_rps
results: parsing output: 145/ for test: kms_psr
results: parsing output: 146/ for test: kms_setmode
results: parsing output: 147/ for test: kms_frontbuffer_tracking
results: parsing output: 148/ for test: kms_flip
results: parsing output: 149/ for test: gem_exec_whisper
results: parsing output: 150/ for test: dmabuf_sync_file
results: parsing output: 151/ for test: kms_frontbuffer_tracking
results: parsing output: 152/ for test: gem_sync
results: parsing output: 153/ for test: kms_ccs
results: parsing output: 154/ for test: syncobj_wait
results: parsing output: 155/ for test: kms_frontbuffer_tracking
Done.