[60.372762] Initializing watchdogs [60.372809] /dev/watchdog0 [60.386196] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [60.391084] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [60.393560] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [60.396815] [001/132] (960s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc) [60.516870] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc [60.519273] Starting dynamic subtest: pipe-A-eDP-1 [60.541963] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [60.550767] Starting dynamic subtest: pipe-B-eDP-1 [60.572109] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [60.579175] Starting dynamic subtest: pipe-C-eDP-1 [60.601596] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [60.610862] Starting dynamic subtest: pipe-D-eDP-1 [60.632737] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [60.637161] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.003s) [62.778027] [002/132] (958s left) kms_chamelium_hpd (dp-hpd-with-enabled-mode) [63.158279] Subtest dp-hpd-with-enabled-mode: SKIP (0.000s) [63.983943] [003/132] (956s left) gem_mmap_gtt (big-copy) [64.055131] Subtest big-copy: SKIP (0.000s) [64.099154] [004/132] (956s left) gem_userptr_blits (map-fixed-invalidate-overlap) [64.161566] Starting subtest: map-fixed-invalidate-overlap [64.165984] Subtest map-fixed-invalidate-overlap: SKIP (0.000s) [64.282374] [005/132] (956s left) perf (blocking-parameterized) [64.406328] Starting subtest: blocking-parameterized [84.430028] Subtest blocking-parameterized: SUCCESS (20.023s) [84.477390] [006/132] (936s left) gem_exec_balancer (parallel-keep-submit-fence) [84.732842] Starting subtest: parallel-keep-submit-fence [85.850335] Subtest parallel-keep-submit-fence: SUCCESS (1.118s) [85.957717] [007/132] (935s left) kms_psr2_sf (psr2-cursor-plane-update-sf) [86.055970] Starting subtest: psr2-cursor-plane-update-sf [86.058378] Starting dynamic subtest: pipe-A-eDP-1 [86.610751] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.562s) [86.620060] Starting dynamic subtest: pipe-B-eDP-1 [87.906817] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.292s) [87.908752] Subtest psr2-cursor-plane-update-sf: SUCCESS (1.856s) [88.761240] [008/132] (932s left) kms_plane (pixel-format-x-tiled-modifier) [88.852240] Starting subtest: pixel-format-x-tiled-modifier [88.880626] Starting dynamic subtest: pipe-A-plane-0 [89.503359] Dynamic subtest pipe-A-plane-0: SUCCESS (0.622s) [89.512916] Starting dynamic subtest: pipe-A-plane-3 [89.891113] Dynamic subtest pipe-A-plane-3: SUCCESS (0.388s) [89.901496] Starting dynamic subtest: pipe-A-plane-5 [89.905094] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [90.963999] Starting dynamic subtest: pipe-B-plane-0 [91.602755] Dynamic subtest pipe-B-plane-0: SUCCESS (0.644s) [91.611216] Starting dynamic subtest: pipe-B-plane-3 [91.980093] Dynamic subtest pipe-B-plane-3: SUCCESS (0.377s) [91.987174] Starting dynamic subtest: pipe-B-plane-5 [91.990691] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [92.307008] Subtest pixel-format-x-tiled-modifier: SUCCESS (3.455s) [93.143099] [009/132] (928s left) syncobj_wait (multi-wait-all-for-submit-signaled) [93.198084] Starting subtest: multi-wait-all-for-submit-signaled [93.200393] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.000s) [93.314577] [010/132] (927s left) kms_flip (modeset-vs-vblank-race-interruptible) [93.407998] Starting subtest: modeset-vs-vblank-race-interruptible [93.410295] Starting dynamic subtest: A-eDP1 [98.184545] Dynamic subtest A-eDP1: SUCCESS (4.777s) [98.192968] Starting dynamic subtest: B-eDP1 [102.814323] Dynamic subtest B-eDP1: SUCCESS (4.629s) [102.824772] Starting dynamic subtest: C-eDP1 [107.329812] Dynamic subtest C-eDP1: SUCCESS (4.514s) [107.339557] Starting dynamic subtest: D-eDP1 [111.870659] Dynamic subtest D-eDP1: SUCCESS (4.539s) [111.872831] Subtest modeset-vs-vblank-race-interruptible: SUCCESS (18.468s) [113.042013] [011/132] (908s left) gem_ctx_persistence (legacy-engines-queued) [113.094104] Starting subtest: legacy-engines-queued [113.096557] Starting dynamic subtest: render [113.165283] Dynamic subtest render: SUCCESS (0.070s) [113.175895] Starting dynamic subtest: bsd1 [114.869500] Dynamic subtest bsd1: SUCCESS (1.701s) [114.879873] Starting dynamic subtest: bsd2 [116.852765] Dynamic subtest bsd2: SUCCESS (1.981s) [116.866658] Starting dynamic subtest: blt [116.915998] Dynamic subtest blt: SUCCESS (0.062s) [116.925656] Starting dynamic subtest: vebox [118.899778] Dynamic subtest vebox: SUCCESS (1.980s) [118.902679] Subtest legacy-engines-queued: SUCCESS (5.805s) [118.975030] [012/132] (902s left) kms_big_fb (x-tiled-16bpp-rotate-270) [119.080409] Starting subtest: x-tiled-16bpp-rotate-270 [119.099500] Subtest x-tiled-16bpp-rotate-270: SKIP (0.019s) [119.199840] [013/132] (902s left) kms_cdclk (plane-scaling) [119.286726] Starting subtest: plane-scaling [119.288904] Starting dynamic subtest: pipe-A-eDP-1 [119.581269] Dynamic subtest pipe-A-eDP-1: SKIP (0.293s) [119.589557] Starting dynamic subtest: pipe-B-eDP-1 [119.594149] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [119.601796] Starting dynamic subtest: pipe-C-eDP-1 [119.606383] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [119.613810] Starting dynamic subtest: pipe-D-eDP-1 [119.618269] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [119.622724] Subtest plane-scaling: SKIP (0.300s) [120.374452] [014/132] (901s left) kms_big_fb (4-tiled-32bpp-rotate-270) [120.470318] Starting subtest: 4-tiled-32bpp-rotate-270 [120.490354] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.020s) [120.594654] [015/132] (900s left) gem_exec_reloc (basic-cpu) [120.650433] Subtest basic-cpu: SKIP (0.000s) [120.708653] [016/132] (900s left) kms_big_fb (y-tiled-64bpp-rotate-90) [120.816639] Starting subtest: y-tiled-64bpp-rotate-90 [120.821309] Subtest y-tiled-64bpp-rotate-90: SKIP (0.000s) [120.912275] [017/132] (900s left) gem_exec_fence (basic-wait-all) [120.975742] Starting subtest: basic-wait-all [121.059082] Subtest basic-wait-all: SUCCESS (0.084s) [122.982480] [FACT gem_exec_fence (basic-wait-all)] new: kernel.kmod_is_loaded.vgem: true [122.985989] [018/132] (898s left) api_intel_bb (simple-bb) [123.056097] Starting subtest: simple-bb [123.060658] Subtest simple-bb: SUCCESS (0.005s) [123.209955] [019/132] (898s left) syncobj_timeline (multi-wait-for-submit-signaled) [123.269998] Starting subtest: multi-wait-for-submit-signaled [123.272372] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s) [123.368617] [020/132] (898s left) gem_exec_reloc (basic-softpin) [123.437121] Subtest basic-softpin: SKIP (0.000s) [123.509898] [021/132] (898s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu) [123.608570] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu [123.612748] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [123.716129] [022/132] (898s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-blt) [123.821178] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-blt [127.943656] Subtest fbc-1p-offscreen-pri-indfb-draw-blt: SUCCESS (4.126s) [129.081090] [023/132] (892s left) kms_psr (psr-sprite-mmap-cpu) [129.172392] Starting subtest: psr-sprite-mmap-cpu [129.181512] Starting dynamic subtest: eDP-1 [130.896437] Dynamic subtest eDP-1: SUCCESS (1.722s) [130.898731] Subtest psr-sprite-mmap-cpu: SUCCESS (1.724s) [131.727219] [024/132] (890s left) gem_exec_whisper (basic-fds-priority-all) [131.784667] Starting subtest: basic-fds-priority-all [153.912275] Subtest basic-fds-priority-all: SUCCESS (22.122s) [154.091597] [025/132] (867s left) kms_psr (pr-sprite-render) [154.188896] Starting subtest: pr-sprite-render [154.193144] Subtest pr-sprite-render: SKIP (0.000s) [154.265649] [026/132] (867s left) syncobj_wait (multi-wait-signaled) [154.329321] Starting subtest: multi-wait-signaled [154.331578] Subtest multi-wait-signaled: SUCCESS (0.000s) [154.412405] [027/132] (867s left) gem_set_tiling_vs_blt (untiled-to-tiled) [154.471300] Subtest untiled-to-tiled: SKIP (0.000s) [154.529159] [028/132] (867s left) kms_big_fb (linear-32bpp-rotate-180) [154.626343] Starting subtest: linear-32bpp-rotate-180 [156.172976] Subtest linear-32bpp-rotate-180: SUCCESS (1.547s) [156.301429] [029/132] (865s left) gem_exec_balancer (nop) [156.373454] Starting subtest: nop [202.983834] Subtest nop: SUCCESS (46.605s) [203.344048] [030/132] (818s left) kms_frontbuffer_tracking (fbc-shrfb-scaledprimary) [203.447343] Starting subtest: fbc-shrfb-scaledprimary [206.443334] Subtest fbc-shrfb-scaledprimary: SUCCESS (2.998s) [207.627554] [031/132] (814s left) gem_mmap_gtt (fault-concurrent) [207.692145] Subtest fault-concurrent: SKIP (0.000s) [207.754715] [032/132] (814s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip) [207.865614] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip [207.870252] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s) [207.968860] [033/132] (814s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc) [208.073356] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc [208.077735] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [208.165644] [034/132] (814s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs) [208.258880] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs [208.263618] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s) [209.351979] [035/132] (812s left) kms_dsc (dsc-with-output-formats) [209.451103] Starting subtest: dsc-with-output-formats [209.472812] Subtest dsc-with-output-formats: SKIP (0.000s) [209.520498] [036/132] (812s left) syncobj_timeline (single-wait-for-submit-available-signaled) [209.580935] Starting subtest: single-wait-for-submit-available-signaled [209.583185] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s) [209.690717] [037/132] (812s left) kms_addfb_basic (addfb25-modifier-no-flag) [209.778759] Starting subtest: addfb25-modifier-no-flag [209.780879] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [209.887875] [038/132] (812s left) kms_pm_rpm (modeset-non-lpsp-stress) [212.115466] Starting subtest: modeset-non-lpsp-stress [213.273865] Subtest modeset-non-lpsp-stress: SKIP (1.156s) [213.662791] [039/132] (808s left) kms_psr (psr2-sprite-render) [213.761881] Starting subtest: psr2-sprite-render [213.764226] Starting dynamic subtest: eDP-1 [215.446457] Dynamic subtest eDP-1: SUCCESS (1.683s) [215.448479] Subtest psr2-sprite-render: SUCCESS (1.684s) [216.307504] [040/132] (806s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move) [216.399530] Starting subtest: psr-2p-scndscrn-cur-indfb-move [216.403942] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s) [216.508269] [041/132] (805s left) kms_draw_crc (fill-fb) [216.603881] Starting subtest: fill-fb [217.044155] Subtest fill-fb: SUCCESS (0.441s) [217.147685] [042/132] (805s left) gem_exec_schedule (fairslice-all) [217.226511] Starting subtest: fairslice-all [219.284225] Subtest fairslice-all: SUCCESS (2.059s) [220.955037] [043/132] (801s left) kms_vblank (query-busy) [221.057838] Starting subtest: query-busy [221.060200] Starting dynamic subtest: pipe-A-eDP-1 [222.939082] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.878s) [222.952095] Starting dynamic subtest: pipe-D-eDP-1 [225.495398] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.554s) [225.497694] Subtest query-busy: SUCCESS (4.436s) [226.287477] [044/132] (796s left) kms_cursor_crc (cursor-rapid-movement-256x256) [226.528782] Starting subtest: cursor-rapid-movement-256x256 [226.534143] Starting dynamic subtest: pipe-A-eDP-1 [227.075148] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.542s) [227.123503] Starting dynamic subtest: pipe-D-eDP-1 [228.278490] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.160s) [228.280505] Subtest cursor-rapid-movement-256x256: SUCCESS (1.747s) [229.139215] [045/132] (793s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-pgflip-blt) [229.227658] Starting subtest: fbc-2p-scndscrn-shrfb-pgflip-blt [229.232088] Subtest fbc-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [229.340056] [046/132] (793s left) kms_frontbuffer_tracking (psr-1p-pri-indfb-multidraw) [229.430267] Starting subtest: psr-1p-pri-indfb-multidraw [252.127293] Subtest psr-1p-pri-indfb-multidraw: SUCCESS (22.700s) [252.242041] [047/132] (770s left) gem_tiled_swapping (non-threaded) [252.291302] Subtest non-threaded: SKIP (0.000s) [252.343537] [048/132] (770s left) i915_drm_fdinfo (virtual-busy-all) [252.379666] Starting subtest: virtual-busy-all [252.383498] Subtest virtual-busy-all: SKIP (0.000s) [252.462223] [049/132] (770s left) kms_hdr (invalid-hdr) [252.549128] Starting subtest: invalid-hdr [254.689741] Starting dynamic subtest: pipe-A-eDP-1 [257.652331] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.963s) [257.654744] Subtest invalid-hdr: SUCCESS (5.104s) [257.758648] [050/132] (765s left) api_intel_allocator (alloc-simple) [257.812771] Starting subtest: alloc-simple [257.815161] Subtest alloc-simple: SUCCESS (0.003s) [257.941034] [051/132] (764s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled) [257.995479] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [257.997761] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [258.089561] [052/132] (764s left) kms_chamelium_frames (dp-crc-fast) [258.468891] Subtest dp-crc-fast: SKIP (0.000s) [259.300717] [053/132] (763s left) gem_ctx_shared (exec-single-timeline) [259.367838] Starting subtest: exec-single-timeline [259.370220] Starting dynamic subtest: rcs0 [260.401886] Dynamic subtest rcs0: SUCCESS (1.032s) [260.413380] Starting dynamic subtest: bcs0 [261.490183] Dynamic subtest bcs0: SUCCESS (1.086s) [261.503451] Starting dynamic subtest: vcs0 [262.579407] Dynamic subtest vcs0: SUCCESS (1.085s) [262.591428] Starting dynamic subtest: vcs1 [263.667114] Dynamic subtest vcs1: SUCCESS (1.085s) [263.678478] Starting dynamic subtest: vecs0 [264.755387] Dynamic subtest vecs0: SUCCESS (1.085s) [264.766999] Starting dynamic subtest: ccs0 [265.843057] Dynamic subtest ccs0: SUCCESS (1.084s) [265.845810] Subtest exec-single-timeline: SUCCESS (6.475s) [266.032243] [054/132] (756s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt) [266.122126] Starting subtest: psr-rgb565-draw-mmap-gtt [266.126060] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s) [266.218825] [055/132] (756s left) kms_flip (2x-blocking-absolute-wf_vblank) [266.314828] Starting subtest: 2x-blocking-absolute-wf_vblank [266.326117] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.010s) [266.405722] [056/132] (756s left) i915_pm_rps (thresholds-idle-park) [266.466697] Starting subtest: thresholds-idle-park [266.470772] Subtest thresholds-idle-park: SKIP (0.000s) [266.563013] [057/132] (756s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-signaled) [266.611037] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-signaled [266.712890] Subtest etime-multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.102s) [266.792034] [058/132] (756s left) kms_content_protection (legacy-hdcp14) [266.929563] Starting subtest: legacy-hdcp14 [266.933729] Subtest legacy-hdcp14: SKIP (0.000s) [267.045556] [059/132] (756s left) kms_psr (fbc-pr-cursor-plane-move) [267.130601] Starting subtest: fbc-pr-cursor-plane-move [267.134698] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s) [267.213575] [060/132] (756s left) gem_lmem_swapping (heavy-multi) [267.261596] Subtest heavy-multi: SKIP (0.000s) [267.300522] [061/132] (755s left) i915_pm_rps (basic-api) [267.359135] Starting subtest: basic-api [267.363361] Subtest basic-api: SKIP (0.000s) [267.461498] [062/132] (755s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset) [267.549884] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset [267.552168] Starting dynamic subtest: A-eDP1 [271.139512] Dynamic subtest A-eDP1: SUCCESS (3.588s) [271.149324] Starting dynamic subtest: B-eDP1 [274.351543] Dynamic subtest B-eDP1: SUCCESS (3.210s) [274.363920] Starting dynamic subtest: C-eDP1 [277.446622] Dynamic subtest C-eDP1: SUCCESS (3.094s) [277.456310] Starting dynamic subtest: D-eDP1 [280.545896] Dynamic subtest D-eDP1: SUCCESS (3.100s) [280.548193] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (12.999s) [281.357665] [063/132] (742s left) perf_pmu (event-wait) [281.398579] Starting subtest: event-wait [281.401077] Starting dynamic subtest: rcs0 [281.406019] Dynamic subtest rcs0: SKIP (0.000s) [281.410446] Subtest event-wait: SKIP (0.001s) [281.503478] [064/132] (741s left) gem_exec_schedule (u-fairslice) [281.568068] Starting subtest: u-fairslice [281.570092] Starting dynamic subtest: rcs0 [283.579641] Dynamic subtest rcs0: SUCCESS (2.018s) [283.589330] Starting dynamic subtest: bcs0 [285.601284] Dynamic subtest bcs0: SUCCESS (2.020s) [285.612920] Starting dynamic subtest: vcs0 [287.619993] Dynamic subtest vcs0: SUCCESS (2.018s) [287.630141] Starting dynamic subtest: vcs1 [289.638047] Dynamic subtest vcs1: SUCCESS (2.017s) [289.648154] Starting dynamic subtest: vecs0 [291.654507] Dynamic subtest vecs0: SUCCESS (2.015s) [291.663768] Starting dynamic subtest: ccs0 [293.671795] Dynamic subtest ccs0: SUCCESS (2.018s) [293.673824] Subtest u-fairslice: SUCCESS (12.111s) [293.971792] [065/132] (729s left) syncobj_timeline (invalid-query-zero-handles) [294.025461] Starting subtest: invalid-query-zero-handles [294.027407] Subtest invalid-query-zero-handles: SUCCESS (0.000s) [294.123351] [066/132] (729s left) prime_vgem (fence-wait) [294.222293] Starting subtest: fence-wait [294.224497] Starting dynamic subtest: rcs0 [295.310693] Dynamic subtest rcs0: SUCCESS (1.087s) [295.322480] Starting dynamic subtest: bcs0 [296.373904] Dynamic subtest bcs0: SUCCESS (1.062s) [296.388567] Starting dynamic subtest: vcs0 [297.419375] Dynamic subtest vcs0: SUCCESS (1.044s) [297.430926] Starting dynamic subtest: vcs1 [298.460380] Dynamic subtest vcs1: SUCCESS (1.040s) [298.471989] Starting dynamic subtest: vecs0 [299.502993] Dynamic subtest vecs0: SUCCESS (1.040s) [299.514817] Starting dynamic subtest: ccs0 [300.547385] Dynamic subtest ccs0: SUCCESS (1.042s) [300.550081] Subtest fence-wait: SUCCESS (6.325s) [300.681560] [067/132] (722s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip) [300.779851] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip [301.414664] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.636s) [301.587936] [068/132] (721s left) kms_color (ctm-0-50) [301.690919] Starting subtest: ctm-0-50 [301.693279] Starting dynamic subtest: pipe-A-eDP-1 [305.177370] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.488s) [305.186800] Starting dynamic subtest: pipe-B-eDP-1 [309.253256] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.076s) [309.262702] Starting dynamic subtest: pipe-C-eDP-1 [313.236792] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.983s) [313.246605] Starting dynamic subtest: pipe-D-eDP-1 [317.219062] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.983s) [317.221332] Subtest ctm-0-50: SUCCESS (15.532s) [318.048169] [069/132] (705s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt) [318.153015] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt [318.157108] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [318.261512] [070/132] (705s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions-varying-size) [318.381286] Starting subtest: short-flip-after-cursor-atomic-transitions-varying-size [319.340368] Subtest short-flip-after-cursor-atomic-transitions-varying-size: SUCCESS (0.958s) [320.176858] [071/132] (703s left) kms_plane_multiple (2x-tiling-y) [320.270637] Starting subtest: 2x-tiling-y [320.274809] Subtest 2x-tiling-y: SKIP (0.000s) [320.342717] [072/132] (703s left) kms_psr (fbc-psr2-sprite-render) [320.438173] Starting subtest: fbc-psr2-sprite-render [320.440383] Starting dynamic subtest: eDP-1 [320.444457] Dynamic subtest eDP-1: SKIP (0.000s) [320.448571] Subtest fbc-psr2-sprite-render: SKIP (0.001s) [320.530055] [073/132] (703s left) kms_frontbuffer_tracking (fbcpsr-2p-shrfb-fliptrack-mmap-gtt) [320.631342] Starting subtest: fbcpsr-2p-shrfb-fliptrack-mmap-gtt [320.635636] Subtest fbcpsr-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s) [320.742831] [074/132] (703s left) kms_atomic (atomic-invalid-params) [320.840972] Starting subtest: atomic-invalid-params [320.843211] Starting dynamic subtest: pipe-A-eDP-1 [321.227660] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.385s) [321.229854] Subtest atomic-invalid-params: SUCCESS (0.387s) [322.103754] [075/132] (701s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt) [322.204862] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt [322.208825] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s) [322.289920] [076/132] (701s left) kms_cursor_crc (cursor-onscreen-256x85) [322.554881] Starting subtest: cursor-onscreen-256x85 [322.599033] Subtest cursor-onscreen-256x85: SKIP (0.042s) [322.749250] [077/132] (701s left) gen9_exec_parse (basic-rejected-ctx-param) [322.803410] Subtest basic-rejected-ctx-param: SKIP (0.000s) [322.889044] [078/132] (701s left) gem_workarounds (suspend-resume) [322.957604] Starting subtest: suspend-resume [338.573096] Subtest suspend-resume: SUCCESS (2.000s) [338.705531] [079/132] (685s left) gem_userptr_blits (readonly-unsync) [338.792453] Subtest readonly-unsync: SKIP (0.000s) [338.918233] [080/132] (685s left) syncobj_wait (invalid-reset-zero-handles) [338.982911] Starting subtest: invalid-reset-zero-handles [338.985239] Subtest invalid-reset-zero-handles: SUCCESS (0.000s) [339.073043] [081/132] (685s left) kms_flip (flip-vs-blocking-wf-vblank) [339.179166] Starting subtest: flip-vs-blocking-wf-vblank [339.181379] Starting dynamic subtest: A-eDP1 [348.091514] Dynamic subtest A-eDP1: SUCCESS (8.910s) [348.102721] Starting dynamic subtest: B-eDP1 [357.024932] Dynamic subtest B-eDP1: SUCCESS (8.929s) [357.035636] Starting dynamic subtest: C-eDP1 [365.994604] Dynamic subtest C-eDP1: SUCCESS (8.919s) [366.005869] Starting dynamic subtest: D-eDP1 [374.932441] Dynamic subtest D-eDP1: SUCCESS (8.935s) [374.934780] Subtest flip-vs-blocking-wf-vblank: SUCCESS (35.707s) [376.117249] [082/132] (648s left) gem_pxp (regular-baseline-src-copy-readible) [376.237814] Starting subtest: regular-baseline-src-copy-readible [376.296352] Subtest regular-baseline-src-copy-readible: SUCCESS (0.059s) [376.400562] [083/132] (647s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area) [376.498942] Starting subtest: fbc-pr-primary-plane-update-sf-dmg-area [376.503231] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.000s) [376.588988] [084/132] (647s left) fbdev (info) [376.639301] Starting subtest: info [376.641577] Subtest info: SUCCESS (0.000s) [376.711613] [085/132] (647s left) kms_plane_cursor (overlay) [376.799026] Starting subtest: overlay [376.803555] Starting dynamic subtest: pipe-A-eDP-1-size-64 [379.340042] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.543s) [379.401418] Starting dynamic subtest: pipe-A-eDP-1-size-128 [381.852199] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.460s) [381.913384] Starting dynamic subtest: pipe-A-eDP-1-size-256 [384.388124] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.484s) [384.742151] Starting dynamic subtest: pipe-B-eDP-1-size-64 [387.856834] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.125s) [387.918844] Starting dynamic subtest: pipe-B-eDP-1-size-128 [390.325347] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.415s) [390.387410] Starting dynamic subtest: pipe-B-eDP-1-size-256 [392.804637] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.426s) [393.157397] Starting dynamic subtest: pipe-C-eDP-1-size-64 [395.927491] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.784s) [395.967339] Starting dynamic subtest: pipe-C-eDP-1-size-128 [398.017004] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.059s) [398.061134] Starting dynamic subtest: pipe-C-eDP-1-size-256 [400.194355] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.147s) [400.524629] Starting dynamic subtest: pipe-D-eDP-1-size-64 [403.434036] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.920s) [403.472342] Starting dynamic subtest: pipe-D-eDP-1-size-128 [405.546162] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.080s) [405.583361] Starting dynamic subtest: pipe-D-eDP-1-size-256 [407.623924] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.047s) [407.945386] Subtest overlay: SUCCESS (31.147s) [408.756826] [086/132] (615s left) kms_cursor_crc (cursor-sliding-256x256) [408.999680] Starting subtest: cursor-sliding-256x256 [409.001920] Starting dynamic subtest: pipe-A-eDP-1 [412.246185] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.243s) [412.275599] Starting dynamic subtest: pipe-D-eDP-1 [416.180475] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.913s) [416.182721] Subtest cursor-sliding-256x256: SUCCESS (7.182s) [417.014354] [087/132] (607s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-blt) [417.111956] Starting subtest: psr-2p-primscrn-cur-indfb-draw-blt [417.116001] Subtest psr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [417.206182] [088/132] (607s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu) [417.306143] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu [417.310230] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [417.414784] [089/132] (607s left) kms_big_fb (yf-tiled-addfb) [417.516244] Starting subtest: yf-tiled-addfb [417.520422] Subtest yf-tiled-addfb: SKIP (0.000s) [417.615280] [090/132] (606s left) gem_ctx_exec (basic-norecovery) [417.682202] Starting subtest: basic-norecovery [418.018953] Subtest basic-norecovery: SUCCESS (0.338s) [418.142212] [091/132] (606s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs) [418.226258] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs [418.228183] Starting dynamic subtest: pipe-A-eDP-1 [418.246464] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [418.259984] Starting dynamic subtest: pipe-B-eDP-1 [418.277252] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [418.285725] Starting dynamic subtest: pipe-C-eDP-1 [418.302520] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [418.311401] Starting dynamic subtest: pipe-D-eDP-1 [418.328478] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [418.331857] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.006s) [420.390921] [092/132] (604s left) kms_joiner (basic-force-big-joiner) [420.493031] Starting subtest: basic-force-big-joiner [420.497141] Subtest basic-force-big-joiner: SKIP (0.000s) [420.558870] [093/132] (604s left) kms_cursor_legacy (cursorb-vs-flipa-legacy) [420.675263] Starting subtest: cursorB-vs-flipA-legacy [420.679975] Subtest cursorB-vs-flipA-legacy: SKIP (0.001s) [420.831288] [094/132] (603s left) kms_psr (fbc-pr-sprite-blt) [420.934824] Starting subtest: fbc-pr-sprite-blt [420.938715] Subtest fbc-pr-sprite-blt: SKIP (0.000s) [421.020337] [095/132] (603s left) gem_lmem_swapping (parallel-random-verify-ccs) [421.087930] Subtest parallel-random-verify-ccs: SKIP (0.000s) [421.139689] [096/132] (603s left) gem_userptr_blits (forbidden-operations) [421.218552] Starting subtest: forbidden-operations [421.222670] Subtest forbidden-operations: SKIP (0.000s) [421.356668] [097/132] (603s left) gem_exec_schedule (pi-distinct-iova) [421.546725] Starting subtest: pi-distinct-iova [421.549140] Starting dynamic subtest: rcs0 [421.635851] Dynamic subtest rcs0: SUCCESS (0.090s) [421.649699] Starting dynamic subtest: vcs0 [421.699334] Dynamic subtest vcs0: SUCCESS (0.061s) [421.711055] Starting dynamic subtest: vcs1 [421.756459] Dynamic subtest vcs1: SUCCESS (0.056s) [421.765953] Starting dynamic subtest: vecs0 [421.815318] Dynamic subtest vecs0: SUCCESS (0.058s) [421.827633] Starting dynamic subtest: ccs0 [421.885541] Dynamic subtest ccs0: SUCCESS (0.069s) [421.888133] Subtest pi-distinct-iova: SUCCESS (0.341s) [423.596395] [098/132] (601s left) kms_flip (2x-busy-flip) [423.694993] Starting subtest: 2x-busy-flip [423.704042] Subtest 2x-busy-flip: SKIP (0.011s) [423.785750] [099/132] (601s left) i915_pm_freq_api (freq-reset-multiple) [423.842585] Starting subtest: freq-reset-multiple [423.844976] Starting dynamic subtest: gt0 [433.512721] Dynamic subtest gt0: SUCCESS (9.667s) [433.523288] Starting dynamic subtest: gt1 [441.933371] Dynamic subtest gt1: SUCCESS (8.420s) [441.935787] Subtest freq-reset-multiple: SUCCESS (18.089s) [442.009995] [100/132] (582s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt) [442.115058] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt [442.119077] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [442.208825] [101/132] (582s left) i915_query (query-topology-coherent-slice-mask) [442.273120] Starting subtest: query-topology-coherent-slice-mask [442.277234] Subtest query-topology-coherent-slice-mask: SKIP (0.000s) [442.368611] [102/132] (582s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-upscaling) [442.462041] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-upscaling [442.465898] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-upscaling: SKIP (0.000s) [442.538642] [103/132] (582s left) syncobj_wait (wait-for-submit-snapshot) [442.600036] Starting subtest: wait-for-submit-snapshot [442.680647] Subtest wait-for-submit-snapshot: SUCCESS (0.081s) [442.765161] [104/132] (582s left) gem_pread (bench) [442.830774] Subtest bench: SKIP (0.000s) [442.892874] [105/132] (582s left) kms_async_flips (async-flip-dpms) [442.989483] Starting subtest: async-flip-dpms [443.377598] Starting dynamic subtest: pipe-A-eDP-1 [447.311611] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.934s) [447.681554] Starting dynamic subtest: pipe-B-eDP-1 [450.485785] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.812s) [450.851972] Starting dynamic subtest: pipe-C-eDP-1 [453.643024] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.799s) [454.028333] Starting dynamic subtest: pipe-D-eDP-1 [456.811809] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.792s) [456.814007] Subtest async-flip-dpms: SUCCESS (13.824s) [457.994036] [106/132] (567s left) kms_cursor_legacy (modeset-atomic-cursor-hotspot) [458.120787] Starting subtest: modeset-atomic-cursor-hotspot [458.125424] Subtest modeset-atomic-cursor-hotspot: SKIP (0.000s) [458.270720] [107/132] (566s left) gem_mmap_offset (clear-via-pagefault) [458.328681] Starting subtest: clear-via-pagefault [458.331704] Starting dynamic subtest: smem0 [485.976101] Dynamic subtest smem0: FAIL (27.582s) [485.978463] Subtest clear-via-pagefault: FAIL (27.584s) [486.003474] Aborting: Kernel badly tainted (0x4244, 0x200) (check dmesg for details): TAINT_WARN: WARN_ON has happened. [486.021378] [FACT gem_mmap_offset (clear-via-pagefault)] new: kernel.is_tainted.taint_warn: true [486.022352] Closing watchdogs results: parsing output: 0/ for test: kms_ccs results: parsing output: 1/ for test: kms_chamelium_hpd results: parsing output: 2/ for test: gem_mmap_gtt results: parsing output: 3/ for test: gem_userptr_blits results: parsing output: 4/ for test: perf results: parsing output: 5/ for test: gem_exec_balancer results: parsing output: 6/ for test: kms_psr2_sf results: parsing output: 7/ for test: kms_plane results: parsing output: 8/ for test: syncobj_wait results: parsing output: 9/ for test: kms_flip results: parsing output: 10/ for test: gem_ctx_persistence results: parsing output: 11/ for test: kms_big_fb results: parsing output: 12/ for test: kms_cdclk results: parsing output: 13/ for test: kms_big_fb results: parsing output: 14/ for test: gem_exec_reloc results: parsing output: 15/ for test: kms_big_fb results: parsing output: 16/ for test: gem_exec_fence results: parsing output: 17/ for test: api_intel_bb results: parsing output: 18/ for test: syncobj_timeline results: parsing output: 19/ for test: gem_exec_reloc results: parsing output: 20/ for test: kms_frontbuffer_tracking results: parsing output: 21/ for test: kms_frontbuffer_tracking results: parsing output: 22/ for test: kms_psr results: parsing output: 23/ for test: gem_exec_whisper results: parsing output: 24/ for test: kms_psr results: parsing output: 25/ for test: syncobj_wait results: parsing output: 26/ for test: gem_set_tiling_vs_blt results: parsing output: 27/ for test: kms_big_fb results: parsing output: 28/ for test: gem_exec_balancer results: parsing output: 29/ for test: kms_frontbuffer_tracking results: parsing output: 30/ for test: gem_mmap_gtt results: parsing output: 31/ for test: kms_big_fb results: parsing output: 32/ for test: kms_frontbuffer_tracking results: parsing output: 33/ for test: kms_ccs results: parsing output: 34/ for test: kms_dsc results: parsing output: 35/ for test: syncobj_timeline results: parsing output: 36/ for test: kms_addfb_basic results: parsing output: 37/ for test: kms_pm_rpm results: parsing output: 38/ for test: kms_psr results: parsing output: 39/ for test: kms_frontbuffer_tracking results: parsing output: 40/ for test: kms_draw_crc results: parsing output: 41/ for test: gem_exec_schedule results: parsing output: 42/ for test: kms_vblank results: parsing output: 43/ for test: kms_cursor_crc results: parsing output: 44/ for test: kms_frontbuffer_tracking results: parsing output: 45/ for test: kms_frontbuffer_tracking results: parsing output: 46/ for test: gem_tiled_swapping results: parsing output: 47/ for test: i915_drm_fdinfo results: parsing output: 48/ for test: kms_hdr results: parsing output: 49/ for test: api_intel_allocator results: parsing output: 50/ for test: syncobj_wait results: parsing output: 51/ for test: kms_chamelium_frames results: parsing output: 52/ for test: gem_ctx_shared results: parsing output: 53/ for test: kms_frontbuffer_tracking results: parsing output: 54/ for test: kms_flip results: parsing output: 55/ for test: i915_pm_rps results: parsing output: 56/ for test: syncobj_timeline results: parsing output: 57/ for test: kms_content_protection results: parsing output: 58/ for test: kms_psr results: parsing output: 59/ for test: gem_lmem_swapping results: parsing output: 60/ for test: i915_pm_rps results: parsing output: 61/ for test: kms_flip results: parsing output: 62/ for test: perf_pmu results: parsing output: 63/ for test: gem_exec_schedule results: parsing output: 64/ for test: syncobj_timeline results: parsing output: 65/ for test: prime_vgem results: parsing output: 66/ for test: kms_big_fb results: parsing output: 67/ for test: kms_color results: parsing output: 68/ for test: kms_frontbuffer_tracking results: parsing output: 69/ for test: kms_cursor_legacy results: parsing output: 70/ for test: kms_plane_multiple results: parsing output: 71/ for test: kms_psr results: parsing output: 72/ for test: kms_frontbuffer_tracking results: parsing output: 73/ for test: kms_atomic results: parsing output: 74/ for test: kms_frontbuffer_tracking results: parsing output: 75/ for test: kms_cursor_crc results: parsing output: 76/ for test: gen9_exec_parse results: parsing output: 77/ for test: gem_workarounds results: parsing output: 78/ for test: gem_userptr_blits results: parsing output: 79/ for test: syncobj_wait results: parsing output: 80/ for test: kms_flip results: parsing output: 81/ for test: gem_pxp results: parsing output: 82/ for test: kms_psr2_sf results: parsing output: 83/ for test: fbdev results: parsing output: 84/ for test: kms_plane_cursor results: parsing output: 85/ for test: kms_cursor_crc results: parsing output: 86/ for test: kms_frontbuffer_tracking results: parsing output: 87/ for test: kms_frontbuffer_tracking results: parsing output: 88/ for test: kms_big_fb results: parsing output: 89/ for test: gem_ctx_exec results: parsing output: 90/ for test: kms_ccs results: parsing output: 91/ for test: kms_joiner results: parsing output: 92/ for test: kms_cursor_legacy results: parsing output: 93/ for test: kms_psr results: parsing output: 94/ for test: gem_lmem_swapping results: parsing output: 95/ for test: gem_userptr_blits results: parsing output: 96/ for test: gem_exec_schedule results: parsing output: 97/ for test: kms_flip results: parsing output: 98/ for test: i915_pm_freq_api results: parsing output: 99/ for test: kms_frontbuffer_tracking results: parsing output: 100/ for test: i915_query results: parsing output: 101/ for test: kms_flip_scaled_crc results: parsing output: 102/ for test: syncobj_wait results: parsing output: 103/ for test: gem_pread results: parsing output: 104/ for test: kms_async_flips results: parsing output: 105/ for test: kms_cursor_legacy results: parsing output: 106/ for test: gem_mmap_offset results: parsing output: 107/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 108/ for test: kms_vblank results: no output, setting notrun results: parsing output: 109/ for test: kms_lease results: no output, setting notrun results: parsing output: 110/ for test: gem_madvise results: no output, setting notrun results: parsing output: 111/ for test: kms_rotation_crc results: no output, setting notrun results: parsing output: 112/ for test: gem_softpin results: no output, setting notrun results: parsing output: 113/ for test: kms_ccs results: no output, setting notrun results: parsing output: 114/ for test: syncobj_timeline results: no output, setting notrun results: parsing output: 115/ for test: kms_plane_scaling results: no output, setting notrun results: parsing output: 116/ for test: gem_softpin results: no output, setting notrun results: parsing output: 117/ for test: gem_vm_create results: no output, setting notrun results: parsing output: 118/ for test: gem_render_copy_redux results: no output, setting notrun results: parsing output: 119/ for test: kms_flip_scaled_crc results: no output, setting notrun results: parsing output: 120/ for test: gem_exec_flush results: no output, setting notrun results: parsing output: 121/ for test: kms_pm_rpm results: no output, setting notrun results: parsing output: 122/ for test: dmabuf_sync_file results: no output, setting notrun results: parsing output: 123/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 124/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 125/ for test: gem_render_copy results: no output, setting notrun results: parsing output: 126/ for test: sysfs_heartbeat_interval results: no output, setting notrun results: parsing output: 127/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 128/ for test: gem_create results: no output, setting notrun results: parsing output: 129/ for test: gem_exec_reloc results: no output, setting notrun results: parsing output: 130/ for test: gem_exec_fence results: no output, setting notrun results: parsing output: 131/ for test: kms_plane_scaling results: no output, setting notrun Done.