[59.500918] Initializing watchdogs [59.500987] /dev/watchdog0 [59.514469] [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] [59.518613] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [59.520849] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [59.524178] [001/131] (960s left) i915_drm_fdinfo (virtual-busy-hang-all) [59.596693] Starting subtest: virtual-busy-hang-all [59.601419] Subtest virtual-busy-hang-all: SKIP (0.000s) [59.686893] [002/131] (960s left) gem_wait (busy) [59.756618] Starting subtest: busy [59.759073] Starting dynamic subtest: all-engines [60.885841] Dynamic subtest all-engines: SUCCESS (1.130s) [60.895774] Starting dynamic subtest: rcs0 [61.429118] Dynamic subtest rcs0: SUCCESS (0.545s) [61.439482] Starting dynamic subtest: bcs0 [61.969710] Dynamic subtest bcs0: SUCCESS (0.541s) [61.976438] Starting dynamic subtest: vcs0 [63.893699] Dynamic subtest vcs0: SUCCESS (1.925s) [63.902843] Starting dynamic subtest: vcs1 [65.877518] Dynamic subtest vcs1: SUCCESS (1.986s) [65.885295] Starting dynamic subtest: vecs0 [67.925355] Dynamic subtest vecs0: SUCCESS (2.049s) [67.934215] Starting dynamic subtest: ccs0 [68.468127] Dynamic subtest ccs0: SUCCESS (0.543s) [68.470511] Subtest busy: SUCCESS (8.724s) [68.684403] [003/131] (951s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen) [68.787798] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen [68.792033] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [68.900406] [004/131] (951s left) kms_big_fb (linear-16bpp-rotate-0) [69.003044] Starting subtest: linear-16bpp-rotate-0 [70.312273] Subtest linear-16bpp-rotate-0: SUCCESS (1.311s) [70.455874] [005/131] (949s left) gem_exec_create (madvise) [70.519741] Starting subtest: madvise [70.521874] Starting dynamic subtest: smem [90.968404] Dynamic subtest smem: SUCCESS (20.449s) [90.970757] Subtest madvise: SUCCESS (20.450s) [91.944238] [006/131] (928s left) kms_lease (lessee-list) [92.051759] Starting subtest: lessee-list [92.054199] Starting dynamic subtest: pipe-A-eDP-1 [92.056472] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.002s) [92.066441] Starting dynamic subtest: pipe-B-eDP-1 [92.068650] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [92.075526] Starting dynamic subtest: pipe-C-eDP-1 [92.077776] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [92.084436] Starting dynamic subtest: pipe-D-eDP-1 [92.086659] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [92.088896] Subtest lessee-list: SUCCESS (0.007s) [92.181171] [007/131] (928s left) kms_dirtyfb (drrs-dirtyfb-ioctl) [92.289994] Starting subtest: drrs-dirtyfb-ioctl [92.302751] Subtest drrs-dirtyfb-ioctl: SKIP (0.001s) [92.423039] [008/131] (927s left) gem_workarounds (reset-context) [92.516056] Starting subtest: reset-context [92.697910] Subtest reset-context: SUCCESS (0.184s) [92.861788] [009/131] (927s left) kms_joiner (basic-force-big-joiner) [92.962792] Starting subtest: basic-force-big-joiner [92.964822] Starting dynamic subtest: single [96.297054] Dynamic subtest single: SUCCESS (3.341s) [96.299354] Subtest basic-force-big-joiner: SUCCESS (3.342s) [97.496710] [010/131] (922s left) kms_frontbuffer_tracking (fbc-indfb-scaledprimary) [97.593769] Starting subtest: fbc-indfb-scaledprimary [100.562898] Subtest fbc-indfb-scaledprimary: SUCCESS (2.972s) [101.702158] [011/131] (918s left) gem_eio (create) [101.929271] Starting subtest: create [102.263954] Subtest create: SUCCESS (0.335s) [102.413503] [012/131] (918s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5) [102.503694] Starting subtest: planes-unity-scaling-downscale-factor-0-5 [102.505834] Starting dynamic subtest: pipe-A [102.524576] Dynamic subtest pipe-A: SKIP (0.016s) [102.533148] Starting dynamic subtest: pipe-B [102.555254] Dynamic subtest pipe-B: SKIP (0.030s) [102.562980] Starting dynamic subtest: pipe-C [102.582470] Dynamic subtest pipe-C: SKIP (0.030s) [102.589946] Starting dynamic subtest: pipe-D [102.611344] Dynamic subtest pipe-D: SKIP (0.029s) [102.614610] Subtest planes-unity-scaling-downscale-factor-0-5: SKIP (0.106s) [102.730935] [013/131] (917s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-wc) [102.828912] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-wc [102.832361] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [102.962093] [014/131] (917s left) gem_tiled_blits (basic) [103.032249] Subtest basic: SKIP (0.000s) [103.119622] [015/131] (917s left) gem_ctx_engines (independent) [103.177129] Starting subtest: independent [103.179027] Starting dynamic subtest: rcs0 [103.331554] Dynamic subtest rcs0: SUCCESS (0.152s) [103.342642] Starting dynamic subtest: bcs0 [103.466969] Dynamic subtest bcs0: SUCCESS (0.135s) [103.476960] Starting dynamic subtest: vcs0 [103.607222] Dynamic subtest vcs0: SUCCESS (0.140s) [103.617647] Starting dynamic subtest: vcs1 [103.771628] Dynamic subtest vcs1: SUCCESS (0.165s) [103.781453] Starting dynamic subtest: vecs0 [103.947448] Dynamic subtest vecs0: SUCCESS (0.177s) [103.958889] Starting dynamic subtest: ccs0 [104.113747] Dynamic subtest ccs0: SUCCESS (0.165s) [104.124073] Starting dynamic subtest: all-engines [104.772886] Dynamic subtest all-engines: SUCCESS (0.659s) [104.775109] Subtest independent: SUCCESS (1.595s) [105.148830] [016/131] (915s left) gem_render_copy (yf-tiled-to-vebox-yf-tiled) [105.207479] Starting subtest: yf-tiled-to-vebox-yf-tiled [105.212073] Subtest yf-tiled-to-vebox-yf-tiled: SKIP (0.000s) [105.416550] [017/131] (915s left) kms_cursor_legacy (cursora-vs-flipa-varying-size) [105.545808] Starting subtest: cursorA-vs-flipA-varying-size [116.681715] Subtest cursorA-vs-flipA-varying-size: SUCCESS (11.133s) [117.511967] [018/131] (903s left) syncobj_wait (invalid-signal-bad-pad) [117.574868] Starting subtest: invalid-signal-bad-pad [117.577183] Subtest invalid-signal-bad-pad: SUCCESS (0.000s) [117.713640] [019/131] (902s left) i915_suspend (debugfs-reader) [117.776823] Starting subtest: debugfs-reader [136.080679] Subtest debugfs-reader: SUCCESS (7.589s) [136.203673] [020/131] (884s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render) [136.320710] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render [136.324999] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s) [136.457993] [021/131] (884s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite) [136.549740] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite [145.056142] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.572s) [145.212621] [022/131] (875s left) kms_pm_rpm (pc8-residency) [146.732888] Starting subtest: pc8-residency [146.737581] Subtest pc8-residency: SKIP (0.000s) [147.505193] [023/131] (873s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [147.606045] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [147.610606] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s) [147.728116] [024/131] (873s left) gem_exec_reloc (basic-gtt-read-noreloc) [147.792681] Subtest basic-gtt-read-noreloc: SKIP (0.000s) [147.848408] [025/131] (873s left) gem_ctx_persistence (saturated-hostile-nopreempt) [147.908781] Starting subtest: saturated-hostile-nopreempt [147.911318] Starting dynamic subtest: rcs0 [147.972329] Dynamic subtest rcs0: SKIP (0.062s) [147.983408] Starting dynamic subtest: bcs0 [148.003465] Dynamic subtest bcs0: SKIP (0.030s) [148.012268] Starting dynamic subtest: vcs0 [148.020229] Dynamic subtest vcs0: SKIP (0.015s) [148.028750] Starting dynamic subtest: vcs1 [148.041192] Dynamic subtest vcs1: SKIP (0.020s) [148.049409] Starting dynamic subtest: vecs0 [148.055870] Dynamic subtest vecs0: SKIP (0.013s) [148.064324] Starting dynamic subtest: ccs0 [148.072115] Dynamic subtest ccs0: SKIP (0.016s) [148.076447] Subtest saturated-hostile-nopreempt: SKIP (0.162s) [148.170126] [026/131] (872s left) kms_dp_link_training (uhbr-mst) [148.266663] Starting subtest: uhbr-mst [148.274948] Subtest uhbr-mst: SKIP (0.000s) [148.354536] [027/131] (872s left) kms_chamelium_hpd (hdmi-hpd-fast) [148.743149] Subtest hdmi-hpd-fast: SKIP (0.000s) [149.572892] [028/131] (871s left) gem_pxp (create-regular-context-2) [149.703168] Starting subtest: create-regular-context-2 [149.705654] Subtest create-regular-context-2: SUCCESS (0.002s) [149.850204] [029/131] (871s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled) [149.911477] Starting subtest: multi-wait-for-submit-unsubmitted-signaled [149.913902] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.000s) [150.042658] [030/131] (871s left) gem_spin_batch (legacy-resubmit-new) [150.116809] Starting subtest: legacy-resubmit-new [150.119459] Starting dynamic subtest: default [150.124455] Dynamic subtest default: SUCCESS (0.006s) [150.134781] Starting dynamic subtest: render [150.137244] Dynamic subtest render: SUCCESS (0.003s) [150.145976] Starting dynamic subtest: bsd [150.148410] Dynamic subtest bsd: SUCCESS (0.004s) [150.159784] Starting dynamic subtest: bsd1 [150.161784] Dynamic subtest bsd1: SUCCESS (0.003s) [150.169343] Starting dynamic subtest: bsd2 [150.171267] Dynamic subtest bsd2: SUCCESS (0.003s) [150.178762] Starting dynamic subtest: blt [150.180665] Dynamic subtest blt: SUCCESS (0.003s) [150.188364] Starting dynamic subtest: vebox [150.190307] Dynamic subtest vebox: SUCCESS (0.003s) [150.192192] Subtest legacy-resubmit-new: SUCCESS (0.031s) [151.671858] [031/131] (869s left) gem_mmap_offset (basic-uaf) [151.738178] Starting subtest: basic-uaf [151.740403] Subtest basic-uaf: SUCCESS (0.001s) [151.871815] [032/131] (869s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt) [151.975840] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt [151.979990] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s) [152.120940] [033/131] (869s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling) [152.215775] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling [152.217987] Starting dynamic subtest: pipe-A-default-mode [152.538379] Dynamic subtest pipe-A-default-mode: SKIP (0.323s) [152.542840] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.324s) [153.342677] [034/131] (868s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc) [153.434634] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc [153.436838] Starting dynamic subtest: pipe-A-eDP-1 [153.458747] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [153.471315] Starting dynamic subtest: pipe-B-eDP-1 [153.492027] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [153.499886] Starting dynamic subtest: pipe-C-eDP-1 [153.520035] Dynamic subtest pipe-C-eDP-1: SKIP (0.002s) [153.528406] Starting dynamic subtest: pipe-D-eDP-1 [153.549898] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [153.554182] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.010s) [155.702197] [035/131] (865s left) kms_big_fb (y-tiled-64bpp-rotate-180) [155.812331] Starting subtest: y-tiled-64bpp-rotate-180 [155.816502] Subtest y-tiled-64bpp-rotate-180: SKIP (0.000s) [155.941685] [036/131] (865s left) kms_chamelium_edid (dp-edid-stress-resolution-non-4k) [156.326406] Subtest dp-edid-stress-resolution-non-4k: SKIP (0.000s) [157.183356] [037/131] (864s left) gem_exec_schedule (smoketest-all) [157.259064] Starting subtest: smoketest-all [189.599250] Subtest smoketest-all: SUCCESS (32.321s) [190.678706] [038/131] (830s left) gem_mmap_gtt (basic-write-read-distinct) [190.747131] Subtest basic-write-read-distinct: SKIP (0.000s) [190.811528] [039/131] (830s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render) [190.910895] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render [190.914923] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s) [191.040992] [040/131] (830s left) gem_exec_flush (basic-uc-set-default) [191.106978] Starting subtest: basic-uc-set-default [196.555644] Subtest basic-uc-set-default: SUCCESS (5.452s) [196.772998] [041/131] (824s left) perf (missing-sample-flags) [196.907214] Starting subtest: missing-sample-flags [196.909363] Subtest missing-sample-flags: SUCCESS (0.000s) [196.945680] [042/131] (824s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc) [197.043503] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc [197.047943] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [197.167698] [043/131] (824s left) gem_caching (reads) [197.225204] Subtest reads: SKIP (0.000s) [197.305543] [044/131] (824s left) gem_exec_schedule (smoketest) [197.476799] Starting subtest: smoketest [197.479297] Starting dynamic subtest: rcs0 [203.031458] Dynamic subtest rcs0: SUCCESS (5.508s) [203.045537] Starting dynamic subtest: bcs0 [208.547082] Dynamic subtest bcs0: SUCCESS (5.519s) [208.557391] Starting dynamic subtest: vcs0 [214.043644] Dynamic subtest vcs0: SUCCESS (5.500s) [214.054193] Starting dynamic subtest: vcs1 [219.539213] Dynamic subtest vcs1: SUCCESS (5.501s) [219.549564] Starting dynamic subtest: vecs0 [225.036308] Dynamic subtest vecs0: SUCCESS (5.493s) [225.047682] Starting dynamic subtest: ccs0 [230.520137] Dynamic subtest ccs0: SUCCESS (5.489s) [230.522145] Subtest smoketest: SUCCESS (33.015s) [230.683414] [045/131] (791s left) gen9_exec_parse (bb-secure) [230.752186] Subtest bb-secure: SKIP (0.000s) [230.842483] [046/131] (791s left) kms_flip (2x-flip-vs-panning-interruptible) [230.943928] Starting subtest: 2x-flip-vs-panning-interruptible [230.953963] Subtest 2x-flip-vs-panning-interruptible: SKIP (0.010s) [231.049583] [047/131] (790s left) gem_exec_fence (syncobj-timeline-invalid-flags) [231.641608] Starting subtest: syncobj-timeline-invalid-flags [231.644299] Subtest syncobj-timeline-invalid-flags: SUCCESS (0.000s) [232.740897] [FACT gem_exec_fence (syncobj-timeline-invalid-flags)] new: kernel.kmod_is_loaded.vgem: true [232.744096] [048/131] (789s left) kms_frontbuffer_tracking (fbc-2p-rte) [232.836979] Starting subtest: fbc-2p-rte [232.841042] Subtest fbc-2p-rte: SKIP (0.000s) [232.967849] [049/131] (789s left) kms_big_fb (yf-tiled-32bpp-rotate-90) [233.063981] Starting subtest: yf-tiled-32bpp-rotate-90 [233.068294] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s) [233.187478] [050/131] (788s left) kms_pm_rpm (basic-pci-d3-state) [234.813163] Starting subtest: basic-pci-d3-state [236.305762] Subtest basic-pci-d3-state: SUCCESS (1.490s) [236.405519] [051/131] (785s left) kms_psr (fbc-psr-primary-mmap-gtt) [236.517084] Starting subtest: fbc-psr-primary-mmap-gtt [236.519066] Starting dynamic subtest: eDP-1 [236.523303] Dynamic subtest eDP-1: SKIP (0.000s) [236.527584] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s) [236.615360] [052/131] (785s left) gem_exec_whisper (basic-normal-all) [236.686783] Starting subtest: basic-normal-all [239.071299] Subtest basic-normal-all: SUCCESS (2.377s) [239.277479] [053/131] (782s left) gem_exec_params (invalid-batch-start-offset) [239.343511] Starting subtest: invalid-batch-start-offset [239.345935] Subtest invalid-batch-start-offset: SUCCESS (0.002s) [239.481823] [054/131] (782s left) kms_async_flips (crc) [239.595488] Starting subtest: crc [239.969406] Starting dynamic subtest: pipe-A-eDP-1 [242.875271] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.900s) [243.250116] Starting dynamic subtest: pipe-B-eDP-1 [246.111841] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.869s) [246.496338] Starting dynamic subtest: pipe-C-eDP-1 [249.342996] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.853s) [249.717294] Starting dynamic subtest: pipe-D-eDP-1 [252.569847] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.860s) [252.572231] Subtest crc: SUCCESS (12.960s) [253.767209] [055/131] (768s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing) [253.858886] Starting subtest: plane-use-after-nonblocking-unbind-fencing [253.861181] Starting dynamic subtest: pipe-A-eDP-1 [253.919516] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.062s) [254.213090] Starting dynamic subtest: pipe-B-eDP-1 [255.054691] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.850s) [255.353235] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (1.494s) [256.217813] [056/131] (766s left) perf_pmu (busy-start) [256.265478] Starting subtest: busy-start [256.267443] Starting dynamic subtest: rcs0 [258.818247] Dynamic subtest rcs0: SUCCESS (2.552s) [258.828431] Starting dynamic subtest: bcs0 [261.367547] Dynamic subtest bcs0: SUCCESS (2.546s) [261.378778] Starting dynamic subtest: vcs0 [264.631795] Dynamic subtest vcs0: SUCCESS (3.260s) [264.643401] Starting dynamic subtest: vcs1 [268.665059] Dynamic subtest vcs1: SUCCESS (4.030s) [268.675618] Starting dynamic subtest: vecs0 [272.631710] Dynamic subtest vecs0: SUCCESS (3.964s) [272.643695] Starting dynamic subtest: ccs0 [275.180790] Dynamic subtest ccs0: SUCCESS (2.548s) [275.183258] Subtest busy-start: SUCCESS (18.912s) [275.327170] [057/131] (746s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal [275.388399] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled [275.492621] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.103s) [275.597709] [058/131] (746s left) gem_exec_reloc (basic-wc) [275.661286] Subtest basic-wc: SKIP (0.000s) [275.727284] [059/131] (746s left) gem_set_tiling_vs_blt (untiled-to-tiled) [275.778925] Subtest untiled-to-tiled: SKIP (0.000s) [275.863896] [060/131] (746s left) kms_atomic_transition (plane-all-modeset-transition) [275.975454] Starting subtest: plane-all-modeset-transition [275.979870] Subtest plane-all-modeset-transition: SKIP (0.000s) [276.073061] [061/131] (746s left) gem_exec_reloc (basic-write-gtt-noreloc) [276.144176] Subtest basic-write-gtt-noreloc: SKIP (0.000s) [276.232546] [062/131] (746s left) kms_flip (plain-flip-fb-recreate) [276.326700] Starting subtest: plain-flip-fb-recreate [276.328972] Starting dynamic subtest: A-eDP1 [285.191174] Dynamic subtest A-eDP1: SUCCESS (8.864s) [285.201693] Starting dynamic subtest: B-eDP1 [294.032810] Dynamic subtest B-eDP1: SUCCESS (8.841s) [294.043950] Starting dynamic subtest: C-eDP1 [302.843524] Dynamic subtest C-eDP1: SUCCESS (8.808s) [302.852606] Starting dynamic subtest: D-eDP1 [311.672673] Dynamic subtest D-eDP1: SUCCESS (8.827s) [311.674763] Subtest plain-flip-fb-recreate: SUCCESS (35.347s) [312.868362] [063/131] (709s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-wc) [312.966004] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-wc [312.970180] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [313.081767] [064/131] (709s left) syncobj_timeline (wait-for-submit-delayed-submit) [313.129825] Starting subtest: wait-for-submit-delayed-submit [313.234080] Subtest wait-for-submit-delayed-submit: SUCCESS (0.104s) [313.331873] [065/131] (709s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render) [313.441569] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render [313.446024] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s) [313.566076] [066/131] (709s left) api_intel_bb (misplaced-blitter) [313.620147] Starting subtest: misplaced-blitter [313.624582] Subtest misplaced-blitter: SUCCESS (0.007s) [313.789090] [067/131] (708s left) kms_cursor_legacy (cursorb-vs-flipb-toggle) [313.908350] Starting subtest: cursorB-vs-flipB-toggle [313.912970] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s) [314.080073] [068/131] (708s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc) [314.183118] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc [314.187242] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [314.315643] [069/131] (708s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling) [314.411279] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling [314.413292] Starting dynamic subtest: pipe-A-default-mode [314.702347] Dynamic subtest pipe-A-default-mode: SKIP (0.286s) [314.707023] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.288s) [315.592676] [070/131] (707s left) syncobj_wait (multi-wait-all-submitted) [315.653128] Starting subtest: multi-wait-all-submitted [315.756528] Subtest multi-wait-all-submitted: SUCCESS (0.103s) [315.867340] [071/131] (707s left) gen9_exec_parse (unaligned-jump) [315.940385] Subtest unaligned-jump: SKIP (0.000s) [316.030413] [072/131] (706s left) kms_psr (fbc-psr2-sprite-mmap-gtt) [316.130407] Starting subtest: fbc-psr2-sprite-mmap-gtt [316.132616] Starting dynamic subtest: eDP-1 [316.136625] Dynamic subtest eDP-1: SKIP (0.000s) [316.140679] Subtest fbc-psr2-sprite-mmap-gtt: SKIP (0.001s) [316.232096] [073/131] (706s left) kms_psr (psr2-primary-page-flip) [316.325824] Starting subtest: psr2-primary-page-flip [316.328099] Starting dynamic subtest: eDP-1 [318.062408] Dynamic subtest eDP-1: SUCCESS (1.735s) [318.064706] Subtest psr2-primary-page-flip: SUCCESS (1.736s) [318.968661] [074/131] (704s left) kms_pipe_crc_basic (read-crc-frame-sequence) [319.071275] Starting subtest: read-crc-frame-sequence [319.073656] Starting dynamic subtest: pipe-A-eDP-1 [319.768809] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.699s) [319.779761] Starting dynamic subtest: pipe-B-eDP-1 [321.105801] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.334s) [321.115185] Starting dynamic subtest: pipe-C-eDP-1 [322.408802] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.302s) [322.419094] Starting dynamic subtest: pipe-D-eDP-1 [323.734069] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.323s) [323.736464] Subtest read-crc-frame-sequence: SUCCESS (4.665s) [324.599332] [075/131] (698s left) kms_vblank (ts-continuation-dpms-suspend) [324.694734] Starting subtest: ts-continuation-dpms-suspend [324.696630] Starting dynamic subtest: pipe-A-eDP-1 [341.623011] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.815s) [341.641060] Starting dynamic subtest: pipe-D-eDP-1 [359.628431] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.490s) [359.630824] Subtest ts-continuation-dpms-suspend: SUCCESS (4.309s) [360.448533] [076/131] (662s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted) [360.515303] Starting subtest: etime-single-wait-all-for-submit-unsubmitted [360.623350] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.108s) [360.723662] [077/131] (662s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu) [360.828513] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu [367.281929] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.507s) [367.432384] [078/131] (655s left) kms_atomic (plane-primary-overlay-mutable-zpos) [367.536337] Starting subtest: plane-primary-overlay-mutable-zpos [370.929498] Subtest plane-primary-overlay-mutable-zpos: SKIP (3.406s) [372.142038] [079/131] (651s left) kms_cursor_crc (cursor-random-256x256) [372.377502] Starting subtest: cursor-random-256x256 [372.382431] Starting dynamic subtest: pipe-A-eDP-1 [375.706050] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.333s) [375.735473] Starting dynamic subtest: pipe-D-eDP-1 [379.678597] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.959s) [379.680890] Subtest cursor-random-256x256: SUCCESS (7.316s) [380.575296] [080/131] (642s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff) [380.687390] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff [380.691333] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s) [380.818810] [081/131] (642s left) kms_cursor_crc (cursor-tearing-framebuffer-change) [380.928488] Starting subtest: cursor-tearing-framebuffer-change [380.930300] Starting dynamic subtest: pipe-A-eDP-1 [381.482257] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.553s) [381.492349] Starting dynamic subtest: pipe-D-eDP-1 [382.664851] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.184s) [382.666974] Subtest cursor-tearing-framebuffer-change: SUCCESS (1.739s) [383.519250] [082/131] (639s left) syncobj_timeline (invalid-query-one-illegal-handle) [383.584956] Starting subtest: invalid-query-one-illegal-handle [383.586957] Subtest invalid-query-one-illegal-handle: SUCCESS (0.000s) [383.716052] [083/131] (639s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt) [383.813912] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt [388.292102] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.486s) [389.507051] [084/131] (633s left) gem_pxp (regular-baseline-src-copy-readible) [389.613525] Starting subtest: regular-baseline-src-copy-readible [389.669184] Subtest regular-baseline-src-copy-readible: SUCCESS (0.058s) [389.833888] [085/131] (633s left) kms_sequence (get-forked-busy) [389.939269] Starting subtest: get-forked-busy [389.941415] Starting dynamic subtest: pipe-A-eDP-1 [391.885526] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.945s) [391.896787] Starting dynamic subtest: pipe-B-eDP-1 [394.464443] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.571s) [394.474532] Starting dynamic subtest: pipe-C-eDP-1 [397.098278] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.632s) [397.111122] Starting dynamic subtest: pipe-D-eDP-1 [399.742593] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.641s) [399.744820] Subtest get-forked-busy: SUCCESS (9.795s) [400.641269] [086/131] (622s left) kms_psr2_sf (pr-plane-move-sf-dmg-area) [405.612708] Starting subtest: pr-plane-move-sf-dmg-area [405.617211] Subtest pr-plane-move-sf-dmg-area: SKIP (0.003s) [406.482066] [087/131] (617s left) kms_rotation_crc (primary-yf-tiled-reflect-x-180) [406.585387] Starting subtest: primary-yf-tiled-reflect-x-180 [406.645646] Subtest primary-yf-tiled-reflect-x-180: SKIP (0.059s) [406.770929] [088/131] (616s left) gem_exec_reloc (basic-cpu-wc-active) [406.844831] Subtest basic-cpu-wc-active: SKIP (0.000s) [406.931381] [089/131] (616s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted) [406.985004] Starting subtest: multi-wait-available-unsubmitted-submitted [406.987381] Subtest multi-wait-available-unsubmitted-submitted: SUCCESS (0.001s) [407.115128] [090/131] (616s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs) [407.209009] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs [407.211809] Starting dynamic subtest: pipe-A-eDP-1 [407.234975] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [407.246532] Starting dynamic subtest: pipe-B-eDP-1 [407.268005] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [407.276910] Starting dynamic subtest: pipe-C-eDP-1 [407.298610] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [407.307497] Starting dynamic subtest: pipe-D-eDP-1 [407.329430] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [407.333841] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs: SKIP (0.005s) [409.452039] [091/131] (614s left) api_intel_allocator (reloc-allocator) [409.512384] Starting subtest: reloc-allocator [409.514577] Starting dynamic subtest: basic [409.519071] Dynamic subtest basic: SUCCESS (0.006s) [409.528965] Starting dynamic subtest: parallel-one [409.531414] Dynamic subtest parallel-one: SUCCESS (0.008s) [409.540434] Starting dynamic subtest: print [409.542650] Dynamic subtest print: SUCCESS (0.000s) [409.551908] Starting dynamic subtest: reuse [409.553923] Dynamic subtest reuse: SUCCESS (0.000s) [409.562376] Starting dynamic subtest: fork-reopen-allocator [409.564312] Dynamic subtest fork-reopen-allocator: SUCCESS (0.013s) [409.566189] Subtest reloc-allocator: SUCCESS (0.034s) [409.718806] [092/131] (614s left) sysfs_preempt_timeout (timeout) [409.776574] Starting subtest: timeout [409.778865] Starting dynamic subtest: vecs0 [419.343181] Dynamic subtest vecs0: SUCCESS (9.562s) [419.361122] Starting dynamic subtest: ccs0 [420.681714] Dynamic subtest ccs0: SUCCESS (1.337s) [420.693953] Starting dynamic subtest: vcs0 [430.266872] Dynamic subtest vcs0: SUCCESS (9.583s) [430.282025] Starting dynamic subtest: bcs0 [431.626079] Dynamic subtest bcs0: SUCCESS (1.356s) [431.637140] Starting dynamic subtest: rcs0 [432.919297] Dynamic subtest rcs0: SUCCESS (1.295s) [432.930140] Starting dynamic subtest: vcs1 [442.323261] Dynamic subtest vcs1: SUCCESS (9.401s) [442.326054] Subtest timeout: SUCCESS (32.548s) [442.438421] [093/131] (581s left) kms_flip (2x-flip-vs-dpms-on-nop-interruptible) [442.536304] Starting subtest: 2x-flip-vs-dpms-on-nop-interruptible [442.546030] Subtest 2x-flip-vs-dpms-on-nop-interruptible: SKIP (0.010s) [442.685656] [094/131] (581s left) i915_pm_rpm (gem-pread) [444.408324] Starting subtest: gem-pread [446.628169] Subtest gem-pread: SUCCESS (2.223s) [446.739674] [095/131] (577s left) kms_properties (get_properties-sanity-atomic) [446.833451] Starting subtest: get_properties-sanity-atomic [446.835653] Subtest get_properties-sanity-atomic: SUCCESS (0.002s) [446.933324] [096/131] (577s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled) [446.995654] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [446.997592] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [447.135842] [097/131] (576s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs) [447.233357] Starting subtest: crc-primary-suspend-yf-tiled-ccs [447.235568] Starting dynamic subtest: pipe-A-eDP-1 [447.245144] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [447.257442] Starting dynamic subtest: pipe-B-eDP-1 [447.266177] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [447.275390] Starting dynamic subtest: pipe-C-eDP-1 [447.283532] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [447.292429] Starting dynamic subtest: pipe-D-eDP-1 [447.300749] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [447.304870] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.005s) [449.555806] [098/131] (574s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip) [449.656414] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip [449.660361] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s) [449.788843] [099/131] (574s left) gem_reg_read (timestamp-moving) [449.848749] Starting subtest: timestamp-moving [450.849330] Subtest timestamp-moving: SUCCESS (1.001s) [450.949983] [100/131] (573s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs) [451.048375] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs [451.050610] Starting dynamic subtest: pipe-A-eDP-1 [451.109960] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [451.121256] Starting dynamic subtest: pipe-B-eDP-1 [451.180013] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [451.191036] Starting dynamic subtest: pipe-C-eDP-1 [451.248030] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [451.258009] Starting dynamic subtest: pipe-D-eDP-1 [451.315793] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [451.320032] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.008s) [453.317514] [101/131] (570s left) kms_plane_scaling (intel-max-src-size) [453.424377] Starting subtest: intel-max-src-size [453.430374] Subtest intel-max-src-size: SKIP (0.000s) [453.542841] [102/131] (570s left) gem_exec_balancer (full-late-pulse) [453.610495] Starting subtest: full-late-pulse [458.159263] Subtest full-late-pulse: SUCCESS (4.547s) [458.516697] [103/131] (565s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc) [458.611559] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc [458.615637] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [458.735143] [104/131] (565s left) kms_psr (pr-primary-render) [458.824481] Starting subtest: pr-primary-render [458.828539] Subtest pr-primary-render: SKIP (0.000s) [458.922892] [105/131] (565s left) gem_flink_basic (basic) [458.989666] Starting subtest: basic [458.991884] Subtest basic: SUCCESS (0.000s) [459.124077] [106/131] (565s left) kms_cursor_crc (cursor-offscreen-256x256) [459.370860] Starting subtest: cursor-offscreen-256x256 [459.375029] Starting dynamic subtest: pipe-A-eDP-1 [461.321976] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.945s) [461.351034] Starting dynamic subtest: pipe-D-eDP-1 [463.895577] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.551s) [463.897833] Subtest cursor-offscreen-256x256: SUCCESS (4.521s) [464.775239] [107/131] (559s left) gem_eio (in-flight-internal-immediate) [465.002058] Starting subtest: in-flight-internal-immediate [466.362440] Subtest in-flight-internal-immediate: SUCCESS (1.359s) [466.543084] [108/131] (557s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu) [466.650365] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu [466.654917] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [466.781109] [109/131] (557s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu) [466.879329] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu [473.790417] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (6.912s) [473.919113] [110/131] (550s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf) [478.957330] Starting subtest: fbc-psr2-cursor-plane-update-sf [478.959629] Starting dynamic subtest: pipe-A-eDP-1 [479.745595] Dynamic subtest pipe-A-eDP-1: SKIP (0.784s) [479.756028] Starting dynamic subtest: pipe-B-eDP-1 [480.872765] Dynamic subtest pipe-B-eDP-1: SKIP (1.124s) [480.877127] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (1.912s) [482.080828] [111/131] (542s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area) [487.126555] Starting subtest: psr2-overlay-plane-update-sf-dmg-area [487.128714] Starting dynamic subtest: pipe-A-eDP-1 [493.737534] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.608s) [493.747727] Starting dynamic subtest: pipe-B-eDP-1 [500.307474] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.567s) [500.309867] Subtest psr2-overlay-plane-update-sf-dmg-area: SUCCESS (13.179s) [501.198248] [112/131] (523s left) gem_exec_fence (concurrent) [501.383121] Starting subtest: concurrent [501.387760] Subtest concurrent: SKIP (0.000s) [503.398966] [113/131] (521s left) kms_setmode (invalid-clone-single-crtc-stealing) [503.446856] Starting subtest: invalid-clone-single-crtc-stealing [503.453157] Subtest invalid-clone-single-crtc-stealing: SKIP (0.000s) [503.582811] [114/131] (521s left) dumb_buffer (create-clear) [503.649534] Starting subtest: create-clear [537.669556] Subtest create-clear: SUCCESS (34.022s) [537.809667] [115/131] (486s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt) [537.913619] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt [537.917813] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [538.040990] [116/131] (486s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [538.177511] Starting subtest: basic-flip-after-cursor-atomic [539.092386] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.912s) [539.915647] [117/131] (484s left) kms_big_fb (4-tiled-32bpp-rotate-270) [540.019515] Starting subtest: 4-tiled-32bpp-rotate-270 [540.039946] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.020s) [540.203947] [118/131] (484s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs) [540.300183] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs [540.302386] Starting dynamic subtest: pipe-A-eDP-1 [540.326263] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [540.337438] Starting dynamic subtest: pipe-B-eDP-1 [540.359818] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [540.368243] Starting dynamic subtest: pipe-C-eDP-1 [540.391922] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [540.400458] Starting dynamic subtest: pipe-D-eDP-1 [540.423019] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [540.427252] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.004s) [542.568884] [119/131] (482s left) kms_big_fb (x-tiled-addfb-size-overflow) [542.679059] Starting subtest: x-tiled-addfb-size-overflow [542.681381] Subtest x-tiled-addfb-size-overflow: SUCCESS (0.000s) [542.826729] [120/131] (482s left) perf (non-zero-reason) [542.933962] Starting subtest: non-zero-reason [542.936083] Starting dynamic subtest: 0-rcs0 [548.278007] Dynamic subtest 0-rcs0: SUCCESS (5.344s) [548.291897] Starting dynamic subtest: 1-vecs0 [552.172299] Dynamic subtest 1-vecs0: SUCCESS (3.893s) [552.174948] Subtest non-zero-reason: SUCCESS (9.239s) [552.220943] [121/131] (472s left) fbdev (info) [552.254679] Starting subtest: info [552.256862] Subtest info: SUCCESS (0.000s) [552.350084] [122/131] (472s left) kms_rotation_crc (primary-4-tiled-reflect-x-180) [552.456952] Starting subtest: primary-4-tiled-reflect-x-180 [559.744451] Subtest primary-4-tiled-reflect-x-180: SUCCESS (7.290s) [561.031456] [123/131] (464s left) kms_plane (pixel-format) [561.134624] Starting subtest: pixel-format [561.160800] Starting dynamic subtest: pipe-A-plane-0 [566.259348] Dynamic subtest pipe-A-plane-0: SUCCESS (5.100s) [566.270924] Starting dynamic subtest: pipe-A-plane-3 [568.614155] Dynamic subtest pipe-A-plane-3: SUCCESS (2.353s) [568.624813] Starting dynamic subtest: pipe-A-plane-5 [568.825440] Dynamic subtest pipe-A-plane-5: SUCCESS (0.210s) [569.898274] Starting dynamic subtest: pipe-B-plane-0 [574.932994] Dynamic subtest pipe-B-plane-0: SUCCESS (5.044s) [574.944532] Starting dynamic subtest: pipe-B-plane-3 [577.221277] Dynamic subtest pipe-B-plane-3: SUCCESS (2.288s) [577.231060] Starting dynamic subtest: pipe-B-plane-5 [577.421202] Dynamic subtest pipe-B-plane-5: SUCCESS (0.199s) [577.740100] Subtest pixel-format: SUCCESS (16.609s) [578.593603] [124/131] (446s left) gem_exec_schedule (implicit-boths) [578.681002] Starting subtest: implicit-boths [578.682964] Starting dynamic subtest: rcs0 [578.780510] Dynamic subtest rcs0: SUCCESS (0.109s) [578.794001] Starting dynamic subtest: vcs0 [578.863294] Dynamic subtest vcs0: SUCCESS (0.082s) [578.876644] Starting dynamic subtest: vcs1 [578.939813] Dynamic subtest vcs1: SUCCESS (0.075s) [578.952692] Starting dynamic subtest: vecs0 [579.014387] Dynamic subtest vecs0: SUCCESS (0.075s) [579.026418] Starting dynamic subtest: ccs0 [579.124337] Dynamic subtest ccs0: SUCCESS (0.109s) [579.127106] Subtest implicit-boths: SUCCESS (0.454s) [580.421693] [125/131] (444s left) kms_color (deep-color) [580.515655] Starting subtest: deep-color [581.531558] Starting dynamic subtest: pipe-A-eDP-1-gamma [582.246402] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.713s) [582.257086] Starting dynamic subtest: pipe-A-eDP-1-degamma [583.709763] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.465s) [583.720537] Starting dynamic subtest: pipe-A-eDP-1-ctm [585.171485] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.459s) [585.927990] Starting dynamic subtest: pipe-B-eDP-1-gamma [586.646443] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.726s) [586.659208] Starting dynamic subtest: pipe-B-eDP-1-degamma [588.102687] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.453s) [588.112387] Starting dynamic subtest: pipe-B-eDP-1-ctm [589.530665] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.427s) [590.325914] Starting dynamic subtest: pipe-C-eDP-1-gamma [590.998929] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.680s) [591.013689] Starting dynamic subtest: pipe-C-eDP-1-degamma [592.371697] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.371s) [592.381929] Starting dynamic subtest: pipe-C-eDP-1-ctm [593.804984] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.433s) [594.615936] Starting dynamic subtest: pipe-D-eDP-1-gamma [595.276871] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.669s) [595.288099] Starting dynamic subtest: pipe-D-eDP-1-degamma [596.682883] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.404s) [596.696969] Starting dynamic subtest: pipe-D-eDP-1-ctm [598.105804] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.421s) [598.108187] Subtest deep-color: SUCCESS (17.587s) [599.006385] [126/131] (426s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-pgflip-blt) [599.108991] Starting subtest: fbc-2p-scndscrn-shrfb-pgflip-blt [599.113010] Subtest fbc-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [599.242361] [127/131] (425s left) gem_huc_copy (huc-copy) [599.313525] Starting subtest: huc-copy [599.315654] Subtest huc-copy: SUCCESS (0.002s) [599.467518] [128/131] (425s left) gem_lmem_swapping (verify-random) [599.511785] Subtest verify-random: SKIP (0.000s) [599.562599] [129/131] (425s left) vgem_basic (mmap) [599.604231] Starting subtest: mmap [599.623386] Subtest mmap: SUCCESS (0.021s) [599.709970] [130/131] (425s left) sriov_basic (bind-unbind-vf) [599.775968] Starting subtest: bind-unbind-vf [599.777970] Starting dynamic subtest: vf-1 [599.851452] Dynamic subtest vf-1: FAIL (0.014s) [599.863524] Starting dynamic subtest: vf-2 [599.933467] Dynamic subtest vf-2: FAIL (0.004s) [599.944465] Starting dynamic subtest: vf-3 [600.004608] Dynamic subtest vf-3: FAIL (0.004s) [600.014809] Starting dynamic subtest: vf-4 [600.073894] Dynamic subtest vf-4: FAIL (0.003s) [600.084100] Starting dynamic subtest: vf-5 [600.144502] Dynamic subtest vf-5: FAIL (0.003s) [600.155040] Starting dynamic subtest: vf-6 [600.215054] Dynamic subtest vf-6: FAIL (0.003s) [600.224774] Starting dynamic subtest: vf-7 [600.284288] Dynamic subtest vf-7: FAIL (0.004s) [600.294669] Starting dynamic subtest: vf-random [600.352836] Dynamic subtest vf-random: FAIL (0.003s) [600.362965] Starting dynamic subtest: vf-last [600.422044] Dynamic subtest vf-last: FAIL (0.449s) [600.423917] Subtest bind-unbind-vf: FAIL (0.494s) [600.461489] [131/131] (424s left) gem_ctx_isolation (nonpriv) [600.518327] Starting subtest: nonpriv [600.520115] Starting dynamic subtest: rcs0 [600.748606] Dynamic subtest rcs0: SUCCESS (0.232s) [600.760835] Starting dynamic subtest: bcs0 [600.998807] Dynamic subtest bcs0: SUCCESS (0.249s) [601.010534] Starting dynamic subtest: vcs0 [601.268170] Dynamic subtest vcs0: SUCCESS (0.268s) [601.280281] Starting dynamic subtest: vcs1 [602.570366] Dynamic subtest vcs1: SUCCESS (1.301s) [602.582546] Starting dynamic subtest: vecs0 [604.565072] Dynamic subtest vecs0: SUCCESS (1.993s) [604.577276] Starting dynamic subtest: ccs0 [606.557398] Dynamic subtest ccs0: SUCCESS (1.991s) [606.559876] Subtest nonpriv: SUCCESS (6.040s) [606.830795] Closing watchdogs results: parsing output: 0/ for test: i915_drm_fdinfo results: parsing output: 1/ for test: gem_wait results: parsing output: 2/ for test: kms_frontbuffer_tracking results: parsing output: 3/ for test: kms_big_fb results: parsing output: 4/ for test: gem_exec_create results: parsing output: 5/ for test: kms_lease results: parsing output: 6/ for test: kms_dirtyfb results: parsing output: 7/ for test: gem_workarounds results: parsing output: 8/ for test: kms_joiner results: parsing output: 9/ for test: kms_frontbuffer_tracking results: parsing output: 10/ for test: gem_eio results: parsing output: 11/ for test: kms_plane_scaling results: parsing output: 12/ for test: kms_frontbuffer_tracking results: parsing output: 13/ for test: gem_tiled_blits results: parsing output: 14/ for test: gem_ctx_engines results: parsing output: 15/ for test: gem_render_copy results: parsing output: 16/ for test: kms_cursor_legacy results: parsing output: 17/ for test: syncobj_wait results: parsing output: 18/ for test: i915_suspend results: parsing output: 19/ for test: kms_frontbuffer_tracking results: parsing output: 20/ for test: kms_frontbuffer_tracking results: parsing output: 21/ for test: kms_pm_rpm results: parsing output: 22/ for test: kms_big_fb results: parsing output: 23/ for test: gem_exec_reloc results: parsing output: 24/ for test: gem_ctx_persistence results: parsing output: 25/ for test: kms_dp_link_training results: parsing output: 26/ for test: kms_chamelium_hpd results: parsing output: 27/ for test: gem_pxp results: parsing output: 28/ for test: syncobj_wait results: parsing output: 29/ for test: gem_spin_batch results: parsing output: 30/ for test: gem_mmap_offset results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: kms_flip_scaled_crc results: parsing output: 33/ for test: kms_ccs results: parsing output: 34/ for test: kms_big_fb results: parsing output: 35/ for test: kms_chamelium_edid results: parsing output: 36/ for test: gem_exec_schedule results: parsing output: 37/ for test: gem_mmap_gtt results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: gem_exec_flush results: parsing output: 40/ for test: perf results: parsing output: 41/ for test: kms_frontbuffer_tracking results: parsing output: 42/ for test: gem_caching results: parsing output: 43/ for test: gem_exec_schedule results: parsing output: 44/ for test: gen9_exec_parse results: parsing output: 45/ for test: kms_flip results: parsing output: 46/ for test: gem_exec_fence results: parsing output: 47/ for test: kms_frontbuffer_tracking results: parsing output: 48/ for test: kms_big_fb results: parsing output: 49/ for test: kms_pm_rpm results: parsing output: 50/ for test: kms_psr results: parsing output: 51/ for test: gem_exec_whisper results: parsing output: 52/ for test: gem_exec_params results: parsing output: 53/ for test: kms_async_flips results: parsing output: 54/ for test: kms_atomic_transition results: parsing output: 55/ for test: perf_pmu results: parsing output: 56/ for test: syncobj_timeline results: parsing output: 57/ for test: gem_exec_reloc results: parsing output: 58/ for test: gem_set_tiling_vs_blt results: parsing output: 59/ for test: kms_atomic_transition results: parsing output: 60/ for test: gem_exec_reloc results: parsing output: 61/ for test: kms_flip results: parsing output: 62/ for test: kms_frontbuffer_tracking results: parsing output: 63/ for test: syncobj_timeline results: parsing output: 64/ for test: kms_frontbuffer_tracking results: parsing output: 65/ for test: api_intel_bb results: parsing output: 66/ for test: kms_cursor_legacy results: parsing output: 67/ for test: kms_frontbuffer_tracking results: parsing output: 68/ for test: kms_flip_scaled_crc results: parsing output: 69/ for test: syncobj_wait results: parsing output: 70/ for test: gen9_exec_parse results: parsing output: 71/ for test: kms_psr results: parsing output: 72/ for test: kms_psr results: parsing output: 73/ for test: kms_pipe_crc_basic results: parsing output: 74/ for test: kms_vblank results: parsing output: 75/ for test: syncobj_timeline results: parsing output: 76/ for test: kms_frontbuffer_tracking results: parsing output: 77/ for test: kms_atomic results: parsing output: 78/ for test: kms_cursor_crc results: parsing output: 79/ for test: kms_frontbuffer_tracking results: parsing output: 80/ for test: kms_cursor_crc results: parsing output: 81/ for test: syncobj_timeline results: parsing output: 82/ for test: kms_frontbuffer_tracking results: parsing output: 83/ for test: gem_pxp results: parsing output: 84/ for test: kms_sequence results: parsing output: 85/ for test: kms_psr2_sf results: parsing output: 86/ for test: kms_rotation_crc results: parsing output: 87/ for test: gem_exec_reloc results: parsing output: 88/ for test: syncobj_timeline results: parsing output: 89/ for test: kms_ccs results: parsing output: 90/ for test: api_intel_allocator results: parsing output: 91/ for test: sysfs_preempt_timeout results: parsing output: 92/ for test: kms_flip results: parsing output: 93/ for test: i915_pm_rpm results: parsing output: 94/ for test: kms_properties results: parsing output: 95/ for test: syncobj_wait results: parsing output: 96/ for test: kms_ccs results: parsing output: 97/ for test: kms_big_fb results: parsing output: 98/ for test: gem_reg_read results: parsing output: 99/ for test: kms_ccs results: parsing output: 100/ for test: kms_plane_scaling results: parsing output: 101/ for test: gem_exec_balancer results: parsing output: 102/ for test: kms_frontbuffer_tracking results: parsing output: 103/ for test: kms_psr results: parsing output: 104/ for test: gem_flink_basic results: parsing output: 105/ for test: kms_cursor_crc results: parsing output: 106/ for test: gem_eio results: parsing output: 107/ for test: kms_frontbuffer_tracking results: parsing output: 108/ for test: kms_frontbuffer_tracking results: parsing output: 109/ for test: kms_psr2_sf results: parsing output: 110/ for test: kms_psr2_sf results: parsing output: 111/ for test: gem_exec_fence results: parsing output: 112/ for test: kms_setmode results: parsing output: 113/ for test: dumb_buffer results: parsing output: 114/ for test: kms_frontbuffer_tracking results: parsing output: 115/ for test: kms_cursor_legacy results: parsing output: 116/ for test: kms_big_fb results: parsing output: 117/ for test: kms_ccs results: parsing output: 118/ for test: kms_big_fb results: parsing output: 119/ for test: perf results: parsing output: 120/ for test: fbdev results: parsing output: 121/ for test: kms_rotation_crc results: parsing output: 122/ for test: kms_plane results: parsing output: 123/ for test: gem_exec_schedule results: parsing output: 124/ for test: kms_color results: parsing output: 125/ for test: kms_frontbuffer_tracking results: parsing output: 126/ for test: gem_huc_copy results: parsing output: 127/ for test: gem_lmem_swapping results: parsing output: 128/ for test: vgem_basic results: parsing output: 129/ for test: sriov_basic results: parsing output: 130/ for test: gem_ctx_isolation Done.