[55.563916] Initializing watchdogs [55.563965] /dev/watchdog0 [55.579352] [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] [55.583965] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [55.586556] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [55.589907] [001/131] (960s left) kms_setmode (basic) [55.663216] Starting subtest: basic [56.043471] Starting dynamic subtest: pipe-A-eDP-1 [58.186164] Dynamic subtest pipe-A-eDP-1: FAIL (2.049s) [58.424370] Starting dynamic subtest: pipe-B-eDP-1 [60.588320] Dynamic subtest pipe-B-eDP-1: FAIL (2.063s) [60.778816] Subtest basic: FAIL (5.134s) [61.609203] [002/131] (954s left) gem_ppgtt (blt-vs-render-ctx0) [61.664974] Starting subtest: blt-vs-render-ctx0 [94.579706] Subtest blt-vs-render-ctx0: SUCCESS (32.931s) [94.713191] [003/131] (921s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs) [94.843083] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs [94.845486] Starting dynamic subtest: pipe-A-eDP-1 [94.869057] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [94.878222] Starting dynamic subtest: pipe-B-eDP-1 [94.899776] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [94.906706] Starting dynamic subtest: pipe-C-eDP-1 [94.927478] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [94.934453] Starting dynamic subtest: pipe-D-eDP-1 [94.956230] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [94.960579] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs: SKIP (0.004s) [97.134336] [004/131] (919s left) gem_cs_tlb (engines) [97.185523] Starting subtest: engines [97.187921] Starting dynamic subtest: rcs0 [99.342228] Dynamic subtest rcs0: SUCCESS (2.153s) [99.351023] Starting dynamic subtest: bcs0 [101.494016] Dynamic subtest bcs0: SUCCESS (2.151s) [101.503156] Starting dynamic subtest: vcs0 [103.647782] Dynamic subtest vcs0: SUCCESS (2.152s) [103.657476] Starting dynamic subtest: vcs1 [105.800560] Dynamic subtest vcs1: SUCCESS (2.153s) [105.808133] Starting dynamic subtest: vecs0 [107.952754] Dynamic subtest vecs0: SUCCESS (2.152s) [107.962777] Starting dynamic subtest: ccs0 [110.107356] Dynamic subtest ccs0: SUCCESS (2.154s) [110.109545] Subtest engines: SUCCESS (12.917s) [110.243016] [005/131] (905s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary) [110.349070] Starting subtest: fbcpsr-shrfb-scaledprimary [118.118353] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (7.771s) [118.273642] [006/131] (898s left) kms_psr_stress_test (invalidate-primary-flip-overlay) [118.363213] Starting subtest: invalidate-primary-flip-overlay [129.116089] Subtest invalidate-primary-flip-overlay: SUCCESS (10.756s) [129.262205] [007/131] (887s left) kms_big_fb (4-tiled-8bpp-rotate-180) [129.369545] Starting subtest: 4-tiled-8bpp-rotate-180 [130.549307] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.180s) [130.688378] [008/131] (885s left) i915_drm_fdinfo (busy-idle-check-all) [130.733693] Starting subtest: busy-idle-check-all [130.735599] Starting dynamic subtest: rcs0 [130.740048] Dynamic subtest rcs0: SKIP (0.004s) [130.748086] Starting dynamic subtest: bcs0 [130.752043] Dynamic subtest bcs0: SKIP (0.000s) [130.758759] Starting dynamic subtest: vcs0 [130.762935] Dynamic subtest vcs0: SKIP (0.000s) [130.769985] Starting dynamic subtest: vcs1 [130.774123] Dynamic subtest vcs1: SKIP (0.000s) [130.780805] Starting dynamic subtest: vecs0 [130.784951] Dynamic subtest vecs0: SKIP (0.000s) [130.791747] Starting dynamic subtest: ccs0 [130.795927] Dynamic subtest ccs0: SKIP (0.000s) [130.800066] Subtest busy-idle-check-all: SKIP (0.006s) [130.832055] [009/131] (885s left) gem_exec_balancer (semaphore) [130.932438] Starting subtest: semaphore [132.869048] Subtest semaphore: SUCCESS (1.934s) [133.186932] [010/131] (883s left) gem_exec_fence (nb-await) [133.360590] Starting subtest: nb-await [133.363038] Starting dynamic subtest: rcs0 [133.440878] Dynamic subtest rcs0: SUCCESS (0.079s) [133.451786] Starting dynamic subtest: bcs0 [133.506588] Dynamic subtest bcs0: SUCCESS (0.065s) [133.514949] Starting dynamic subtest: vcs0 [133.568738] Dynamic subtest vcs0: SUCCESS (0.062s) [133.578756] Starting dynamic subtest: vcs1 [133.630770] Dynamic subtest vcs1: SUCCESS (0.062s) [133.641661] Starting dynamic subtest: vecs0 [133.693997] Dynamic subtest vecs0: SUCCESS (0.063s) [133.704867] Starting dynamic subtest: ccs0 [133.754167] Dynamic subtest ccs0: SUCCESS (0.060s) [133.756468] Subtest nb-await: SUCCESS (0.393s) [135.978739] [FACT gem_exec_fence (nb-await)] new: kernel.kmod_is_loaded.vgem: true [135.981922] [011/131] (880s left) kms_color (ctm-0-25) [136.081940] Starting subtest: ctm-0-25 [136.084272] Starting dynamic subtest: pipe-A-eDP-1 [139.556883] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.472s) [139.565811] Starting dynamic subtest: pipe-B-eDP-1 [143.799783] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.242s) [143.807622] Starting dynamic subtest: pipe-C-eDP-1 [147.813089] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.014s) [147.822656] Starting dynamic subtest: pipe-D-eDP-1 [151.806494] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.992s) [151.808530] Subtest ctm-0-25: SUCCESS (15.721s) [152.617976] [012/131] (863s left) syncobj_timeline (wait-all-for-submit-delayed-submit) [152.681215] Starting subtest: wait-all-for-submit-delayed-submit [152.786828] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.103s) [152.864261] [013/131] (863s left) kms_cursor_crc (cursor-alpha-transparent) [152.958448] Starting subtest: cursor-alpha-transparent [152.960878] Starting dynamic subtest: pipe-A-eDP-1 [153.630248] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.669s) [153.638904] Starting dynamic subtest: pipe-D-eDP-1 [154.931090] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.299s) [154.933395] Subtest cursor-alpha-transparent: SUCCESS (1.970s) [155.776808] [014/131] (860s left) gem_pxp (verify-pxp-stale-ctx-execution) [155.892420] Starting subtest: verify-pxp-stale-ctx-execution [156.952525] Subtest verify-pxp-stale-ctx-execution: SUCCESS (1.060s) [157.083058] [015/131] (859s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-20x20) [157.180877] Starting subtest: planes-downscale-factor-0-5-upscale-20x20 [157.183080] Starting dynamic subtest: pipe-A [157.191841] Dynamic subtest pipe-A: SKIP (0.005s) [157.200037] Starting dynamic subtest: pipe-B [157.212085] Dynamic subtest pipe-B: SKIP (0.019s) [157.221631] Starting dynamic subtest: pipe-C [157.230338] Dynamic subtest pipe-C: SKIP (0.020s) [157.237776] Starting dynamic subtest: pipe-D [157.249739] Dynamic subtest pipe-D: SKIP (0.019s) [157.254059] Subtest planes-downscale-factor-0-5-upscale-20x20: SKIP (0.063s) [157.368360] [016/131] (859s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render) [157.459133] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render [157.463083] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s) [157.573152] [017/131] (859s left) gem_workarounds (suspend-resume) [157.646099] Starting subtest: suspend-resume [174.242640] Subtest suspend-resume: SUCCESS (1.730s) [181.387302] [018/131] (842s left) kms_psr (fbc-pr-basic) [181.510322] Starting subtest: fbc-pr-basic [181.514881] Subtest fbc-pr-basic: SKIP (0.000s) [181.582547] [019/131] (842s left) kms_cursor_crc (cursor-onscreen-128x42) [181.816611] Starting subtest: cursor-onscreen-128x42 [181.861367] Subtest cursor-onscreen-128x42: SKIP (0.039s) [182.061291] [020/131] (841s left) gem_render_copy (linear) [182.109597] Starting subtest: linear [182.112077] Starting dynamic subtest: smem [182.152156] Dynamic subtest smem: SUCCESS (0.042s) [182.154541] Subtest linear: SUCCESS (0.042s) [182.377060] [021/131] (841s left) kms_chamelium_color (ctm-0-25) [182.474316] Subtest ctm-0-25: SKIP (0.000s) [182.517652] [022/131] (841s left) kms_addfb_basic (clobberred-modifier) [182.564249] Starting subtest: clobberred-modifier [182.568388] Subtest clobberred-modifier: SKIP (0.000s) [182.704182] [023/131] (841s left) kms_prop_blob (invalid-get-prop) [182.762803] Starting subtest: invalid-get-prop [182.765081] Subtest invalid-get-prop: SUCCESS (0.000s) [182.876865] [024/131] (841s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-blt) [182.969314] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-blt [189.601786] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.685s) [189.781256] [025/131] (834s left) gem_userptr_blits (sync-overlap) [189.856225] Starting subtest: sync-overlap [189.858178] Subtest sync-overlap: SUCCESS (0.000s) [189.992076] [026/131] (834s left) gem_exec_flush (basic-wb-ro-default) [190.050911] Starting subtest: basic-wb-ro-default [195.483401] Subtest basic-wb-ro-default: SUCCESS (5.451s) [195.687105] [027/131] (828s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [195.804560] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [196.671034] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.870s) [196.851760] [028/131] (827s left) kms_addfb_basic (too-high) [196.954725] Starting subtest: too-high [196.956974] Subtest too-high: SUCCESS (0.001s) [197.061492] [029/131] (827s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu) [197.157208] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu [204.059312] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (6.915s) [204.189643] [030/131] (820s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled-ccs) [204.256886] Starting subtest: yf-tiled-ccs-to-yf-tiled-ccs [204.261837] Subtest yf-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s) [204.457515] [031/131] (819s left) kms_invalid_mode (zero-hdisplay) [204.543254] Starting subtest: zero-hdisplay [204.545626] Starting dynamic subtest: pipe-A-eDP-1 [204.835883] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.294s) [204.845901] Starting dynamic subtest: pipe-B-eDP-1 [204.847890] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [204.855985] Starting dynamic subtest: pipe-C-eDP-1 [204.857999] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [204.866283] Starting dynamic subtest: pipe-D-eDP-1 [204.868524] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [204.870865] Subtest zero-hdisplay: SUCCESS (0.299s) [205.624054] [032/131] (818s left) gem_exec_whisper (basic-queues-forked-all) [205.688450] Starting subtest: basic-queues-forked-all [224.070425] Subtest basic-queues-forked-all: SUCCESS (18.380s) [224.250886] [033/131] (800s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip) [224.356461] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip [224.360623] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s) [224.462355] [034/131] (799s left) gem_mmap_gtt (hang-user) [224.519606] Subtest hang-user: SKIP (0.000s) [224.583514] [035/131] (799s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-render) [224.685578] Starting subtest: psr-2p-primscrn-pri-indfb-draw-render [224.689691] Subtest psr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s) [224.778407] [036/131] (799s left) kms_sequence (get-busy) [224.885011] Starting subtest: get-busy [224.887302] Starting dynamic subtest: pipe-A-eDP-1 [226.837739] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.950s) [226.848827] Starting dynamic subtest: pipe-B-eDP-1 [229.404446] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.567s) [229.414128] Starting dynamic subtest: pipe-C-eDP-1 [232.023204] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.615s) [232.034031] Starting dynamic subtest: pipe-D-eDP-1 [234.640544] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.620s) [234.642881] Subtest get-busy: SUCCESS (9.758s) [235.526881] [037/131] (789s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted) [235.583478] Starting subtest: multi-wait-all-for-submit-unsubmitted [235.683049] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.101s) [235.759489] [038/131] (788s left) kms_psr2_sf (pr-overlay-plane-update-continuous-sf) [240.783832] Starting subtest: pr-overlay-plane-update-continuous-sf [240.788611] Subtest pr-overlay-plane-update-continuous-sf: SKIP (0.002s) [241.624395] [039/131] (783s left) syncobj_timeline (multi-wait-available-signaled) [241.675545] Starting subtest: multi-wait-available-signaled [241.677922] Subtest multi-wait-available-signaled: SUCCESS (0.001s) [241.789955] [040/131] (782s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted) [241.848513] Starting subtest: invalid-multi-wait-unsubmitted-submitted [241.850858] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.001s) [241.963205] [041/131] (782s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant) [242.062148] Starting subtest: coverage-vs-premult-vs-constant [242.506813] Starting dynamic subtest: pipe-A-eDP-1 [243.093658] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.585s) [243.105079] Starting dynamic subtest: pipe-D-eDP-1 [244.422277] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.328s) [244.424401] Subtest coverage-vs-premult-vs-constant: SUCCESS (2.359s) [245.273221] [042/131] (779s left) kms_psr (fbc-psr-no-drrs) [245.365321] Starting subtest: fbc-psr-no-drrs [245.367544] Starting dynamic subtest: eDP-1 [245.375916] Dynamic subtest eDP-1: SKIP (0.000s) [245.380168] Subtest fbc-psr-no-drrs: SKIP (0.001s) [245.445106] [043/131] (779s left) gem_tiled_blits (basic) [245.512239] Subtest basic: SKIP (0.000s) [245.602298] [044/131] (779s left) syncobj_timeline (etime-single-wait-submitted) [245.648945] Starting subtest: etime-single-wait-submitted [245.756242] Subtest etime-single-wait-submitted: SUCCESS (0.107s) [245.832141] [045/131] (779s left) kms_pm_rpm (modeset-lpsp-stress) [247.972643] Starting subtest: modeset-lpsp-stress [264.266084] Subtest modeset-lpsp-stress: SUCCESS (16.299s) [264.364845] [046/131] (760s left) api_intel_bb (full-batch) [264.431590] Starting subtest: full-batch [264.437101] Subtest full-batch: SUCCESS (0.005s) [264.524265] [047/131] (760s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs) [264.622128] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs [264.624429] Starting dynamic subtest: pipe-A-eDP-1 [264.681519] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [264.690519] Starting dynamic subtest: pipe-B-eDP-1 [264.749142] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [264.760112] Starting dynamic subtest: pipe-C-eDP-1 [264.817243] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [264.827398] Starting dynamic subtest: pipe-D-eDP-1 [264.886421] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [264.890855] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.008s) [266.784524] [048/131] (758s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [266.883066] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [266.887313] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [266.985789] [049/131] (758s left) syncobj_basic (bad-handle-to-fd) [267.034453] Starting subtest: bad-handle-to-fd [267.036351] Subtest bad-handle-to-fd: SUCCESS (0.000s) [267.149060] [050/131] (757s left) perf (gen12-group-concurrent-oa-buffer-read) [267.277468] Starting subtest: gen12-group-concurrent-oa-buffer-read [277.323306] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.042s) [277.370185] [051/131] (747s left) kms_chamelium_edid (dp-edid-resolution-list) [277.763314] Subtest dp-edid-resolution-list: SKIP (0.000s) [278.593577] [052/131] (746s left) gem_exec_reloc (basic-softpin) [278.658336] Subtest basic-softpin: SKIP (0.000s) [278.748876] [053/131] (746s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-blt) [278.849784] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-blt [283.338666] Subtest fbc-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (4.491s) [284.502803] [054/131] (740s left) i915_module_load (reload-with-fault-injection) [284.539886] Starting subtest: reload-with-fault-injection [325.951425] Subtest reload-with-fault-injection: SUCCESS (41.410s) [325.980867] [FACT i915_module_load (reload-with-fault-injection)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [325.981560] [FACT i915_module_load (reload-with-fault-injection)] deleted: kernel.kmod_is_loaded.i915: true [325.985497] [055/131] (699s left) kms_addfb_basic (bo-too-small) [327.426518] Starting subtest: bo-too-small [327.428411] Subtest bo-too-small: SUCCESS (0.000s) [327.505702] [FACT kms_addfb_basic (bo-too-small)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [327.507695] [FACT kms_addfb_basic (bo-too-small)] new: kernel.kmod_is_loaded.i915: true [327.511531] [056/131] (697s left) gem_mmap_offset (open-flood) [327.573587] Starting subtest: open-flood [349.057719] Subtest open-flood: SUCCESS (21.489s) [349.171929] [057/131] (676s left) kms_lease (lease-invalid-connector) [349.283681] Starting subtest: lease-invalid-connector [349.285626] Starting dynamic subtest: pipe-A-eDP-1 [349.287587] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [349.296037] Starting dynamic subtest: pipe-B-eDP-1 [349.297618] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [349.305316] Starting dynamic subtest: pipe-C-eDP-1 [349.307123] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [349.314893] Starting dynamic subtest: pipe-D-eDP-1 [349.316539] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [349.318148] Subtest lease-invalid-connector: SUCCESS (0.003s) [349.360347] [058/131] (676s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-pwrite) [349.459084] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-pwrite [349.462693] Subtest psr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [349.575908] [059/131] (675s left) prime_mmap (test_forked_cpu_write) [349.637643] Starting subtest: test_forked_cpu_write [349.639408] Starting dynamic subtest: test_forked_cpu_write-smem [349.644926] Dynamic subtest test_forked_cpu_write-smem: SUCCESS (0.008s) [349.647305] Subtest test_forked_cpu_write: SUCCESS (0.009s) [349.759581] [060/131] (675s left) kms_addfb_basic (basic) [349.818560] Starting subtest: basic [349.820259] Subtest basic: SUCCESS (0.000s) [349.957370] [061/131] (675s left) gem_exec_schedule (preempt-queue-contexts) [350.028985] Subtest preempt-queue-contexts: SKIP (0.000s) [350.319856] [062/131] (675s left) gem_madvise (dontneed-after-mmap) [350.357220] Starting subtest: dontneed-after-mmap [350.380840] Subtest dontneed-after-mmap: SUCCESS (0.025s) [350.495811] [063/131] (675s left) kms_big_fb (y-tiled-addfb-size-offset-overflow) [350.605757] Starting subtest: y-tiled-addfb-size-offset-overflow [350.609928] Subtest y-tiled-addfb-size-offset-overflow: SKIP (0.000s) [350.721710] [064/131] (674s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt) [350.820881] Starting subtest: fbcpsr-rgb101010-draw-blt [357.554794] Subtest fbcpsr-rgb101010-draw-blt: SUCCESS (6.738s) [357.687494] [065/131] (668s left) kms_atomic_interruptible (universal-setplane-primary) [357.784108] Starting subtest: universal-setplane-primary [357.786447] Starting dynamic subtest: pipe-A-eDP-1 [365.176370] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.392s) [365.178759] Subtest universal-setplane-primary: SUCCESS (7.394s) [366.020547] [066/131] (659s left) vgem_basic (create) [366.064639] Starting subtest: create [366.066811] Subtest create: SUCCESS (0.000s) [366.120417] [067/131] (659s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-25) [366.225819] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-25 [366.228265] Starting dynamic subtest: pipe-A [366.246726] Dynamic subtest pipe-A: SKIP (0.014s) [366.256061] Starting dynamic subtest: pipe-B [366.301872] Dynamic subtest pipe-B: SKIP (0.031s) [366.310179] Starting dynamic subtest: pipe-C [366.319339] Dynamic subtest pipe-C: SKIP (0.030s) [366.327557] Starting dynamic subtest: pipe-D [366.340250] Dynamic subtest pipe-D: SKIP (0.030s) [366.344332] Subtest planes-upscale-factor-0-25-downscale-factor-0-25: SKIP (0.106s) [366.452993] [068/131] (659s left) i915_suspend (basic-s2idle-without-i915) [366.494563] Starting subtest: basic-s2idle-without-i915 [387.602093] Subtest basic-s2idle-without-i915: SUCCESS (6.141s) [393.728089] [069/131] (638s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-wc) [393.852331] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-wc [400.204259] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (6.400s) [400.349277] [070/131] (631s left) gem_softpin (safe-alignment) [400.427051] Starting subtest: safe-alignment [400.458638] Subtest safe-alignment: SUCCESS (0.031s) [401.806736] [071/131] (630s left) kms_big_fb (x-tiled-32bpp-rotate-270) [401.904398] Starting subtest: x-tiled-32bpp-rotate-270 [401.923222] Subtest x-tiled-32bpp-rotate-270: SKIP (0.019s) [402.069482] [072/131] (629s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes) [402.123223] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s) [402.193168] [073/131] (629s left) api_intel_allocator (fork-simple-once) [402.251080] Starting subtest: fork-simple-once [402.263177] Subtest fork-simple-once: SUCCESS (0.013s) [402.377285] [074/131] (629s left) kms_plane_multiple (2x-tiling-x) [402.476369] Starting subtest: 2x-tiling-x [402.480787] Subtest 2x-tiling-x: SKIP (0.000s) [402.544341] [075/131] (629s left) kms_cursor_legacy (flip-vs-cursor-atomic) [402.675936] Starting subtest: flip-vs-cursor-atomic [409.709959] Subtest flip-vs-cursor-atomic: SUCCESS (7.053s) [410.561480] [076/131] (621s left) gem_reg_read (timestamp-monotonic) [410.616784] Starting subtest: timestamp-monotonic [415.301898] Subtest timestamp-monotonic: SUCCESS (4.692s) [415.377327] [077/131] (616s left) sw_sync (sync_busy_fork) [415.410054] Starting subtest: sync_busy_fork [416.418461] Subtest sync_busy_fork: SUCCESS (1.013s) [416.480933] [078/131] (615s left) kms_vblank (ts-continuation-idle-hang) [416.569939] Starting subtest: ts-continuation-idle-hang [416.572276] Starting dynamic subtest: pipe-A-eDP-1 [443.547497] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.978s) [443.562301] Starting dynamic subtest: pipe-D-eDP-1 [468.566801] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.021s) [468.569221] Subtest ts-continuation-idle-hang: SUCCESS (52.003s) [469.383229] [079/131] (562s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions) [469.509366] Starting subtest: flip-vs-cursor-atomic-transitions [477.013643] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (7.504s) [477.807674] [080/131] (554s left) kms_chamelium_hpd (dp-hpd-fast) [478.201236] Subtest dp-hpd-fast: SKIP (0.000s) [479.007730] [081/131] (553s left) gem_exec_schedule (u-lateslice) [479.082401] Starting subtest: u-lateslice [479.084648] Starting dynamic subtest: rcs0 [479.091077] Dynamic subtest rcs0: SUCCESS (0.020s) [479.099938] Starting dynamic subtest: bcs0 [479.108171] Dynamic subtest bcs0: SUCCESS (0.017s) [479.116467] Starting dynamic subtest: vcs0 [479.125469] Dynamic subtest vcs0: SUCCESS (0.016s) [479.134246] Starting dynamic subtest: vcs1 [479.144394] Dynamic subtest vcs1: SUCCESS (0.018s) [479.153298] Starting dynamic subtest: vecs0 [479.162737] Dynamic subtest vecs0: SUCCESS (0.018s) [479.173307] Starting dynamic subtest: ccs0 [479.179908] Dynamic subtest ccs0: SUCCESS (0.017s) [479.182127] Subtest u-lateslice: SUCCESS (0.109s) [480.843748] [082/131] (551s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs) [480.932737] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs [480.935012] Starting dynamic subtest: pipe-A-eDP-1 [481.829569] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.886s) [481.839105] Starting dynamic subtest: pipe-B-eDP-1 [483.325582] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.496s) [483.334887] Starting dynamic subtest: pipe-C-eDP-1 [484.840339] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.513s) [484.849915] Starting dynamic subtest: pipe-D-eDP-1 [486.359688] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.521s) [486.361571] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SUCCESS (5.419s) [487.532350] [083/131] (544s left) gem_userptr_blits (process-exit-busy) [487.613248] Starting subtest: process-exit-busy [487.623788] Subtest process-exit-busy: SUCCESS (0.013s) [487.756187] [084/131] (544s left) gem_ctx_persistence (idempotent) [487.820112] Starting subtest: idempotent [487.822658] Subtest idempotent: SUCCESS (0.000s) [487.949228] [085/131] (544s left) gem_ctx_persistence (legacy-engines-persistence) [488.001853] Starting subtest: legacy-engines-persistence [488.004187] Starting dynamic subtest: render [488.839988] Dynamic subtest render: SUCCESS (0.837s) [488.852181] Starting dynamic subtest: bsd1 [489.655267] Dynamic subtest bsd1: SUCCESS (0.813s) [489.674962] Starting dynamic subtest: bsd2 [490.488440] Dynamic subtest bsd2: SUCCESS (0.830s) [490.501517] Starting dynamic subtest: blt [491.276768] Dynamic subtest blt: SUCCESS (0.785s) [491.286046] Starting dynamic subtest: vebox [492.093842] Dynamic subtest vebox: SUCCESS (0.814s) [492.096475] Subtest legacy-engines-persistence: SUCCESS (4.092s) [492.171989] [086/131] (540s left) api_intel_bb (render-ccs) [492.228428] Starting subtest: render-ccs [492.597556] Subtest render-ccs: SUCCESS (0.370s) [492.722140] [087/131] (539s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling) [492.825892] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling [492.827960] Starting dynamic subtest: pipe-A-default-mode [493.983527] Dynamic subtest pipe-A-default-mode: SKIP (1.150s) [493.988582] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (1.151s) [494.147150] [088/131] (538s left) sysfs_heartbeat_interval (invalid) [494.201227] Starting subtest: invalid [494.203620] Starting dynamic subtest: vecs0 [494.205894] Dynamic subtest vecs0: SUCCESS (0.000s) [494.214979] Starting dynamic subtest: ccs0 [494.217211] Dynamic subtest ccs0: SUCCESS (0.000s) [494.225687] Starting dynamic subtest: vcs0 [494.227746] Dynamic subtest vcs0: SUCCESS (0.000s) [494.236169] Starting dynamic subtest: bcs0 [494.238399] Dynamic subtest bcs0: SUCCESS (0.000s) [494.246889] Starting dynamic subtest: rcs0 [494.249160] Dynamic subtest rcs0: SUCCESS (0.000s) [494.257588] Starting dynamic subtest: vcs1 [494.259841] Dynamic subtest vcs1: SUCCESS (0.000s) [494.262077] Subtest invalid: SUCCESS (0.005s) [494.298621] [089/131] (538s left) perf_pmu (semaphore-busy) [494.342892] Starting subtest: semaphore-busy [494.345233] Starting dynamic subtest: rcs0 [496.009260] Dynamic subtest rcs0: SUCCESS (1.662s) [496.020424] Starting dynamic subtest: bcs0 [497.640521] Dynamic subtest bcs0: SUCCESS (1.628s) [497.652226] Starting dynamic subtest: vcs0 [501.275186] Dynamic subtest vcs0: SUCCESS (3.631s) [501.286697] Starting dynamic subtest: vcs1 [507.227521] Dynamic subtest vcs1: SUCCESS (5.949s) [507.238440] Starting dynamic subtest: vecs0 [513.242751] Dynamic subtest vecs0: SUCCESS (6.012s) [513.254054] Starting dynamic subtest: ccs0 [516.317056] Dynamic subtest ccs0: SUCCESS (3.072s) [516.319432] Subtest semaphore-busy: SUCCESS (21.967s) [516.431178] [090/131] (516s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-pwrite) [516.541191] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-pwrite [521.915686] Subtest fbc-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (5.377s) [523.043468] [091/131] (509s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-pgflip-blt) [523.150564] Starting subtest: fbc-2p-scndscrn-shrfb-pgflip-blt [523.154756] Subtest fbc-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [523.264066] [092/131] (509s left) perf_pmu (busy-idle-no-semaphores) [523.300949] Starting subtest: busy-idle-no-semaphores [523.303173] Starting dynamic subtest: rcs0 [523.991210] Dynamic subtest rcs0: SUCCESS (0.688s) [524.001760] Starting dynamic subtest: bcs0 [524.642049] Dynamic subtest bcs0: SUCCESS (0.649s) [524.653630] Starting dynamic subtest: vcs0 [525.293498] Dynamic subtest vcs0: SUCCESS (0.650s) [525.305050] Starting dynamic subtest: vcs1 [527.370273] Dynamic subtest vcs1: SUCCESS (2.074s) [527.381776] Starting dynamic subtest: vecs0 [529.356793] Dynamic subtest vecs0: SUCCESS (1.981s) [529.368642] Starting dynamic subtest: ccs0 [531.336003] Dynamic subtest ccs0: SUCCESS (1.979s) [531.339202] Subtest busy-idle-no-semaphores: SUCCESS (8.035s) [531.468234] [093/131] (501s left) drm_read (short-buffer-wakeup) [531.654891] Starting subtest: short-buffer-wakeup [563.863862] Subtest short-buffer-wakeup: SUCCESS (32.215s) [564.018561] [094/131] (468s left) gem_exec_reloc (basic-wc-gtt-noreloc) [564.087834] Subtest basic-wc-gtt-noreloc: SKIP (0.000s) [564.160397] [095/131] (468s left) kms_psr (fbc-psr2-sprite-mmap-cpu) [564.255901] Starting subtest: fbc-psr2-sprite-mmap-cpu [564.258186] Starting dynamic subtest: eDP-1 [564.262219] Dynamic subtest eDP-1: SKIP (0.000s) [564.266308] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.001s) [564.326436] [096/131] (468s left) gem_lmem_swapping (heavy-random) [564.376005] Subtest heavy-random: SKIP (0.000s) [564.421515] [097/131] (468s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt) [564.528715] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt [564.532916] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [564.649792] [098/131] (468s left) kms_feature_discovery (psr1) [564.750129] Starting subtest: psr1 [564.752005] Subtest psr1: SUCCESS (0.000s) [564.824100] [099/131] (468s left) i915_pm_rps (min-max-config-loaded) [564.882394] Starting subtest: min-max-config-loaded [564.887160] Subtest min-max-config-loaded: SKIP (0.000s) [564.956926] [100/131] (468s left) gem_exec_reloc (basic-range) [565.019327] Subtest basic-range: SKIP (0.000s) [565.088287] [101/131] (468s left) gem_mmap (basic-small-bo) [565.142786] Subtest basic-small-bo: SKIP (0.000s) [565.206814] [102/131] (467s left) gem_render_copy_redux (normal) [565.263058] Starting subtest: normal [565.656431] Subtest normal: SUCCESS (0.394s) [565.806375] [103/131] (467s left) gem_exec_reloc (basic-wc-active) [565.874114] Subtest basic-wc-active: SKIP (0.000s) [565.937200] [104/131] (467s left) gem_exec_fence (syncobj-invalid-flags) [566.354252] Starting subtest: syncobj-invalid-flags [566.356981] Subtest syncobj-invalid-flags: SUCCESS (0.000s) [567.833122] [105/131] (465s left) gem_exec_schedule (in-order) [567.907032] Starting subtest: in-order [567.909206] Starting dynamic subtest: rcs0 [568.091412] Dynamic subtest rcs0: SUCCESS (0.185s) [568.101223] Starting dynamic subtest: vcs0 [568.201476] Dynamic subtest vcs0: SUCCESS (0.110s) [568.212555] Starting dynamic subtest: vcs1 [568.306842] Dynamic subtest vcs1: SUCCESS (0.105s) [568.318687] Starting dynamic subtest: vecs0 [568.414032] Dynamic subtest vecs0: SUCCESS (0.107s) [568.426329] Starting dynamic subtest: ccs0 [568.546940] Dynamic subtest ccs0: SUCCESS (0.131s) [568.550451] Subtest in-order: SUCCESS (0.642s) [569.871567] [106/131] (463s left) kms_psr (pr-cursor-render) [569.970640] Starting subtest: pr-cursor-render [569.974999] Subtest pr-cursor-render: SKIP (0.000s) [570.040279] [107/131] (463s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip) [570.144869] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip [571.024137] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.881s) [571.210382] [108/131] (462s left) kms_cursor_crc (cursor-sliding-64x64) [571.383027] Starting subtest: cursor-sliding-64x64 [571.385323] Starting dynamic subtest: pipe-A-eDP-1 [575.037865] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.653s) [575.065570] Starting dynamic subtest: pipe-D-eDP-1 [579.303557] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.245s) [579.306028] Subtest cursor-sliding-64x64: SUCCESS (7.922s) [580.165495] [109/131] (453s left) kms_dsc (dsc-with-bpc-formats) [580.252915] Starting subtest: dsc-with-bpc-formats [580.364733] Subtest dsc-with-bpc-formats: SKIP (0.003s) [580.405195] [110/131] (453s left) gem_exec_balancer (full-late-pulse) [580.455865] Starting subtest: full-late-pulse [585.591352] Subtest full-late-pulse: SUCCESS (5.136s) [585.924080] [111/131] (447s left) kms_cursor_legacy (cursor-vs-flip-atomic) [586.052646] Starting subtest: cursor-vs-flip-atomic [615.331192] Subtest cursor-vs-flip-atomic: SUCCESS (29.285s) [616.176780] [112/131] (417s left) kms_cursor_edge_walk (128x128-top-edge) [616.270496] Starting subtest: 128x128-top-edge [616.273198] Starting dynamic subtest: pipe-A-eDP-1 [619.739806] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.466s) [619.750961] Starting dynamic subtest: pipe-D-eDP-1 [622.847379] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.106s) [622.849714] Subtest 128x128-top-edge: SUCCESS (6.576s) [623.649520] [113/131] (409s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset) [623.745781] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset [623.757200] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset: SKIP (0.011s) [623.876705] [114/131] (409s left) kms_psr (psr-cursor-plane-move) [623.986163] Starting subtest: psr-cursor-plane-move [623.988486] Starting dynamic subtest: eDP-1 [625.729971] Dynamic subtest eDP-1: SUCCESS (1.743s) [625.731865] Subtest psr-cursor-plane-move: SUCCESS (1.744s) [626.593170] [115/131] (407s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff) [626.700627] Starting subtest: psr-2p-primscrn-spr-indfb-onoff [626.704789] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s) [626.803456] [116/131] (406s left) kms_flip (2x-plain-flip-fb-recreate) [626.903754] Starting subtest: 2x-plain-flip-fb-recreate [626.915070] Subtest 2x-plain-flip-fb-recreate: SKIP (0.011s) [626.992101] [117/131] (406s left) kms_big_fb (yf-tiled-32bpp-rotate-270) [627.085040] Starting subtest: yf-tiled-32bpp-rotate-270 [627.089233] Subtest yf-tiled-32bpp-rotate-270: SKIP (0.000s) [627.180540] [118/131] (406s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling) [627.269038] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling [627.271304] Starting dynamic subtest: pipe-A-default-mode [630.020824] Dynamic subtest pipe-A-default-mode: SUCCESS (2.749s) [630.023146] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.750s) [630.874678] [119/131] (402s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-gtt) [630.969168] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-gtt [630.973438] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [631.087769] [120/131] (402s left) gem_create (create-massive) [631.140482] Starting subtest: create-massive [631.142840] Subtest create-massive: SUCCESS (0.000s) [631.326092] [121/131] (402s left) i915_drm_fdinfo (most-busy-idle-check-all) [631.362751] Starting subtest: most-busy-idle-check-all [631.365296] Starting dynamic subtest: rcs0 [631.370181] Dynamic subtest rcs0: SKIP (0.004s) [631.380866] Starting dynamic subtest: bcs0 [631.385529] Dynamic subtest bcs0: SKIP (0.000s) [631.394921] Starting dynamic subtest: vcs0 [631.398873] Dynamic subtest vcs0: SKIP (0.000s) [631.407589] Starting dynamic subtest: vcs1 [631.411833] Dynamic subtest vcs1: SKIP (0.000s) [631.420117] Starting dynamic subtest: vecs0 [631.424348] Dynamic subtest vecs0: SKIP (0.000s) [631.432819] Starting dynamic subtest: ccs0 [631.436974] Dynamic subtest ccs0: SKIP (0.000s) [631.441188] Subtest most-busy-idle-check-all: SKIP (0.008s) [631.478706] [122/131] (402s left) gem_softpin (evict-snoop) [631.566871] Starting subtest: evict-snoop [631.571444] Subtest evict-snoop: SKIP (0.000s) [631.714139] [123/131] (402s left) gem_userptr_blits (vma-merge) [631.786704] Starting subtest: vma-merge [631.828386] Subtest vma-merge: SUCCESS (0.042s) [631.951447] [124/131] (402s left) kms_flip (dpms-vs-vblank-race) [632.042778] Starting subtest: dpms-vs-vblank-race [632.045005] Starting dynamic subtest: A-eDP1 [637.033651] Dynamic subtest A-eDP1: SUCCESS (4.986s) [637.043307] Starting dynamic subtest: B-eDP1 [641.624407] Dynamic subtest B-eDP1: SUCCESS (4.590s) [641.634395] Starting dynamic subtest: C-eDP1 [646.216906] Dynamic subtest C-eDP1: SUCCESS (4.589s) [646.226022] Starting dynamic subtest: D-eDP1 [650.827094] Dynamic subtest D-eDP1: SUCCESS (4.608s) [650.829111] Subtest dpms-vs-vblank-race: SUCCESS (18.780s) [651.704745] [125/131] (382s left) kms_addfb_basic (master-rmfb) [651.764311] Starting subtest: master-rmfb [651.766522] Subtest master-rmfb: SUCCESS (0.002s) [651.925230] [126/131] (382s left) kms_hdr (bpc-switch-dpms) [652.017940] Starting subtest: bpc-switch-dpms [653.069136] Starting dynamic subtest: pipe-A-eDP-1 [657.588476] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.519s) [657.590843] Subtest bpc-switch-dpms: SUCCESS (5.570s) [657.729366] [127/131] (376s left) gen9_exec_parse (basic-rejected-ctx-param) [657.790033] Subtest basic-rejected-ctx-param: SKIP (0.000s) [657.873451] [128/131] (376s left) kms_pm_rpm (dpms-lpsp) [659.919101] Starting subtest: dpms-lpsp [660.203808] Subtest dpms-lpsp: SUCCESS (0.290s) [660.302679] [129/131] (373s left) kms_flip (plain-flip-fb-recreate-interruptible) [660.393215] Starting subtest: plain-flip-fb-recreate-interruptible [660.395386] Starting dynamic subtest: A-eDP1 [669.244105] Dynamic subtest A-eDP1: SUCCESS (8.850s) [669.253110] Starting dynamic subtest: B-eDP1 [678.168997] Dynamic subtest B-eDP1: SUCCESS (8.923s) [678.182067] Starting dynamic subtest: C-eDP1 [686.987732] Dynamic subtest C-eDP1: SUCCESS (8.817s) [686.999750] Starting dynamic subtest: D-eDP1 [695.812305] Dynamic subtest D-eDP1: SUCCESS (8.822s) [695.816708] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (35.421s) [696.989179] [130/131] (337s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs) [697.090159] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs [697.092492] Starting dynamic subtest: pipe-A-eDP-1 [697.113803] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [697.125420] Starting dynamic subtest: pipe-B-eDP-1 [697.145694] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [697.154815] Starting dynamic subtest: pipe-C-eDP-1 [697.173920] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [697.182709] Starting dynamic subtest: pipe-D-eDP-1 [697.202320] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [697.204427] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.006s) [699.251288] [131/131] (335s left) syncobj_eventfd (timeline-wait) [699.310984] Starting subtest: timeline-wait [699.320484] Subtest timeline-wait: SUCCESS (0.011s) [699.394269] Closing watchdogs results: parsing output: 0/ for test: kms_setmode results: parsing output: 1/ for test: gem_ppgtt results: parsing output: 2/ for test: kms_ccs results: parsing output: 3/ for test: gem_cs_tlb results: parsing output: 4/ for test: kms_frontbuffer_tracking results: parsing output: 5/ for test: kms_psr_stress_test results: parsing output: 6/ for test: kms_big_fb results: parsing output: 7/ for test: i915_drm_fdinfo results: parsing output: 8/ for test: gem_exec_balancer results: parsing output: 9/ for test: gem_exec_fence results: parsing output: 10/ for test: kms_color results: parsing output: 11/ for test: syncobj_timeline results: parsing output: 12/ for test: kms_cursor_crc results: parsing output: 13/ for test: gem_pxp results: parsing output: 14/ for test: kms_plane_scaling results: parsing output: 15/ for test: kms_frontbuffer_tracking results: parsing output: 16/ for test: gem_workarounds results: parsing output: 17/ for test: kms_psr results: parsing output: 18/ for test: kms_cursor_crc results: parsing output: 19/ for test: gem_render_copy results: parsing output: 20/ for test: kms_chamelium_color results: parsing output: 21/ for test: kms_addfb_basic results: parsing output: 22/ for test: kms_prop_blob results: parsing output: 23/ for test: kms_frontbuffer_tracking results: parsing output: 24/ for test: gem_userptr_blits results: parsing output: 25/ for test: gem_exec_flush results: parsing output: 26/ for test: kms_big_fb results: parsing output: 27/ for test: kms_addfb_basic results: parsing output: 28/ for test: kms_frontbuffer_tracking results: parsing output: 29/ for test: gem_render_copy results: parsing output: 30/ for test: kms_invalid_mode results: parsing output: 31/ for test: gem_exec_whisper results: parsing output: 32/ for test: kms_big_fb results: parsing output: 33/ for test: gem_mmap_gtt results: parsing output: 34/ for test: kms_frontbuffer_tracking results: parsing output: 35/ for test: kms_sequence results: parsing output: 36/ for test: syncobj_wait results: parsing output: 37/ for test: kms_psr2_sf results: parsing output: 38/ for test: syncobj_timeline results: parsing output: 39/ for test: syncobj_timeline results: parsing output: 40/ for test: kms_plane_alpha_blend results: parsing output: 41/ for test: kms_psr results: parsing output: 42/ for test: gem_tiled_blits results: parsing output: 43/ for test: syncobj_timeline results: parsing output: 44/ for test: kms_pm_rpm results: parsing output: 45/ for test: api_intel_bb results: parsing output: 46/ for test: kms_ccs results: parsing output: 47/ for test: kms_frontbuffer_tracking results: parsing output: 48/ for test: syncobj_basic results: parsing output: 49/ for test: perf results: parsing output: 50/ for test: kms_chamelium_edid results: parsing output: 51/ for test: gem_exec_reloc results: parsing output: 52/ for test: kms_frontbuffer_tracking results: parsing output: 53/ for test: i915_module_load results: parsing output: 54/ for test: kms_addfb_basic results: parsing output: 55/ for test: gem_mmap_offset results: parsing output: 56/ for test: kms_lease results: parsing output: 57/ for test: kms_frontbuffer_tracking results: parsing output: 58/ for test: prime_mmap results: parsing output: 59/ for test: kms_addfb_basic results: parsing output: 60/ for test: gem_exec_schedule results: parsing output: 61/ for test: gem_madvise results: parsing output: 62/ for test: kms_big_fb results: parsing output: 63/ for test: kms_frontbuffer_tracking results: parsing output: 64/ for test: kms_atomic_interruptible results: parsing output: 65/ for test: vgem_basic results: parsing output: 66/ for test: kms_plane_scaling results: parsing output: 67/ for test: i915_suspend results: parsing output: 68/ for test: kms_frontbuffer_tracking results: parsing output: 69/ for test: gem_softpin results: parsing output: 70/ for test: kms_big_fb results: parsing output: 71/ for test: kms_pipe_b_c_ivb results: parsing output: 72/ for test: api_intel_allocator results: parsing output: 73/ for test: kms_plane_multiple results: parsing output: 74/ for test: kms_cursor_legacy results: parsing output: 75/ for test: gem_reg_read results: parsing output: 76/ for test: sw_sync results: parsing output: 77/ for test: kms_vblank results: parsing output: 78/ for test: kms_cursor_legacy results: parsing output: 79/ for test: kms_chamelium_hpd results: parsing output: 80/ for test: gem_exec_schedule results: parsing output: 81/ for test: kms_ccs results: parsing output: 82/ for test: gem_userptr_blits results: parsing output: 83/ for test: gem_ctx_persistence results: parsing output: 84/ for test: gem_ctx_persistence results: parsing output: 85/ for test: api_intel_bb results: parsing output: 86/ for test: kms_flip_scaled_crc results: parsing output: 87/ for test: sysfs_heartbeat_interval results: parsing output: 88/ for test: perf_pmu results: parsing output: 89/ for test: kms_frontbuffer_tracking results: parsing output: 90/ for test: kms_frontbuffer_tracking results: parsing output: 91/ for test: perf_pmu results: parsing output: 92/ for test: drm_read results: parsing output: 93/ for test: gem_exec_reloc results: parsing output: 94/ for test: kms_psr results: parsing output: 95/ for test: gem_lmem_swapping results: parsing output: 96/ for test: kms_frontbuffer_tracking results: parsing output: 97/ for test: kms_feature_discovery results: parsing output: 98/ for test: i915_pm_rps results: parsing output: 99/ for test: gem_exec_reloc results: parsing output: 100/ for test: gem_mmap results: parsing output: 101/ for test: gem_render_copy_redux results: parsing output: 102/ for test: gem_exec_reloc results: parsing output: 103/ for test: gem_exec_fence results: parsing output: 104/ for test: gem_exec_schedule results: parsing output: 105/ for test: kms_psr results: parsing output: 106/ for test: kms_big_fb results: parsing output: 107/ for test: kms_cursor_crc results: parsing output: 108/ for test: kms_dsc results: parsing output: 109/ for test: gem_exec_balancer results: parsing output: 110/ for test: kms_cursor_legacy results: parsing output: 111/ for test: kms_cursor_edge_walk results: parsing output: 112/ for test: kms_flip results: parsing output: 113/ for test: kms_psr results: parsing output: 114/ for test: kms_frontbuffer_tracking results: parsing output: 115/ for test: kms_flip results: parsing output: 116/ for test: kms_big_fb results: parsing output: 117/ for test: kms_flip_scaled_crc results: parsing output: 118/ for test: kms_frontbuffer_tracking results: parsing output: 119/ for test: gem_create results: parsing output: 120/ for test: i915_drm_fdinfo results: parsing output: 121/ for test: gem_softpin results: parsing output: 122/ for test: gem_userptr_blits results: parsing output: 123/ for test: kms_flip results: parsing output: 124/ for test: kms_addfb_basic results: parsing output: 125/ for test: kms_hdr results: parsing output: 126/ for test: gen9_exec_parse results: parsing output: 127/ for test: kms_pm_rpm results: parsing output: 128/ for test: kms_flip results: parsing output: 129/ for test: kms_ccs results: parsing output: 130/ for test: syncobj_eventfd Done.