[65.792209] Initializing watchdogs
[65.792293]   /dev/watchdog0
[65.822151] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics]
[65.837255] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[65.842150] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[65.844670] [001/133] (960s left) kms_psr (psr2-primary-blt)
[67.338125] Subtest psr2-primary-blt: SKIP (0.000s)
[67.438769] [002/133] (958s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[68.964856] Starting subtest: 2x-cursor-vs-flip-legacy
[68.968912] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.003s)
[69.073796] [003/133] (957s left) syncobj_wait (multi-wait-submitted-signaled)
[69.129094] Starting subtest: multi-wait-submitted-signaled
[69.129996] Subtest multi-wait-submitted-signaled: SUCCESS (0.001s)
[69.234803] [004/133] (957s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[70.741744] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[70.743876] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.001s)
[70.926408] [005/133] (955s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier)
[72.411325] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier
[72.457478] Starting dynamic subtest: pipe-A-plane-0
[72.994179] Dynamic subtest pipe-A-plane-0: SUCCESS (0.536s)
[73.024480] Starting dynamic subtest: pipe-A-plane-3
[73.342080] Dynamic subtest pipe-A-plane-3: SUCCESS (0.347s)
[73.376399] Starting dynamic subtest: pipe-A-plane-5
[73.692165] Dynamic subtest pipe-A-plane-5: SUCCESS (0.348s)
[73.711178] Starting dynamic subtest: pipe-A-plane-7
[73.713615] Dynamic subtest pipe-A-plane-7: SKIP (0.000s)
[73.837556] Starting dynamic subtest: pipe-B-plane-0
[74.230839] Dynamic subtest pipe-B-plane-0: SUCCESS (0.400s)
[74.247491] Starting dynamic subtest: pipe-B-plane-3
[74.548150] Dynamic subtest pipe-B-plane-3: SUCCESS (0.316s)
[74.576544] Starting dynamic subtest: pipe-B-plane-5
[74.898639] Dynamic subtest pipe-B-plane-5: SUCCESS (0.349s)
[74.933856] Starting dynamic subtest: pipe-B-plane-7
[74.936413] Dynamic subtest pipe-B-plane-7: SKIP (0.000s)
[74.989983] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier: SUCCESS (2.576s)
[75.140674] [006/133] (951s left) gem_exec_whisper (basic-contexts-forked-all)
[75.202173] Starting subtest: basic-contexts-forked-all
[87.986127] Subtest basic-contexts-forked-all: SUCCESS (12.779s)
[88.211452] [007/133] (938s left) gem_eio (wait-wedge-10ms)
[88.417467] Starting subtest: wait-wedge-10ms
[89.891751] Subtest wait-wedge-10ms: SUCCESS (1.474s)
[91.488046] [008/133] (935s left) gem_exec_alignment (many)
[91.546398] Starting subtest: many
[110.299921] Subtest many: SUCCESS (18.751s)
[110.823621] [009/133] (916s left) gem_userptr_blits (huge-split)
[110.943846] Starting subtest: huge-split
[110.963768] Subtest huge-split: SUCCESS (0.020s)
[111.169230] [010/133] (915s left) gem_exec_gttfill (all-engines)
[111.225454] Starting subtest: all-engines
[138.084445] Subtest all-engines: SUCCESS (26.856s)
[138.441987] [011/133] (888s left) gem_exec_schedule (lateslice)
[138.548439] Starting subtest: lateslice
[138.549255] Starting dynamic subtest: rcs0
[138.587211] Dynamic subtest rcs0: SUCCESS (0.039s)
[138.596899] Starting dynamic subtest: bcs0
[138.606802] Dynamic subtest bcs0: SUCCESS (0.019s)
[138.616435] Starting dynamic subtest: vcs0
[138.627178] Dynamic subtest vcs0: SUCCESS (0.020s)
[138.636778] Starting dynamic subtest: vcs1
[138.648172] Dynamic subtest vcs1: SUCCESS (0.021s)
[138.657738] Starting dynamic subtest: vecs0
[138.669416] Dynamic subtest vecs0: SUCCESS (0.021s)
[138.670285] Subtest lateslice: SUCCESS (0.121s)
[139.109020] [012/133] (888s left) gem_tiling_max_stride
[139.218170] [013/133] (888s left) kms_psr (psr-dpms)
[140.706903] Subtest psr-dpms: SKIP (0.000s)
[140.790159] [014/133] (886s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[142.300222] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[142.301877] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[142.463708] [015/133] (885s left) gen9_exec_parse (basic-rejected-ctx-param)
[142.515692] Subtest basic-rejected-ctx-param: SKIP (0.000s)
[142.585152] [016/133] (884s left) gem_ctx_persistence (legacy-engines-cleanup)
[142.635261] Starting subtest: legacy-engines-cleanup
[142.636263] Starting dynamic subtest: render
[142.692413] Dynamic subtest render: SUCCESS (0.057s)
[142.705590] Starting dynamic subtest: bsd1
[142.706743] Dynamic subtest bsd1: SUCCESS (0.013s)
[142.719336] Starting dynamic subtest: bsd2
[142.745515] Dynamic subtest bsd2: SUCCESS (0.038s)
[142.759277] Starting dynamic subtest: blt
[142.789673] Dynamic subtest blt: SUCCESS (0.043s)
[142.809334] Starting dynamic subtest: vebox
[142.836960] Dynamic subtest vebox: SUCCESS (0.045s)
[142.839312] Subtest legacy-engines-cleanup: SUCCESS (0.202s)
[143.029629] [017/133] (884s left) kms_getfb (getfb2-handle-protection)
[144.516838] Starting subtest: getfb2-handle-protection
[144.534459] Subtest getfb2-handle-protection: SUCCESS (0.018s)
[144.753717] [018/133] (882s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[146.239401] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[146.240284] Starting dynamic subtest: pipe-A
[146.465948] Dynamic subtest pipe-A: SUCCESS (0.226s)
[146.475944] Starting dynamic subtest: pipe-B
[146.607156] Dynamic subtest pipe-B: SUCCESS (0.141s)
[146.616783] Starting dynamic subtest: pipe-C
[146.747257] Dynamic subtest pipe-C: SUCCESS (0.140s)
[146.756531] Starting dynamic subtest: pipe-D
[146.887328] Dynamic subtest pipe-D: SUCCESS (0.140s)
[146.888274] Subtest planes-downscale-factor-0-5-unity-scaling: SUCCESS (0.648s)
[147.069136] [019/133] (880s left) syncobj_wait (single-wait-for-submit-submitted)
[147.115291] Starting subtest: single-wait-for-submit-submitted
[147.225503] Subtest single-wait-for-submit-submitted: SUCCESS (0.106s)
[147.380719] [020/133] (880s left) syncobj_wait (wait-any-interrupted)
[147.427045] Starting subtest: wait-any-interrupted
[147.530574] Subtest wait-any-interrupted: SUCCESS (0.101s)
[147.672547] [021/133] (880s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[149.161746] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[149.163398] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[149.339156] [022/133] (878s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-blt)
[150.828278] Starting subtest: psr-2p-primscrn-spr-indfb-draw-blt
[150.829914] Subtest psr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[151.001417] [023/133] (877s left) kms_big_fb (yf-tiled-32bpp-rotate-0)
[152.509925] Starting subtest: yf-tiled-32bpp-rotate-0
[152.511894] Subtest yf-tiled-32bpp-rotate-0: SKIP (0.000s)
[152.707818] [024/133] (875s left) syncobj_timeline (etime-multi-wait-for-submit-submitted)
[152.753941] Starting subtest: etime-multi-wait-for-submit-submitted
[152.865530] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.107s)
[152.970827] [025/133] (875s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-blt)
[154.459968] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-blt
[156.917960] Subtest fbc-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (2.458s)
[157.092163] [026/133] (871s left) kms_psr (fbc-psr-cursor-mmap-cpu)
[158.576325] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.000s)
[158.648572] [027/133] (869s left) prime_vgem (coherency-blt)
[158.828782] Starting subtest: coherency-blt
[161.573624] Subtest coherency-blt: SUCCESS (2.742s)
[161.734459] [FACT prime_vgem (coherency-blt)] new: kernel.kmod_is_loaded.vgem: true
[161.736264] [028/133] (866s left) perf_pmu (frequency)
[161.785156] Starting subtest: frequency
[161.788404] Starting dynamic subtest: gt0
[164.032156] Dynamic subtest gt0: FAIL (2.179s)
[164.066724] Starting dynamic subtest: idle-gt0
[164.478281] Dynamic subtest idle-gt0: SUCCESS (0.504s)
[164.480303] Subtest frequency: FAIL (2.692s)
[164.594182] [029/133] (864s left) kms_cursor_legacy (single-bo)
[166.078955] Starting subtest: single-bo
[166.079985] Starting dynamic subtest: pipe-A
[171.465134] Dynamic subtest pipe-A: SUCCESS (5.383s)
[171.476367] Starting dynamic subtest: pipe-B
[176.849680] Dynamic subtest pipe-B: SUCCESS (5.382s)
[176.860163] Starting dynamic subtest: pipe-C
[182.228845] Dynamic subtest pipe-C: SUCCESS (5.381s)
[182.239412] Starting dynamic subtest: pipe-D
[187.610830] Dynamic subtest pipe-D: SUCCESS (5.382s)
[187.621347] Starting dynamic subtest: all-pipes
[192.993597] Dynamic subtest all-pipes: SUCCESS (5.382s)
[192.994399] Subtest single-bo: SUCCESS (26.911s)
[193.108673] [030/133] (835s left) kms_flip (2x-absolute-wf_vblank)
[194.594855] Starting subtest: 2x-absolute-wf_vblank
[194.614271] Subtest 2x-absolute-wf_vblank: SKIP (0.019s)
[194.733815] [031/133] (834s left) kms_prop_blob (invalid-get-prop-any)
[194.786109] Starting subtest: invalid-get-prop-any
[194.787154] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[194.894862] [032/133] (833s left) kms_invalid_mode (zero-vdisplay)
[196.379993] Starting subtest: zero-vdisplay
[196.380926] Starting dynamic subtest: pipe-A-HDMI-A-3
[196.415611] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.035s)
[196.427378] Starting dynamic subtest: pipe-B-HDMI-A-3
[196.428336] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.001s)
[196.438846] Starting dynamic subtest: pipe-C-HDMI-A-3
[196.439946] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.001s)
[196.451482] Starting dynamic subtest: pipe-D-HDMI-A-3
[196.452280] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.001s)
[196.453134] Subtest zero-vdisplay: SUCCESS (0.043s)
[196.593152] [033/133] (832s left) gem_render_copy (linear)
[196.645389] Starting subtest: linear
[196.646236] Starting dynamic subtest: smem
[196.736208] Dynamic subtest smem: SUCCESS (0.091s)
[196.747031] Starting dynamic subtest: lmem0
[196.873110] Dynamic subtest lmem0: SUCCESS (0.133s)
[196.874153] Subtest linear: SUCCESS (0.224s)
[197.127201] [034/133] (831s left) kms_async_flips (crc-atomic)
[198.612165] Starting subtest: crc-atomic
[198.864203] Starting dynamic subtest: pipe-A-HDMI-A-3
[201.318670] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.451s)
[201.511506] Starting dynamic subtest: pipe-B-HDMI-A-3
[203.679157] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (2.175s)
[203.850327] Starting dynamic subtest: pipe-C-HDMI-A-3
[206.025131] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (2.182s)
[206.204499] Starting dynamic subtest: pipe-D-HDMI-A-3
[208.368822] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.171s)
[208.369747] Subtest crc-atomic: SUCCESS (9.755s)
[208.711782] [035/133] (820s left) kms_chamelium_hpd (vga-hpd-after-suspend)
[210.238125] Subtest vga-hpd-after-suspend: SKIP (0.000s)
[210.356921] [036/133] (818s left) kms_pipe_crc_basic (read-crc)
[211.841499] Starting subtest: read-crc
[211.843410] Starting dynamic subtest: pipe-A-HDMI-A-3
[212.534230] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.690s)
[212.546318] Starting dynamic subtest: pipe-B-HDMI-A-3
[213.062823] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.527s)
[213.074781] Starting dynamic subtest: pipe-C-HDMI-A-3
[213.562262] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.497s)
[213.573136] Starting dynamic subtest: pipe-D-HDMI-A-3
[214.036271] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.472s)
[214.037207] Subtest read-crc: SUCCESS (2.194s)
[214.214250] [037/133] (815s left) gem_mmap_gtt (cpuset-medium-copy)
[214.259381] Subtest cpuset-medium-copy: SKIP (0.000s)
[214.340973] [038/133] (814s left) gem_exec_fence (keep-in-fence)
[214.537963] Starting subtest: keep-in-fence
[214.538870] Starting dynamic subtest: rcs0
[214.607644] Dynamic subtest rcs0: SUCCESS (0.069s)
[214.645667] Starting dynamic subtest: bcs0
[214.686013] Dynamic subtest bcs0: SUCCESS (0.077s)
[214.702981] Starting dynamic subtest: vcs0
[214.742331] Dynamic subtest vcs0: SUCCESS (0.055s)
[214.772810] Starting dynamic subtest: vcs1
[214.813158] Dynamic subtest vcs1: SUCCESS (0.070s)
[214.838857] Starting dynamic subtest: vecs0
[214.880242] Dynamic subtest vecs0: SUCCESS (0.066s)
[214.881548] Subtest keep-in-fence: SUCCESS (0.344s)
[215.500863] [039/133] (813s left) sysfs_heartbeat_interval (invalid)
[215.550323] Starting subtest: invalid
[215.551190] Starting dynamic subtest: vecs0
[215.551987] Dynamic subtest vecs0: SUCCESS (0.000s)
[215.562896] Starting dynamic subtest: vcs0
[215.563774] Dynamic subtest vcs0: SUCCESS (0.000s)
[215.574563] Starting dynamic subtest: bcs0
[215.575629] Dynamic subtest bcs0: SUCCESS (0.000s)
[215.586239] Starting dynamic subtest: rcs0
[215.587372] Dynamic subtest rcs0: SUCCESS (0.000s)
[215.599411] Starting dynamic subtest: vcs1
[215.600303] Dynamic subtest vcs1: SUCCESS (0.000s)
[215.601227] Subtest invalid: SUCCESS (0.004s)
[215.663566] [040/133] (813s left) kms_ccs (crc-primary-rotation-180-y-tiled-ccs)
[217.147623] Starting subtest: crc-primary-rotation-180-y-tiled-ccs
[217.149561] Starting dynamic subtest: pipe-A-HDMI-A-3
[217.158719] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.001s)
[217.169708] Starting dynamic subtest: pipe-B-HDMI-A-3
[217.183604] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.001s)
[217.194195] Starting dynamic subtest: pipe-C-HDMI-A-3
[217.201625] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.001s)
[217.212222] Starting dynamic subtest: pipe-D-HDMI-A-3
[217.219891] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.001s)
[217.221415] Subtest crc-primary-rotation-180-y-tiled-ccs: SKIP (0.010s)
[217.409678] [041/133] (812s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted)
[217.455358] Starting subtest: invalid-multi-wait-unsubmitted-submitted
[217.456186] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s)
[217.570445] [042/133] (811s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[219.058793] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[219.060502] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[219.244985] [043/133] (810s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[220.733886] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[220.735875] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[220.940774] [044/133] (808s left) kms_draw_crc (draw-method-mmap-cpu)
[222.425959] Starting subtest: draw-method-mmap-cpu
[222.426894] Starting dynamic subtest: xrgb8888-untiled
[222.794754] Dynamic subtest xrgb8888-untiled: SUCCESS (0.368s)
[222.836470] Starting dynamic subtest: rgb565-untiled
[223.128209] Dynamic subtest rgb565-untiled: SUCCESS (0.331s)
[223.170993] Starting dynamic subtest: xrgb2101010-untiled
[223.460050] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.330s)
[223.473177] Starting dynamic subtest: xbgr16161616f-untiled
[223.794194] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.333s)
[223.809153] Starting dynamic subtest: xrgb8888-xtiled
[223.961414] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.165s)
[224.002224] Starting dynamic subtest: rgb565-xtiled
[224.161493] Dynamic subtest rgb565-xtiled: SUCCESS (0.197s)
[224.202411] Starting dynamic subtest: xrgb2101010-xtiled
[224.343384] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.180s)
[224.357054] Starting dynamic subtest: xbgr16161616f-xtiled
[224.510033] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.166s)
[224.523549] Starting dynamic subtest: xrgb8888-ytiled
[224.677967] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.166s)
[224.720789] Starting dynamic subtest: rgb565-ytiled
[224.877992] Dynamic subtest rgb565-ytiled: SUCCESS (0.197s)
[224.918974] Starting dynamic subtest: xrgb2101010-ytiled
[225.059900] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.180s)
[225.072975] Starting dynamic subtest: xbgr16161616f-ytiled
[225.228198] Dynamic subtest xbgr16161616f-ytiled: SUCCESS (0.166s)
[225.230323] Subtest draw-method-mmap-cpu: SUCCESS (2.803s)
[225.470349] [045/133] (804s left) sw_sync (sync_merge)
[225.513227] Starting subtest: sync_merge
[225.514218] Subtest sync_merge: SUCCESS (0.000s)
[225.612918] [046/133] (804s left) kms_content_protection (mei-interface)
[227.154794] Starting subtest: mei-interface
[227.157351] Subtest mei-interface: SKIP (0.001s)
[227.358330] [047/133] (802s left) prime_mmap (test_correct_cpu_write)
[227.402339] Starting subtest: test_correct_cpu_write
[227.403187] Starting dynamic subtest: test_correct_cpu_write-smem
[227.404026] Dynamic subtest test_correct_cpu_write-smem: SUCCESS (0.000s)
[227.414937] Starting dynamic subtest: test_correct_cpu_write-lmem0
[227.416094] Dynamic subtest test_correct_cpu_write-lmem0: SUCCESS (0.000s)
[227.417084] Subtest test_correct_cpu_write: SUCCESS (0.002s)
[227.537959] [048/133] (802s left) kms_plane (plane-position-hole)
[229.024048] Starting subtest: plane-position-hole
[229.483909] Starting dynamic subtest: pipe-A-plane-1
[229.862440] Dynamic subtest pipe-A-plane-1: SUCCESS (0.379s)
[229.873428] Starting dynamic subtest: pipe-A-plane-2
[230.257486] Dynamic subtest pipe-A-plane-2: SUCCESS (0.395s)
[230.268499] Starting dynamic subtest: pipe-A-plane-3
[230.652399] Dynamic subtest pipe-A-plane-3: SUCCESS (0.394s)
[230.663312] Starting dynamic subtest: pipe-A-plane-4
[231.047343] Dynamic subtest pipe-A-plane-4: SUCCESS (0.394s)
[231.058137] Starting dynamic subtest: pipe-A-plane-5
[231.443281] Dynamic subtest pipe-A-plane-5: SUCCESS (0.394s)
[231.454034] Starting dynamic subtest: pipe-A-plane-6
[231.838107] Dynamic subtest pipe-A-plane-6: SUCCESS (0.394s)
[231.849139] Starting dynamic subtest: pipe-A-plane-7
[231.858477] Dynamic subtest pipe-A-plane-7: SUCCESS (0.020s)
[232.149699] Starting dynamic subtest: pipe-B-plane-1
[232.519125] Dynamic subtest pipe-B-plane-1: SUCCESS (0.380s)
[232.530721] Starting dynamic subtest: pipe-B-plane-2
[232.881243] Dynamic subtest pipe-B-plane-2: SUCCESS (0.361s)
[232.892213] Starting dynamic subtest: pipe-B-plane-3
[233.245343] Dynamic subtest pipe-B-plane-3: SUCCESS (0.364s)
[233.256244] Starting dynamic subtest: pipe-B-plane-4
[233.641243] Dynamic subtest pipe-B-plane-4: SUCCESS (0.394s)
[233.652220] Starting dynamic subtest: pipe-B-plane-5
[234.038478] Dynamic subtest pipe-B-plane-5: SUCCESS (0.397s)
[234.049564] Starting dynamic subtest: pipe-B-plane-6
[234.434309] Dynamic subtest pipe-B-plane-6: SUCCESS (0.394s)
[234.445239] Starting dynamic subtest: pipe-B-plane-7
[234.461181] Dynamic subtest pipe-B-plane-7: SUCCESS (0.025s)
[234.462166] Subtest plane-position-hole: SUCCESS (5.438s)
[234.668974] [049/133] (795s left) gem_exec_flush (basic-uc-pro-default)
[234.721557] Subtest basic-uc-pro-default: SKIP (0.000s)
[234.812087] [050/133] (795s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[236.300648] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[236.302248] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[236.484061] [051/133] (793s left) gem_eio (hibernate)
[236.671359] Starting subtest: hibernate
[253.413195] Subtest hibernate: SUCCESS (16.743s)
[258.985805] [052/133] (775s left) gem_pread (display)
[259.108218] Subtest display: SKIP (0.000s)
[259.199042] [053/133] (775s left) gem_render_copy (linear-to-vebox-yf-tiled)
[259.250466] Starting subtest: linear-to-vebox-yf-tiled
[259.251290] Starting dynamic subtest: smem
[259.333643] Dynamic subtest smem: SUCCESS (0.083s)
[259.347507] Starting dynamic subtest: lmem0
[260.088640] Dynamic subtest lmem0: SUCCESS (0.751s)
[260.089860] Subtest linear-to-vebox-yf-tiled: SUCCESS (0.835s)
[260.354517] [054/133] (774s left) perf (blocking-parameterized)
[260.489111] Starting subtest: blocking-parameterized
[280.532943] Subtest blocking-parameterized: SUCCESS (20.041s)
[280.603397] [055/133] (754s left) kms_lease (multimaster-lease)
[282.089020] Starting subtest: multimaster-lease
[282.092279] Subtest multimaster-lease: SUCCESS (0.004s)
[282.221808] [056/133] (752s left) gem_exec_balancer (sliced)
[282.285151] Starting subtest: sliced
[282.287245] Subtest sliced: SKIP (0.000s)
[282.754749] [057/133] (752s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted-signaled)
[282.800756] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[282.801557] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[282.945272] [058/133] (752s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[284.449127] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[285.087747] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.638s)
[285.279489] [059/133] (749s left) gem_softpin (allocator-evict)
[285.331944] Starting subtest: allocator-evict
[285.332930] Starting dynamic subtest: rcs0
[313.321223] Dynamic subtest rcs0: SUCCESS (27.991s)
[313.334847] Starting dynamic subtest: bcs0
[341.551512] Dynamic subtest bcs0: SUCCESS (28.227s)
[341.564380] Starting dynamic subtest: vcs0
[370.107245] Dynamic subtest vcs0: SUCCESS (28.555s)
[370.120471] Starting dynamic subtest: vcs1
[398.563405] Dynamic subtest vcs1: SUCCESS (28.456s)
[398.576341] Starting dynamic subtest: vecs0
[427.049506] Dynamic subtest vecs0: SUCCESS (28.486s)
[427.050464] Subtest allocator-evict: SUCCESS (141.719s)
[427.238576] [060/133] (607s left) gem_ctx_create (basic)
[427.336862] Starting subtest: basic
[427.337803] Subtest basic: SUCCESS (0.000s)
[427.552315] [061/133] (607s left) kms_chamelium_audio (dp-audio)
[429.091913] Subtest dp-audio: SKIP (0.000s)
[429.211738] [062/133] (606s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-upscaling)
[430.697198] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-upscaling
[430.698969] Subtest flip-32bpp-yftile-to-64bpp-yftile-upscaling: SKIP (0.000s)
[430.835201] [063/133] (604s left) gem_exec_await (wide-contexts)
[430.996850] Starting subtest: wide-contexts
[452.909875] Subtest wide-contexts: SUCCESS (21.913s)
[453.161564] [064/133] (582s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-move)
[454.704701] Starting subtest: fbc-2p-scndscrn-cur-indfb-move
[454.706343] Subtest fbc-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[454.908681] [065/133] (580s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs)
[454.961783] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs
[454.962639] Starting dynamic subtest: smem
[455.068776] Dynamic subtest smem: SUCCESS (0.107s)
[455.082067] Starting dynamic subtest: lmem0
[456.178795] Dynamic subtest lmem0: SUCCESS (1.106s)
[456.180052] Subtest y-tiled-ccs-to-yf-tiled-ccs: SUCCESS (1.214s)
[456.455261] [066/133] (579s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-downscaling)
[457.939664] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-downscaling
[457.941494] Subtest flip-64bpp-4tile-to-32bpp-4tile-downscaling: SKIP (0.000s)
[458.063576] [067/133] (577s left) i915_pm_rpm (gem-execbuf)
[462.032066] Starting subtest: gem-execbuf
[462.034175] Starting dynamic subtest: lmem0
[466.276625] Dynamic subtest lmem0: SUCCESS (4.246s)
[466.349538] Starting dynamic subtest: smem0
[469.467134] Dynamic subtest smem0: SUCCESS (3.183s)
[469.473509] Subtest gem-execbuf: SUCCESS (7.441s)
[470.468414] [068/133] (565s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[471.959983] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[471.961951] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[472.177017] [069/133] (563s left) syncobj_timeline (multi-wait-available-submitted-signaled)
[472.231313] Starting subtest: multi-wait-available-submitted-signaled
[472.232234] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.001s)
[472.339928] [070/133] (563s left) prime_mmap (test_userptr)
[472.386376] Starting subtest: test_userptr
[472.387237] Starting dynamic subtest: test_userptr-smem
[472.388121] Dynamic subtest test_userptr-smem: SUCCESS (0.000s)
[472.389266] Subtest test_userptr: SUCCESS (0.001s)
[472.570851] [071/133] (563s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-onoff)
[474.061767] Starting subtest: fbc-2p-scndscrn-cur-indfb-onoff
[474.063355] Subtest fbc-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[474.236791] [072/133] (562s left) core_getstats (basic)
[474.281961] Starting subtest: basic
[474.282832] Subtest basic: SUCCESS (0.000s)
[474.401098] [073/133] (561s left) gem_exec_schedule (semaphore-noskip)
[474.462269] Starting subtest: semaphore-noskip
[474.833224] Subtest semaphore-noskip: SUCCESS (0.367s)
[475.275048] [074/133] (561s left) gen9_exec_parse (shadow-peek)
[475.326236] Subtest shadow-peek: SKIP (0.000s)
[475.401157] [075/133] (561s left) api_intel_allocator (reopen-fork)
[475.446251] Starting subtest: reopen-fork
[478.696534] Subtest reopen-fork: SUCCESS (3.248s)
[478.887831] [076/133] (557s left) kms_async_flips (alternate-sync-async-flip)
[480.373135] Starting subtest: alternate-sync-async-flip
[480.638536] Starting dynamic subtest: pipe-A-HDMI-A-3
[483.000220] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.357s)
[483.193824] Starting dynamic subtest: pipe-B-HDMI-A-3
[485.267420] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (2.085s)
[485.474129] Starting dynamic subtest: pipe-C-HDMI-A-3
[487.563451] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (2.098s)
[487.776286] Starting dynamic subtest: pipe-D-HDMI-A-3
[489.857596] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.090s)
[489.859679] Subtest alternate-sync-async-flip: SUCCESS (9.484s)
[490.222758] [077/133] (546s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-atomic)
[491.708279] Starting subtest: flip-vs-cursor-busy-crc-atomic
[492.442859] Subtest flip-vs-cursor-busy-crc-atomic: SUCCESS (0.733s)
[492.621223] [078/133] (544s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite)
[494.113707] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite
[494.115310] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[494.309252] [079/133] (542s left) kms_frontbuffer_tracking (fbc-suspend)
[495.797854] Starting subtest: fbc-suspend
[551.343757] Subtest fbc-suspend: SUCCESS (23.347s)
[554.606726] [080/133] (485s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[556.092930] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[556.095326] Starting dynamic subtest: pipe-A-HDMI-A-3
[556.106678] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s)
[556.121722] Starting dynamic subtest: pipe-B-HDMI-A-3
[556.129568] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s)
[556.144202] Starting dynamic subtest: pipe-C-HDMI-A-3
[556.151979] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s)
[556.166391] Starting dynamic subtest: pipe-D-HDMI-A-3
[556.174597] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s)
[556.176200] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SKIP (0.009s)
[556.362600] [081/133] (483s left) kms_pm_rpm (legacy-planes-dpms)
[560.184396] Starting subtest: legacy-planes-dpms
[560.185391] Starting dynamic subtest: plane-65
[567.065150] Dynamic subtest plane-65: SUCCESS (6.879s)
[567.144234] Starting dynamic subtest: plane-95
[574.084653] Dynamic subtest plane-95: SUCCESS (7.013s)
[574.165843] Starting dynamic subtest: plane-125
[581.100709] Dynamic subtest plane-125: SUCCESS (7.009s)
[581.191027] Starting dynamic subtest: plane-135
[588.093826] Dynamic subtest plane-135: SUCCESS (6.986s)
[588.174483] Starting dynamic subtest: plane-145
[594.977367] Dynamic subtest plane-145: SUCCESS (6.877s)
[595.057840] Starting dynamic subtest: plane-155
[601.967960] Dynamic subtest plane-155: SUCCESS (6.983s)
[601.977430] Subtest legacy-planes-dpms: SUCCESS (41.787s)
[602.977923] [082/133] (437s left) kms_pm_dc (dc5-retention-flops)
[605.472977] Starting subtest: dc5-retention-flops
[605.474911] Subtest dc5-retention-flops: SKIP (0.000s)
[605.632725] [083/133] (434s left) kms_frontbuffer_tracking (psr-rgb101010-draw-render)
[607.125490] Starting subtest: psr-rgb101010-draw-render
[607.127359] Subtest psr-rgb101010-draw-render: SKIP (0.000s)
[607.317887] [084/133] (433s left) syncobj_timeline (single-wait-available-submitted)
[607.363882] Starting subtest: single-wait-available-submitted
[607.364761] Subtest single-wait-available-submitted: SUCCESS (0.000s)
[607.502100] [085/133] (432s left) gem_pxp (create-valid-protected-context)
[610.071453] Starting subtest: create-valid-protected-context
[610.073606] Subtest create-valid-protected-context: SKIP (0.000s)
[610.189582] [086/133] (430s left) kms_vblank (query-forked-busy)
[611.677795] Starting subtest: query-forked-busy
[611.678925] Starting dynamic subtest: pipe-A-HDMI-A-3
[614.275706] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.595s)
[614.341003] Starting dynamic subtest: pipe-D-HDMI-A-3
[616.778373] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.474s)
[616.780584] Subtest query-forked-busy: SUCCESS (5.103s)
[616.978491] [087/133] (423s left) gem_mmap_gtt (fault-concurrent)
[617.024507] Subtest fault-concurrent: SKIP (0.000s)
[617.106656] [088/133] (423s left) template (b)
[617.151369] Starting subtest: B
[617.152214] Subtest B: SUCCESS (0.000s)
[617.263363] [089/133] (423s left) kms_color_pipeline (plane-lut1d-post-ctm3x4)
[618.752827] Starting subtest: plane-lut1d-post-ctm3x4
[618.962262] Starting dynamic subtest: pipe-A-plane-0
[619.224613] Dynamic subtest pipe-A-plane-0: SUCCESS (0.263s)
[619.252669] Starting dynamic subtest: pipe-A-plane-1
[619.425910] Dynamic subtest pipe-A-plane-1: SUCCESS (0.197s)
[619.457770] Starting dynamic subtest: pipe-A-plane-2
[619.609388] Dynamic subtest pipe-A-plane-2: SUCCESS (0.177s)
[619.938487] Starting dynamic subtest: pipe-B-plane-0
[620.087904] Dynamic subtest pipe-B-plane-0: SUCCESS (0.197s)
[620.112205] Starting dynamic subtest: pipe-B-plane-1
[620.274818] Dynamic subtest pipe-B-plane-1: SUCCESS (0.182s)
[620.314536] Starting dynamic subtest: pipe-B-plane-2
[620.489674] Dynamic subtest pipe-B-plane-2: SUCCESS (0.209s)
[620.792097] Starting dynamic subtest: pipe-C-plane-0
[620.954500] Dynamic subtest pipe-C-plane-0: SUCCESS (0.197s)
[620.990707] Starting dynamic subtest: pipe-C-plane-1
[621.167367] Dynamic subtest pipe-C-plane-1: SUCCESS (0.209s)
[621.206208] Starting dynamic subtest: pipe-C-plane-2
[621.383982] Dynamic subtest pipe-C-plane-2: SUCCESS (0.209s)
[621.699146] Starting dynamic subtest: pipe-D-plane-0
[621.879319] Dynamic subtest pipe-D-plane-0: SUCCESS (0.213s)
[621.915963] Starting dynamic subtest: pipe-D-plane-1
[622.096107] Dynamic subtest pipe-D-plane-1: SUCCESS (0.209s)
[622.138923] Starting dynamic subtest: pipe-D-plane-2
[622.312815] Dynamic subtest pipe-D-plane-2: SUCCESS (0.209s)
[622.368021] Subtest plane-lut1d-post-ctm3x4: SUCCESS (3.615s)
[622.548545] [090/133] (418s left) gem_mmap_gtt (hang-user)
[622.594031] Subtest hang-user: SKIP (0.000s)
[622.677314] [091/133] (418s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[624.187242] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[624.188907] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[624.349719] [092/133] (416s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[625.841967] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[625.843642] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[626.043949] [093/133] (415s left) kms_flip (2x-dpms-vs-vblank-race)
[627.531548] Starting subtest: 2x-dpms-vs-vblank-race
[627.550003] Subtest 2x-dpms-vs-vblank-race: SKIP (0.019s)
[627.680445] [094/133] (413s left) dumb_buffer (create-valid-dumb)
[627.729200] Starting subtest: create-valid-dumb
[627.730177] Subtest create-valid-dumb: SUCCESS (0.000s)
[627.904278] [095/133] (413s left) gem_compute (compute-square)
[627.949284] Starting subtest: compute-square
[627.959755] Subtest compute-square: SUCCESS (0.011s)
[628.150020] [096/133] (413s left) kms_frontbuffer_tracking (psr-slowdraw)
[629.640807] Starting subtest: psr-slowdraw
[629.642446] Subtest psr-slowdraw: SKIP (0.000s)
[629.846935] [097/133] (411s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions-varying-size)
[631.339256] Starting subtest: short-flip-before-cursor-atomic-transitions-varying-size
[632.367614] Subtest short-flip-before-cursor-atomic-transitions-varying-size: SUCCESS (1.029s)
[632.559744] [098/133] (409s left) kms_psr (pr-sprite-blt)
[634.046024] Subtest pr-sprite-blt: SKIP (0.000s)
[634.134934] [099/133] (407s left) gem_userptr_blits (create-destroy-unsync)
[634.189781] Subtest create-destroy-unsync: SKIP (0.000s)
[634.412634] [100/133] (407s left) kms_selftest (drm_format_helper)
[634.465514] Starting subtest: drm_format_helper
[634.505392] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8
[634.569751] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.065s)
[634.587665] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332
[634.661340] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.089s)
[634.710448] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565
[634.740332] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.073s)
[634.759926] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555
[634.813959] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.070s)
[634.862517] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555
[634.888691] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.071s)
[634.908379] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551
[634.957927] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.067s)
[634.993987] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888
[635.037084] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.074s)
[635.081305] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888
[635.110756] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.070s)
[635.129933] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888
[635.199371] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.087s)
[635.256099] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010
[635.275801] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.068s)
[635.292482] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010
[635.348296] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.071s)
[635.378155] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono
[635.413639] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.062s)
[635.444882] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab
[635.483785] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.068s)
[635.512032] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888
[635.556292] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.068s)
[635.591483] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888
[635.623896] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.065s)
[635.644987] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset
[635.699909] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.074s)
[635.750394] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy
[635.785421] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.078s)
[635.786253] Subtest drm_format_helper: SUCCESS (1.320s)
[636.007718] [101/133] (405s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted)
[636.054413] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted
[636.159906] Subtest etime-multi-wait-all-for-submit-unsubmitted: SUCCESS (0.101s)
[636.316580] [102/133] (405s left) kms_big_fb (y-tiled-8bpp-rotate-270)
[637.823608] Starting subtest: y-tiled-8bpp-rotate-270
[637.924787] Subtest y-tiled-8bpp-rotate-270: SKIP (0.102s)
[638.092230] [103/133] (403s left) kms_cursor_crc (cursor-offscreen-32x10)
[639.688327] Starting subtest: cursor-offscreen-32x10
[639.743827] Subtest cursor-offscreen-32x10: SKIP (0.053s)
[640.165542] [104/133] (402s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc)
[641.652354] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc
[641.653576] Starting dynamic subtest: pipe-A-HDMI-A-3
[641.661944] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s)
[641.676703] Starting dynamic subtest: pipe-B-HDMI-A-3
[641.684754] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s)
[641.699328] Starting dynamic subtest: pipe-C-HDMI-A-3
[641.708029] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s)
[641.722338] Starting dynamic subtest: pipe-D-HDMI-A-3
[641.731074] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s)
[641.732900] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.011s)
[641.919745] [105/133] (400s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[643.411879] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[643.413537] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[643.604897] [106/133] (398s left) kms_cursor_edge_walk (128x128-right-edge)
[645.091622] Starting subtest: 128x128-right-edge
[645.092674] Starting dynamic subtest: pipe-A-HDMI-A-3
[648.409489] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (3.317s)
[648.426389] Starting dynamic subtest: pipe-D-HDMI-A-3
[651.631507] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (3.219s)
[651.632344] Subtest 128x128-right-edge: SUCCESS (6.542s)
[651.816302] [107/133] (390s left) kms_psr (fbc-pr-primary-render)
[653.303101] Subtest fbc-pr-primary-render: SKIP (0.000s)
[653.394796] [108/133] (389s left) gem_exec_whisper (basic-sync-all)
[653.455012] Starting subtest: basic-sync-all
[656.907056] Subtest basic-sync-all: SUCCESS (3.453s)
[657.217930] [109/133] (385s left) syncobj_basic (create-signaled)
[657.262915] Starting subtest: create-signaled
[657.263792] Subtest create-signaled: SUCCESS (0.000s)
[657.388894] [110/133] (385s left) gem_request_retire (retire-vma-not-inactive)
[657.438440] Starting subtest: retire-vma-not-inactive
[657.474448] Subtest retire-vma-not-inactive: SUCCESS (0.035s)
[657.680139] [111/133] (385s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[659.165416] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[659.167179] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[659.382103] [112/133] (383s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-sf)
[660.868548] Subtest psr2-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[660.962806] [113/133] (382s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping)
[662.449817] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping
[662.451539] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping: SKIP (0.000s)
[662.601802] [114/133] (380s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-plflip-blt)
[664.093231] Starting subtest: fbcpsr-2p-scndscrn-shrfb-plflip-blt
[664.095009] Subtest fbcpsr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[664.327984] [115/133] (378s left) syncobj_wait (invalid-signal-bad-pad)
[664.375377] Starting subtest: invalid-signal-bad-pad
[664.376201] Subtest invalid-signal-bad-pad: SUCCESS (0.000s)
[664.493266] [116/133] (378s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[665.983922] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[665.985730] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[666.171283] [117/133] (377s left) kms_chamelium_frames (hdmi-crc-nonplanar-formats)
[667.712126] Subtest hdmi-crc-nonplanar-formats: SKIP (0.000s)
[667.835736] [118/133] (375s left) kms_atomic_transition (plane-all-transition-nonblocking-fencing)
[669.322389] Starting subtest: plane-all-transition-nonblocking-fencing
[669.323599] Starting dynamic subtest: pipe-A-HDMI-A-3
[673.149914] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (3.826s)
[673.221355] Starting dynamic subtest: pipe-B-HDMI-A-3
[677.211478] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (4.002s)
[677.283483] Subtest plane-all-transition-nonblocking-fencing: SUCCESS (7.960s)
[677.458596] [119/133] (366s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[677.507937] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[677.508870] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[677.630870] [120/133] (365s left) gem_ccs (ctrl-surf-copy)
[677.682459] Starting subtest: ctrl-surf-copy
[677.684206] Subtest ctrl-surf-copy: SKIP (0.000s)
[677.791885] [121/133] (365s left) i915_pm_rps (thresholds-idle-park)
[677.846878] Starting subtest: thresholds-idle-park
[677.848536] Subtest thresholds-idle-park: SKIP (0.000s)
[677.957643] [122/133] (365s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-wc)
[679.449470] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-wc
[679.451022] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[679.657284] [123/133] (364s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[681.149719] Starting subtest: basic-flip-after-cursor-legacy
[682.144008] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.995s)
[682.334457] [124/133] (361s left) i915_module_load (reload-no-display)
[682.378153] Starting subtest: reload-no-display
[688.051643] Subtest reload-no-display: SUCCESS (5.671s)
[688.093922] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[688.095029] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[688.097850] [125/133] (355s left) gem_exec_balancer (bonded-pair)
[691.459631] Starting subtest: bonded-pair
[691.461472] Subtest bonded-pair: SKIP (0.000s)
[691.862916] [FACT gem_exec_balancer (bonded-pair)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[691.866211] [FACT gem_exec_balancer (bonded-pair)] new: kernel.kmod_is_loaded.i915: true
[691.869873] [126/133] (352s left) kms_flip (plain-flip-fb-recreate)
[693.358515] Starting subtest: plain-flip-fb-recreate
[693.364431] Starting dynamic subtest: A-HDMI-A3
[701.419104] Dynamic subtest A-HDMI-A3: SUCCESS (8.054s)
[701.436165] Starting dynamic subtest: B-HDMI-A3
[709.417302] Dynamic subtest B-HDMI-A3: SUCCESS (7.995s)
[709.433423] Starting dynamic subtest: C-HDMI-A3
[717.387793] Dynamic subtest C-HDMI-A3: SUCCESS (7.967s)
[717.434716] Starting dynamic subtest: D-HDMI-A3
[725.390291] Dynamic subtest D-HDMI-A3: SUCCESS (7.993s)
[725.401025] Subtest plain-flip-fb-recreate: SUCCESS (32.042s)
[725.648125] [127/133] (318s left) gem_ctx_param (invalid-get-no-zeromap)
[725.693390] Starting subtest: invalid-get-no-zeromap
[725.694321] Subtest invalid-get-no-zeromap: SUCCESS (0.001s)
[725.908799] [128/133] (318s left) kms_cursor_crc (cursor-size-hints)
[727.461635] Starting subtest: cursor-size-hints
[727.464222] Starting dynamic subtest: pipe-A-HDMI-A-3
[728.048671] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.585s)
[728.063481] Starting dynamic subtest: pipe-D-HDMI-A-3
[728.503950] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.452s)
[728.504910] Subtest cursor-size-hints: SUCCESS (1.044s)
[729.156150] [129/133] (315s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180-hflip)
[730.662174] Starting subtest: linear-max-hw-stride-32bpp-rotate-180-hflip
[730.663851] Subtest linear-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[730.902012] [130/133] (313s left) prime_vgem (basic-fence-read)
[730.984541] Starting subtest: basic-fence-read
[730.995656] Subtest basic-fence-read: SKIP (0.012s)
[731.197631] [131/133] (313s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[732.684329] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[732.772220] [132/133] (311s left) gem_eio (in-flight-internal-immediate)
[732.936150] Starting subtest: in-flight-internal-immediate
[734.057551] Subtest in-flight-internal-immediate: SUCCESS (1.121s)
[735.620154] [133/133] (309s left) perf_pmu (init-sema)
[735.676455] Starting subtest: init-sema
[735.677287] Starting dynamic subtest: rcs0
[735.678193] Dynamic subtest rcs0: SUCCESS (0.002s)
[735.694651] Starting dynamic subtest: bcs0
[735.695661] Dynamic subtest bcs0: SUCCESS (0.001s)
[735.709560] Starting dynamic subtest: vcs0
[735.710584] Dynamic subtest vcs0: SUCCESS (0.001s)
[735.724125] Starting dynamic subtest: vcs1
[735.725023] Dynamic subtest vcs1: SUCCESS (0.001s)
[735.739005] Starting dynamic subtest: vecs0
[735.740173] Dynamic subtest vecs0: SUCCESS (0.001s)
[735.741086] Subtest init-sema: SUCCESS (0.011s)
[735.824574] Closing watchdogs
results: parsing output: 0/ for test: kms_psr
results: parsing output: 1/ for test: kms_cursor_legacy
results: parsing output: 2/ for test: syncobj_wait
results: parsing output: 3/ for test: kms_big_fb
results: parsing output: 4/ for test: kms_plane
results: parsing output: 5/ for test: gem_exec_whisper
results: parsing output: 6/ for test: gem_eio
results: parsing output: 7/ for test: gem_exec_alignment
results: parsing output: 8/ for test: gem_userptr_blits
results: parsing output: 9/ for test: gem_exec_gttfill
results: parsing output: 10/ for test: gem_exec_schedule
results: parsing output: 11/ for test: gem_tiling_max_stride
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: gen9_exec_parse
results: parsing output: 15/ for test: gem_ctx_persistence
results: parsing output: 16/ for test: kms_getfb
results: parsing output: 17/ for test: kms_plane_scaling
results: parsing output: 18/ for test: syncobj_wait
results: parsing output: 19/ for test: syncobj_wait
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_big_fb
results: parsing output: 23/ for test: syncobj_timeline
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_psr
results: parsing output: 26/ for test: prime_vgem
results: parsing output: 27/ for test: perf_pmu
results: parsing output: 28/ for test: kms_cursor_legacy
results: parsing output: 29/ for test: kms_flip
results: parsing output: 30/ for test: kms_prop_blob
results: parsing output: 31/ for test: kms_invalid_mode
results: parsing output: 32/ for test: gem_render_copy
results: parsing output: 33/ for test: kms_async_flips
results: parsing output: 34/ for test: kms_chamelium_hpd
results: parsing output: 35/ for test: kms_pipe_crc_basic
results: parsing output: 36/ for test: gem_mmap_gtt
results: parsing output: 37/ for test: gem_exec_fence
results: parsing output: 38/ for test: sysfs_heartbeat_interval
results: parsing output: 39/ for test: kms_ccs
results: parsing output: 40/ for test: syncobj_wait
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: kms_draw_crc
results: parsing output: 44/ for test: sw_sync
results: parsing output: 45/ for test: kms_content_protection
results: parsing output: 46/ for test: prime_mmap
results: parsing output: 47/ for test: kms_plane
results: parsing output: 48/ for test: gem_exec_flush
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: gem_eio
results: parsing output: 51/ for test: gem_pread
results: parsing output: 52/ for test: gem_render_copy
results: parsing output: 53/ for test: perf
results: parsing output: 54/ for test: kms_lease
results: parsing output: 55/ for test: gem_exec_balancer
results: parsing output: 56/ for test: syncobj_timeline
results: parsing output: 57/ for test: kms_big_fb
results: parsing output: 58/ for test: gem_softpin
results: parsing output: 59/ for test: gem_ctx_create
results: parsing output: 60/ for test: kms_chamelium_audio
results: parsing output: 61/ for test: kms_flip_scaled_crc
results: parsing output: 62/ for test: gem_exec_await
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: gem_render_copy
results: parsing output: 65/ for test: kms_flip_scaled_crc
results: parsing output: 66/ for test: i915_pm_rpm
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: syncobj_timeline
results: parsing output: 69/ for test: prime_mmap
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: core_getstats
results: parsing output: 72/ for test: gem_exec_schedule
results: parsing output: 73/ for test: gen9_exec_parse
results: parsing output: 74/ for test: api_intel_allocator
results: parsing output: 75/ for test: kms_async_flips
results: parsing output: 76/ for test: kms_cursor_legacy
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_ccs
results: parsing output: 80/ for test: kms_pm_rpm
results: parsing output: 81/ for test: kms_pm_dc
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: syncobj_timeline
results: parsing output: 84/ for test: gem_pxp
results: parsing output: 85/ for test: kms_vblank
results: parsing output: 86/ for test: gem_mmap_gtt
results: parsing output: 87/ for test: template
results: parsing output: 88/ for test: kms_color_pipeline
results: parsing output: 89/ for test: gem_mmap_gtt
results: parsing output: 90/ for test: kms_big_fb
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_flip
results: parsing output: 93/ for test: dumb_buffer
results: parsing output: 94/ for test: gem_compute
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_cursor_legacy
results: parsing output: 97/ for test: kms_psr
results: parsing output: 98/ for test: gem_userptr_blits
results: parsing output: 99/ for test: kms_selftest
results: parsing output: 100/ for test: syncobj_timeline
results: parsing output: 101/ for test: kms_big_fb
results: parsing output: 102/ for test: kms_cursor_crc
results: parsing output: 103/ for test: kms_ccs
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_cursor_edge_walk
results: parsing output: 106/ for test: kms_psr
results: parsing output: 107/ for test: gem_exec_whisper
results: parsing output: 108/ for test: syncobj_basic
results: parsing output: 109/ for test: gem_request_retire
results: parsing output: 110/ for test: kms_ccs
results: parsing output: 111/ for test: kms_psr2_sf
results: parsing output: 112/ for test: kms_plane
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: syncobj_wait
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_chamelium_frames
results: parsing output: 117/ for test: kms_atomic_transition
results: parsing output: 118/ for test: syncobj_wait
results: parsing output: 119/ for test: gem_ccs
results: parsing output: 120/ for test: i915_pm_rps
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: kms_cursor_legacy
results: parsing output: 123/ for test: i915_module_load
results: parsing output: 124/ for test: gem_exec_balancer
results: parsing output: 125/ for test: kms_flip
results: parsing output: 126/ for test: gem_ctx_param
results: parsing output: 127/ for test: kms_cursor_crc
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: prime_vgem
results: parsing output: 130/ for test: kms_psr2_sf
results: parsing output: 131/ for test: gem_eio
results: parsing output: 132/ for test: perf_pmu
Done.