[55.684435] Initializing watchdogs
[55.684482]   /dev/watchdog0
[55.699801] [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.704547] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[55.706812] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[55.708909] [001/133] (960s left) kms_psr (fbc-psr2-basic)
[55.817625] Starting subtest: fbc-psr2-basic
[55.818731] Starting dynamic subtest: eDP-1
[55.820629] Dynamic subtest eDP-1: SKIP (0.000s)
[55.822446] Subtest fbc-psr2-basic: SKIP (0.000s)
[55.895191] [002/133] (960s left) gem_exec_reloc (basic-wc-gtt)
[55.949235] Subtest basic-wc-gtt: SKIP (0.000s)
[56.010978] [003/133] (960s left) kms_addfb_basic (addfb25-bad-modifier)
[56.090794] Starting subtest: addfb25-bad-modifier
[56.091890] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[56.181300] [004/133] (960s left) gem_mmap_gtt (cpuset-big-copy)
[56.227970] Subtest cpuset-big-copy: SKIP (0.000s)
[56.283132] [005/133] (960s left) gem_fenced_exec_thrash (2-spare-fences)
[56.334234] Subtest 2-spare-fences: SKIP (0.000s)
[56.391768] [006/133] (959s left) kms_atomic_transition (modeset-transition-nonblocking)
[56.478797] Starting subtest: modeset-transition-nonblocking
[56.479763] Starting dynamic subtest: 1x-outputs
[67.310605] Dynamic subtest 1x-outputs: SUCCESS (10.833s)
[67.311746] Subtest modeset-transition-nonblocking: SUCCESS (10.833s)
[68.162326] [007/133] (948s left) gem_exec_params (invalid-bsd-ring)
[68.218155] Starting subtest: invalid-bsd-ring
[68.219168] Subtest invalid-bsd-ring: SUCCESS (0.000s)
[68.325875] [008/133] (948s left) kms_colorop (plane-xr30-xr30-srgb_eotf-srgb_inv_eotf-srgb_eotf)
[68.444459] Subtest plane-XR30-XR30-srgb_eotf-srgb_inv_eotf-srgb_eotf: SKIP (0.000s)
[68.528496] [009/133] (947s left) kms_cursor_legacy (forked-move)
[68.640908] Starting subtest: forked-move
[68.641798] Starting dynamic subtest: pipe-A
[74.109942] Dynamic subtest pipe-A: SUCCESS (5.466s)
[74.118463] Starting dynamic subtest: pipe-B
[79.586524] Dynamic subtest pipe-B: SUCCESS (5.477s)
[79.594346] Starting dynamic subtest: pipe-C
[85.058307] Dynamic subtest pipe-C: SUCCESS (5.469s)
[85.066324] Starting dynamic subtest: pipe-D
[90.521174] Dynamic subtest pipe-D: SUCCESS (5.463s)
[90.528899] Starting dynamic subtest: all-pipes
[96.020158] Dynamic subtest all-pipes: SUCCESS (5.496s)
[96.021863] Subtest forked-move: SUCCESS (27.376s)
[96.165378] [010/133] (920s left) i915_hangman (engine-engine-error)
[96.233150] Starting subtest: engine-engine-error
[96.234066] Starting dynamic subtest: rcs0
[97.914769] Dynamic subtest rcs0: SUCCESS (1.679s)
[97.923438] Starting dynamic subtest: bcs0
[99.895691] Dynamic subtest bcs0: SUCCESS (1.980s)
[99.905180] Starting dynamic subtest: vcs0
[101.877279] Dynamic subtest vcs0: SUCCESS (1.980s)
[101.885673] Starting dynamic subtest: vcs1
[103.863713] Dynamic subtest vcs1: SUCCESS (1.985s)
[103.872619] Starting dynamic subtest: vecs0
[105.844778] Dynamic subtest vecs0: SUCCESS (1.981s)
[105.852867] Starting dynamic subtest: ccs0
[107.893802] Dynamic subtest ccs0: SUCCESS (2.046s)
[107.895572] Subtest engine-engine-error: SUCCESS (11.659s)
[107.974562] [011/133] (908s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[108.077808] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[108.693400] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.616s)
[108.890312] [012/133] (907s left) gen9_exec_parse (secure-batches)
[108.933603] Subtest secure-batches: SKIP (0.000s)
[108.986233] [013/133] (907s left) kms_ccs (crc-primary-basic-yf-tiled-ccs)
[109.071835] Starting subtest: crc-primary-basic-yf-tiled-ccs
[109.072910] Starting dynamic subtest: pipe-A-eDP-1
[109.082305] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[109.089066] Starting dynamic subtest: pipe-B-eDP-1
[109.097940] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[109.104028] Starting dynamic subtest: pipe-C-eDP-1
[109.112395] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[109.118044] Starting dynamic subtest: pipe-D-eDP-1
[109.126382] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[109.127919] Subtest crc-primary-basic-yf-tiled-ccs: SKIP (0.004s)
[111.223693] [014/133] (905s left) gem_create (create-ext-set-pat)
[111.391082] Starting subtest: create-ext-set-pat
[111.391956] Subtest create-ext-set-pat: SUCCESS (0.001s)
[111.518886] [015/133] (905s left) syncobj_timeline (etime-single-wait-submitted)
[111.572778] Starting subtest: etime-single-wait-submitted
[111.683885] Subtest etime-single-wait-submitted: SUCCESS (0.108s)
[111.768947] [016/133] (904s left) kms_pm_rpm (modeset-lpsp)
[114.087954] Starting subtest: modeset-lpsp
[115.543908] Subtest modeset-lpsp: SUCCESS (1.460s)
[115.634552] [017/133] (901s left) kms_cursor_legacy (cursorb-vs-flipa-varying-size)
[115.748797] Starting subtest: cursorB-vs-flipA-varying-size
[115.751598] Subtest cursorB-vs-flipA-varying-size: SKIP (0.001s)
[115.897159] [018/133] (900s left) gem_exec_params (rel-constants-invalid)
[115.948184] Starting subtest: rel-constants-invalid
[115.949165] Subtest rel-constants-invalid: SUCCESS (0.000s)
[116.046413] [019/133] (900s left) vgem_basic (dmabuf-mmap)
[116.115752] Starting subtest: dmabuf-mmap
[116.122294] Subtest dmabuf-mmap: SUCCESS (0.007s)
[116.174126] [FACT vgem_basic (dmabuf-mmap)] new: kernel.kmod_is_loaded.vgem: true
[116.175825] [020/133] (900s left) kms_colorop (plane-xr30-xr30-bt2020_oetf)
[116.297879] Subtest plane-XR30-XR30-bt2020_oetf: SKIP (0.000s)
[116.372720] [021/133] (900s left) gem_softpin (overlap)
[116.432388] Starting subtest: overlap
[117.327298] Subtest overlap: SUCCESS (0.895s)
[117.483945] [022/133] (899s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions-varying-size)
[117.591606] Starting subtest: short-flip-after-cursor-atomic-transitions-varying-size
[118.571587] Subtest short-flip-after-cursor-atomic-transitions-varying-size: SUCCESS (0.978s)
[119.453738] [023/133] (897s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[119.541432] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[119.543202] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[119.648764] [024/133] (897s left) kms_flip (wf_vblank-ts-check)
[119.736961] Starting subtest: wf_vblank-ts-check
[119.739352] Starting dynamic subtest: A-eDP1
[128.680070] Dynamic subtest A-eDP1: SUCCESS (8.941s)
[128.688341] Starting dynamic subtest: B-eDP1
[137.613148] Dynamic subtest B-eDP1: SUCCESS (8.932s)
[137.619459] Starting dynamic subtest: C-eDP1
[146.526527] Dynamic subtest C-eDP1: SUCCESS (8.913s)
[146.534126] Starting dynamic subtest: D-eDP1
[155.457665] Dynamic subtest D-eDP1: SUCCESS (8.930s)
[155.459748] Subtest wf_vblank-ts-check: SUCCESS (35.723s)
[156.682419] [025/133] (860s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-onoff)
[156.767870] Starting subtest: fbc-2p-primscrn-cur-indfb-onoff
[156.769606] Subtest fbc-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[156.882943] [026/133] (860s left) gem_exec_balancer (indices)
[156.942409] Starting subtest: indices
[158.901364] Subtest indices: SUCCESS (1.956s)
[159.232669] [027/133] (857s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[164.187071] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf
[164.189897] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.002s)
[165.034978] [028/133] (851s left) gem_ctx_persistence (legacy-engines-mixed-process)
[165.088354] Starting subtest: legacy-engines-mixed-process
[165.089514] Starting dynamic subtest: render
[166.893293] Dynamic subtest render: SUCCESS (1.805s)
[166.903196] Starting dynamic subtest: bsd1
[168.950699] Dynamic subtest bsd1: SUCCESS (2.055s)
[168.961388] Starting dynamic subtest: bsd2
[170.931032] Dynamic subtest bsd2: SUCCESS (1.978s)
[170.940072] Starting dynamic subtest: blt
[172.927776] Dynamic subtest blt: SUCCESS (1.996s)
[172.937233] Starting dynamic subtest: vebox
[174.965354] Dynamic subtest vebox: SUCCESS (2.036s)
[174.966649] Subtest legacy-engines-mixed-process: SUCCESS (9.877s)
[175.050710] [029/133] (841s left) kms_psr2_sf (psr2-overlay-primary-update-sf-dmg-area)
[180.022087] Starting subtest: psr2-overlay-primary-update-sf-dmg-area
[180.023219] Starting dynamic subtest: pipe-A-eDP-1
[186.573174] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.550s)
[186.581042] Starting dynamic subtest: pipe-B-eDP-1
[193.234933] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.659s)
[193.236091] Subtest psr2-overlay-primary-update-sf-dmg-area: SUCCESS (13.212s)
[194.111107] [030/133] (822s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[194.206703] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt
[194.208424] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[194.333057] [031/133] (822s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc)
[194.426122] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc
[201.086539] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (6.659s)
[201.240292] [032/133] (815s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[201.329629] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[201.331318] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[201.445835] [033/133] (815s left) gem_exec_capture (pi)
[201.503635] Starting subtest: pi
[201.504589] Starting dynamic subtest: rcs0
[205.866761] Dynamic subtest rcs0: SUCCESS (4.364s)
[205.874832] Starting dynamic subtest: bcs0
[210.068434] Dynamic subtest bcs0: SUCCESS (4.200s)
[210.077361] Starting dynamic subtest: vcs0
[214.209558] Dynamic subtest vcs0: SUCCESS (4.140s)
[214.216421] Starting dynamic subtest: vcs1
[218.353815] Dynamic subtest vcs1: SUCCESS (4.143s)
[218.362107] Starting dynamic subtest: vecs0
[222.475309] Dynamic subtest vecs0: SUCCESS (4.120s)
[222.482943] Starting dynamic subtest: ccs0
[226.615627] Dynamic subtest ccs0: SUCCESS (4.139s)
[226.618425] Subtest pi: SUCCESS (25.115s)
[226.723129] [034/133] (790s left) kms_big_fb (x-tiled-32bpp-rotate-180)
[226.865363] Starting subtest: x-tiled-32bpp-rotate-180
[228.357630] Subtest x-tiled-32bpp-rotate-180: SUCCESS (1.492s)
[228.506894] [035/133] (788s left) perf (gen12-mi-rpc)
[228.656932] Starting subtest: gen12-mi-rpc
[228.657884] Starting dynamic subtest: rcs0
[228.673183] Dynamic subtest rcs0: SUCCESS (0.016s)
[228.674057] Subtest gen12-mi-rpc: SUCCESS (0.017s)
[228.705529] [036/133] (788s left) gem_exec_schedule (submit-early-slice)
[228.818432] Starting subtest: submit-early-slice
[228.819504] Starting dynamic subtest: rcs0
[228.865058] Dynamic subtest rcs0: SUCCESS (0.046s)
[228.875266] Starting dynamic subtest: bcs0
[228.906925] Dynamic subtest bcs0: SUCCESS (0.042s)
[228.914352] Starting dynamic subtest: vcs0
[228.949868] Dynamic subtest vcs0: SUCCESS (0.042s)
[228.958317] Starting dynamic subtest: vcs1
[228.987059] Dynamic subtest vcs1: SUCCESS (0.037s)
[228.994856] Starting dynamic subtest: vecs0
[229.030312] Dynamic subtest vecs0: SUCCESS (0.043s)
[229.039982] Starting dynamic subtest: ccs0
[229.070770] Dynamic subtest ccs0: SUCCESS (0.040s)
[229.071887] Subtest submit-early-slice: SUCCESS (0.252s)
[231.066156] [037/133] (786s left) gem_exec_whisper (basic-normal-all)
[231.133346] Starting subtest: basic-normal-all
[234.341414] Subtest basic-normal-all: SUCCESS (3.207s)
[234.527559] [038/133] (782s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs)
[234.595512] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs
[234.597370] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[234.782677] [039/133] (782s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt)
[234.879623] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt
[234.881366] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[234.997326] [040/133] (782s left) vgem_basic (unload)
[235.023068] Starting subtest: unload
[264.280376] Subtest unload: SUCCESS (29.255s)
[264.394614] [041/133] (753s left) i915_pm_rps (waitboost)
[264.448110] Starting subtest: waitboost
[270.534822] Subtest waitboost: SUCCESS (6.086s)
[270.683313] [042/133] (746s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[270.781946] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[271.440267] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.659s)
[271.630303] [043/133] (745s left) gem_sync (basic-all)
[271.687416] Starting subtest: basic-all
[274.903623] Subtest basic-all: SUCCESS (3.215s)
[275.090788] [044/133] (742s left) gem_softpin (reverse)
[275.144733] Starting subtest: reverse
[275.152893] Subtest reverse: SUCCESS (0.008s)
[275.303311] [045/133] (742s left) kms_chamelium_frames (hdmi-frame-dump)
[275.678161] Subtest hdmi-frame-dump: SKIP (0.000s)
[276.529452] [046/133] (741s left) core_getstats (basic)
[276.576217] Starting subtest: basic
[276.577144] Subtest basic: SUCCESS (0.000s)
[276.689113] [047/133] (740s left) prime_vgem (basic-fence-mmap)
[276.764545] Starting subtest: basic-fence-mmap
[276.766430] Subtest basic-fence-mmap: SKIP (0.000s)
[276.880156] [048/133] (740s left) gen9_exec_parse (valid-registers)
[276.941275] Subtest valid-registers: SKIP (0.000s)
[276.999363] [049/133] (740s left) gem_exec_reloc (basic-scanout)
[277.054282] Subtest basic-scanout: SKIP (0.000s)
[277.137290] [050/133] (740s left) syncobj_timeline (single-wait-all-signaled)
[277.195651] Starting subtest: single-wait-all-signaled
[277.196718] Subtest single-wait-all-signaled: SUCCESS (0.000s)
[277.315750] [051/133] (740s left) api_intel_allocator (standalone)
[277.365348] Starting subtest: standalone
[277.382085] Subtest standalone: SUCCESS (0.018s)
[277.518607] [052/133] (740s left) perf_pmu (busy-double-start)
[277.549397] Starting subtest: busy-double-start
[277.550396] Starting dynamic subtest: rcs0
[281.150420] Dynamic subtest rcs0: FAIL (3.584s)
[281.157398] Starting dynamic subtest: bcs0
[284.743273] Dynamic subtest bcs0: SUCCESS (3.610s)
[284.753799] Starting dynamic subtest: vcs0
[288.427511] Dynamic subtest vcs0: SUCCESS (3.682s)
[288.439329] Starting dynamic subtest: vcs1
[292.478541] Dynamic subtest vcs1: SUCCESS (4.049s)
[292.489532] Starting dynamic subtest: vecs0
[296.415463] Dynamic subtest vecs0: SUCCESS (3.935s)
[296.426636] Starting dynamic subtest: ccs0
[300.006517] Dynamic subtest ccs0: FAIL (3.565s)
[300.007383] Subtest busy-double-start: FAIL (22.433s)
[300.124457] [053/133] (717s left) kms_flip (2x-flip-vs-fences-interruptible)
[300.223900] Starting subtest: 2x-flip-vs-fences-interruptible
[300.225550] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.000s)
[300.328891] [054/133] (717s left) gem_userptr_blits (unsync-overlap)
[300.377669] Subtest unsync-overlap: SKIP (0.000s)
[300.523408] [055/133] (717s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-cpu)
[300.617304] Starting subtest: fbcpsr-rgb565-draw-mmap-cpu
[307.259209] Subtest fbcpsr-rgb565-draw-mmap-cpu: SUCCESS (6.642s)
[307.411490] [056/133] (710s left) kms_psr (psr2-cursor-plane-onoff)
[307.500224] Starting subtest: psr2-cursor-plane-onoff
[307.501117] Starting dynamic subtest: eDP-1
[309.165171] Dynamic subtest eDP-1: SUCCESS (1.664s)
[309.166193] Subtest psr2-cursor-plane-onoff: SUCCESS (1.665s)
[309.967748] [057/133] (708s left) gem_exercise_blt (fast-copy)
[310.029656] Starting subtest: fast-copy
[310.030608] Starting dynamic subtest: linear-smem-smem
[310.052987] Dynamic subtest linear-smem-smem: SUCCESS (0.023s)
[310.062580] Starting dynamic subtest: xmajor-smem-smem
[310.071123] Dynamic subtest xmajor-smem-smem: SUCCESS (0.017s)
[310.081184] Starting dynamic subtest: tile4-smem-smem
[310.091762] Dynamic subtest tile4-smem-smem: SUCCESS (0.020s)
[310.101261] Starting dynamic subtest: tile64-smem-smem
[310.109499] Dynamic subtest tile64-smem-smem: SUCCESS (0.017s)
[310.110549] Subtest fast-copy: SUCCESS (0.080s)
[310.241650] [058/133] (707s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[310.327310] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[314.419677] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (4.092s)
[315.582738] [059/133] (702s left) syncobj_wait (wait-all-for-submit-snapshot)
[315.639801] Starting subtest: wait-all-for-submit-snapshot
[315.722200] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s)
[315.815289] [060/133] (702s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc)
[315.913577] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc
[315.914409] Starting dynamic subtest: pipe-A-eDP-1
[315.935978] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[315.943542] Starting dynamic subtest: pipe-B-eDP-1
[315.964483] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[315.971591] Starting dynamic subtest: pipe-C-eDP-1
[315.992769] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[315.999883] Starting dynamic subtest: pipe-D-eDP-1
[316.020847] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[316.022546] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.009s)
[318.154839] [061/133] (699s left) syncobj_timeline (wait-all-for-submit-snapshot)
[318.211550] Starting subtest: wait-all-for-submit-snapshot
[318.292803] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s)
[318.374949] [062/133] (699s left) api_intel_bb (destroy-bb)
[318.426477] Starting subtest: destroy-bb
[318.433552] Subtest destroy-bb: SUCCESS (0.008s)
[318.572687] [063/133] (699s left) gem_mmap_gtt (medium-copy-odd)
[318.630999] Subtest medium-copy-odd: SKIP (0.000s)
[318.695852] [064/133] (699s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[318.790947] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc
[318.792851] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[318.899471] [065/133] (699s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling)
[318.992542] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling
[318.993517] Starting dynamic subtest: pipe-A-default-mode
[320.103227] Dynamic subtest pipe-A-default-mode: SKIP (1.110s)
[320.104865] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (1.111s)
[320.266523] [066/133] (697s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-plflip-blt)
[320.366212] Starting subtest: psr-1p-primscrn-shrfb-plflip-blt
[327.821628] Subtest psr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.455s)
[327.953143] [067/133] (690s left) kms_plane_multiple (tiling-none)
[328.045439] Starting subtest: tiling-none
[328.046270] Starting dynamic subtest: pipe-A-eDP-1
[331.723331] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.677s)
[331.730994] Starting dynamic subtest: pipe-B-eDP-1
[336.156432] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.431s)
[336.168292] Starting dynamic subtest: pipe-C-eDP-1
[340.477090] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.319s)
[340.484846] Starting dynamic subtest: pipe-D-eDP-1
[344.833305] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.356s)
[344.834151] Subtest tiling-none: SUCCESS (16.788s)
[345.659335] [068/133] (672s left) kms_psr (pr-cursor-blt)
[345.748523] Starting subtest: pr-cursor-blt
[345.750282] Subtest pr-cursor-blt: SKIP (0.000s)
[345.828456] [069/133] (672s left) gem_mmap_gtt (basic-small-bo)
[345.876663] Subtest basic-small-bo: SKIP (0.000s)
[345.940445] [070/133] (672s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[346.029878] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[352.639430] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.608s)
[352.780824] [071/133] (665s left) kms_psr (fbc-psr2-sprite-render)
[352.870434] Starting subtest: fbc-psr2-sprite-render
[352.871361] Starting dynamic subtest: eDP-1
[352.873171] Dynamic subtest eDP-1: SKIP (0.000s)
[352.874897] Subtest fbc-psr2-sprite-render: SKIP (0.001s)
[352.959469] [072/133] (665s left) gem_workarounds (reset)
[353.021914] Starting subtest: reset
[353.195927] Subtest reset: SUCCESS (0.174s)
[353.331952] [073/133] (665s left) gem_exec_alignment (forked)
[353.385598] Starting subtest: forked
[395.141537] Subtest forked: SUCCESS (41.751s)
[395.721174] [074/133] (622s left) gem_exec_fence (syncobj-repeat)
[396.229435] Starting subtest: syncobj-repeat
[396.410260] Subtest syncobj-repeat: SUCCESS (0.179s)
[398.014988] [075/133] (620s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[398.118405] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[398.119506] Starting dynamic subtest: pipe-A
[398.347135] Dynamic subtest pipe-A: SUCCESS (0.230s)
[398.355067] Starting dynamic subtest: pipe-B
[399.644656] Dynamic subtest pipe-B: SUCCESS (1.297s)
[399.653786] Starting dynamic subtest: pipe-C
[400.976559] Dynamic subtest pipe-C: SUCCESS (1.331s)
[400.984236] Starting dynamic subtest: pipe-D
[402.304992] Dynamic subtest pipe-D: SUCCESS (1.328s)
[402.306264] Subtest plane-scaler-with-clipping-clamping-rotation: SUCCESS (4.188s)
[403.493531] [076/133] (615s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-submi
[403.554371] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-submitted
[403.659732] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-submitted: SUCCESS (0.104s)
[403.752989] [077/133] (614s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt)
[403.833470] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt
[411.151087] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.319s)
[411.281606] [078/133] (607s left) kms_scaling_modes (scaling-mode-full-aspect)
[411.375594] Starting subtest: scaling-mode-full-aspect
[411.376476] Starting dynamic subtest: pipe-A-eDP-1
[411.473765] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.098s)
[411.483307] Starting dynamic subtest: pipe-B-eDP-1
[412.640096] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.165s)
[412.650125] Starting dynamic subtest: pipe-C-eDP-1
[413.748161] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.107s)
[413.757280] Starting dynamic subtest: pipe-D-eDP-1
[414.890951] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.141s)
[414.891816] Subtest scaling-mode-full-aspect: SUCCESS (3.517s)
[416.069659] [079/133] (602s left) kms_async_flips (async-flip-with-page-flip-events-tiled)
[416.156211] Starting subtest: async-flip-with-page-flip-events-tiled
[416.542921] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs
[417.557260] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: FAIL (0.798s)
[417.565389] Starting dynamic subtest: pipe-A-eDP-1-4
[417.702179] Dynamic subtest pipe-A-eDP-1-4: FAIL (0.186s)
[417.710363] Starting dynamic subtest: pipe-A-eDP-1-4
[417.761531] Dynamic subtest pipe-A-eDP-1-4: FAIL (0.008s)
[417.769347] Starting dynamic subtest: pipe-A-eDP-1-x
[417.904750] Dynamic subtest pipe-A-eDP-1-x: FAIL (0.180s)
[418.088343] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs
[419.084399] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: FAIL (0.922s)
[419.092774] Starting dynamic subtest: pipe-B-eDP-1-4
[419.326799] Dynamic subtest pipe-B-eDP-1-4: FAIL (0.187s)
[419.335561] Starting dynamic subtest: pipe-B-eDP-1-4
[419.385739] Dynamic subtest pipe-B-eDP-1-4: FAIL (0.008s)
[419.393766] Starting dynamic subtest: pipe-B-eDP-1-x
[419.525698] Dynamic subtest pipe-B-eDP-1-x: FAIL (0.180s)
[419.757424] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs
[422.488478] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.735s)
[422.496502] Starting dynamic subtest: pipe-C-eDP-1-4
[424.652400] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.163s)
[424.660281] Starting dynamic subtest: pipe-C-eDP-1-4
[426.661347] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s)
[426.670057] Starting dynamic subtest: pipe-C-eDP-1-x
[428.831241] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.167s)
[429.196253] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs
[431.928950] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.738s)
[431.936694] Starting dynamic subtest: pipe-D-eDP-1-4
[434.103721] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.173s)
[434.111822] Starting dynamic subtest: pipe-D-eDP-1-4
[436.112704] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s)
[436.124094] Starting dynamic subtest: pipe-D-eDP-1-x
[438.293047] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.178s)
[438.294307] Subtest async-flip-with-page-flip-events-tiled: FAIL (22.135s)
[439.518574] [080/133] (579s left) kms_dsc (dsc-with-output-formats-with-bpc)
[439.610486] Starting subtest: dsc-with-output-formats-with-bpc
[439.631960] Subtest dsc-with-output-formats-with-bpc: SKIP (0.001s)
[439.689692] [081/133] (579s left) kms_cdclk (mode-transition-all-outputs)
[439.779252] Starting subtest: mode-transition-all-outputs
[440.074041] Subtest mode-transition-all-outputs: SKIP (0.294s)
[440.943672] [082/133] (577s left) prime_busy (after)
[440.989074] Starting subtest: after
[440.992095] Starting dynamic subtest: rcs0
[441.034892] Dynamic subtest rcs0: SUCCESS (0.042s)
[441.045033] Starting dynamic subtest: bcs0
[441.090999] Dynamic subtest bcs0: SUCCESS (0.055s)
[441.100332] Starting dynamic subtest: vcs0
[441.131773] Dynamic subtest vcs0: SUCCESS (0.040s)
[441.139590] Starting dynamic subtest: vcs1
[441.172800] Dynamic subtest vcs1: SUCCESS (0.040s)
[441.181035] Starting dynamic subtest: vecs0
[441.213971] Dynamic subtest vecs0: SUCCESS (0.041s)
[441.222039] Starting dynamic subtest: ccs0
[441.255443] Dynamic subtest ccs0: SUCCESS (0.041s)
[441.365960] Subtest after: SUCCESS (0.374s)
[441.454811] [083/133] (577s left) kms_flip (2x-busy-flip)
[441.545680] Starting subtest: 2x-busy-flip
[441.557317] Subtest 2x-busy-flip: SKIP (0.011s)
[441.654472] [084/133] (577s left) syncobj_wait (signal)
[441.709313] Starting subtest: signal
[441.710297] Subtest signal: SUCCESS (0.000s)
[441.839833] [085/133] (577s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs)
[441.938482] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs
[441.939412] Starting dynamic subtest: pipe-A-eDP-1
[441.948179] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[441.956849] Starting dynamic subtest: pipe-B-eDP-1
[441.965487] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[441.973620] Starting dynamic subtest: pipe-C-eDP-1
[441.981487] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[441.989234] Starting dynamic subtest: pipe-D-eDP-1
[441.997438] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[441.999033] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.006s)
[444.148850] [086/133] (574s left) kms_invalid_mode (zero-hdisplay)
[444.237050] Starting subtest: zero-hdisplay
[444.237846] Starting dynamic subtest: pipe-A-eDP-1
[444.520952] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[444.528830] Starting dynamic subtest: pipe-B-eDP-1
[444.529768] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[444.537102] Starting dynamic subtest: pipe-C-eDP-1
[444.537975] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[444.545417] Starting dynamic subtest: pipe-D-eDP-1
[444.546364] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[444.547276] Subtest zero-hdisplay: SUCCESS (0.290s)
[445.377433] [087/133] (573s left) kms_flip (nonexisting-fb)
[445.463551] Starting subtest: nonexisting-fb
[445.464414] Starting dynamic subtest: A-eDP1
[446.641962] Dynamic subtest A-eDP1: SUCCESS (1.178s)
[446.650439] Starting dynamic subtest: B-eDP1
[447.773023] Dynamic subtest B-eDP1: SUCCESS (1.130s)
[447.781807] Starting dynamic subtest: C-eDP1
[448.902945] Dynamic subtest C-eDP1: SUCCESS (1.129s)
[448.910879] Starting dynamic subtest: D-eDP1
[450.034403] Dynamic subtest D-eDP1: SUCCESS (1.131s)
[450.036821] Subtest nonexisting-fb: SUCCESS (4.575s)
[451.315990] [088/133] (567s left) kms_chamelium_hpd (dp-hpd-storm)
[451.691649] Subtest dp-hpd-storm: SKIP (0.000s)
[452.510661] [089/133] (566s left) kms_cursor_crc (cursor-onscreen-32x32)
[452.641817] Starting subtest: cursor-onscreen-32x32
[452.682356] Subtest cursor-onscreen-32x32: SKIP (0.038s)
[453.023313] [090/133] (566s left) gem_mmap_gtt (zero-extend)
[453.072538] Subtest zero-extend: SKIP (0.000s)
[453.139496] [091/133] (565s left) gem_tiled_pread_pwrite
[453.261571] [092/133] (565s left) kms_flip (bo-too-big-interruptible)
[453.349587] Starting subtest: bo-too-big-interruptible
[453.351885] Starting dynamic subtest: A-eDP1
[454.690057] Dynamic subtest A-eDP1: SUCCESS (1.338s)
[454.699111] Starting dynamic subtest: B-eDP1
[455.918166] Dynamic subtest B-eDP1: SUCCESS (1.227s)
[455.928263] Starting dynamic subtest: C-eDP1
[457.146571] Dynamic subtest C-eDP1: SUCCESS (1.227s)
[457.155575] Starting dynamic subtest: D-eDP1
[458.393962] Dynamic subtest D-eDP1: SUCCESS (1.246s)
[458.397276] Subtest bo-too-big-interruptible: SUCCESS (5.046s)
[459.595591] [093/133] (559s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[459.879079] Starting subtest: cursor-rapid-movement-512x512
[459.880903] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[460.084864] [094/133] (559s left) kms_ccs (bad-rotation-90-yf-tiled-ccs)
[460.172399] Starting subtest: bad-rotation-90-yf-tiled-ccs
[460.173382] Starting dynamic subtest: pipe-A-eDP-1
[460.181670] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[460.189483] Starting dynamic subtest: pipe-B-eDP-1
[460.197989] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[460.205872] Starting dynamic subtest: pipe-C-eDP-1
[460.214154] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[460.221588] Starting dynamic subtest: pipe-D-eDP-1
[460.229983] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[460.231712] Subtest bad-rotation-90-yf-tiled-ccs: SKIP (0.004s)
[462.363880] [095/133] (556s left) kms_color (gamma)
[462.456584] Starting subtest: gamma
[462.457557] Starting dynamic subtest: pipe-A-eDP-1
[463.154509] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.696s)
[463.163723] Starting dynamic subtest: pipe-B-eDP-1
[464.550990] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.397s)
[464.559047] Starting dynamic subtest: pipe-C-eDP-1
[465.922231] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.371s)
[465.930188] Starting dynamic subtest: pipe-D-eDP-1
[467.278670] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.355s)
[467.279873] Subtest gamma: SUCCESS (4.821s)
[468.089034] [096/133] (551s left) syncobj_wait (invalid-multi-wait-all-unsubmitted)
[468.145560] Starting subtest: invalid-multi-wait-all-unsubmitted
[468.146532] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[468.255293] [097/133] (551s left) kms_rotation_crc (primary-y-tiled-reflect-x-180)
[468.349428] Starting subtest: primary-y-tiled-reflect-x-180
[468.408289] Subtest primary-y-tiled-reflect-x-180: SKIP (0.059s)
[468.515570] [098/133] (550s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-render)
[468.616776] Starting subtest: psr-2p-primscrn-pri-indfb-draw-render
[468.618695] Subtest psr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[468.731021] [099/133] (550s left) syncobj_timeline (multi-wait-all-signaled)
[468.783292] Starting subtest: multi-wait-all-signaled
[468.784318] Subtest multi-wait-all-signaled: SUCCESS (0.000s)
[468.880660] [100/133] (550s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[468.962013] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[468.963689] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[469.091040] [101/133] (550s left) kms_vblank (ts-continuation-modeset)
[469.171379] Starting subtest: ts-continuation-modeset
[469.172339] Starting dynamic subtest: pipe-A-eDP-1
[470.640669] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.468s)
[470.650585] Starting dynamic subtest: pipe-D-eDP-1
[472.805098] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.161s)
[472.806047] Subtest ts-continuation-modeset: SUCCESS (3.634s)
[473.627711] [102/133] (545s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-upscaling)
[473.710622] Starting subtest: flip-64bpp-linear-to-32bpp-linear-upscaling
[473.711569] Starting dynamic subtest: pipe-A-default-mode
[476.431660] Dynamic subtest pipe-A-default-mode: SUCCESS (2.719s)
[476.432674] Subtest flip-64bpp-linear-to-32bpp-linear-upscaling: SUCCESS (2.721s)
[477.314872] [103/133] (542s left) gem_pwrite (basic-exhaustion)
[477.372974] Subtest basic-exhaustion: SKIP (0.000s)
[477.439965] [104/133] (542s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[477.529913] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[477.531744] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[477.671469] [105/133] (541s left) gem_userptr_blits (sync-unmap-cycles)
[477.734079] Starting subtest: sync-unmap-cycles
[483.107380] Subtest sync-unmap-cycles: SUCCESS (5.373s)
[483.260402] [106/133] (536s left) kms_properties (colorop-properties-legacy)
[483.361496] Starting subtest: colorop-properties-legacy
[483.362532] Starting dynamic subtest: pipe-A-eDP-1
[483.696360] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.334s)
[483.705208] Starting dynamic subtest: pipe-B-eDP-1
[484.761049] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.063s)
[484.768885] Starting dynamic subtest: pipe-C-eDP-1
[485.794024] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.032s)
[485.803445] Starting dynamic subtest: pipe-D-eDP-1
[486.831579] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.035s)
[486.832504] Subtest colorop-properties-legacy: SUCCESS (3.471s)
[487.631919] [107/133] (531s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[487.748966] Starting subtest: basic-busy-flip-before-cursor-atomic
[487.750779] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[487.912502] [108/133] (531s left) kms_invalid_mode (bad-vsync-end)
[488.007783] Starting subtest: bad-vsync-end
[488.008799] Starting dynamic subtest: pipe-A-eDP-1
[488.291353] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.282s)
[488.299101] Starting dynamic subtest: pipe-B-eDP-1
[488.299956] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[488.307062] Starting dynamic subtest: pipe-C-eDP-1
[488.307997] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[488.315184] Starting dynamic subtest: pipe-D-eDP-1
[488.316038] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[488.316967] Subtest bad-vsync-end: SUCCESS (0.288s)
[489.158655] [109/133] (530s left) kms_plane_alpha_blend (alpha-7efc)
[489.259351] Starting subtest: alpha-7efc
[489.544205] Starting dynamic subtest: pipe-A-eDP-1
[490.141242] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.596s)
[490.165876] Starting dynamic subtest: pipe-D-eDP-1
[491.459762] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.300s)
[491.460705] Subtest alpha-7efc: SUCCESS (2.201s)
[492.332878] [110/133] (527s left) gem_sync (basic-store-all)
[492.392268] Starting subtest: basic-store-all
[496.083854] Subtest basic-store-all: SUCCESS (3.693s)
[496.273313] [111/133] (523s left) gem_render_copy (linear-to-vebox-y-tiled)
[496.332393] Starting subtest: linear-to-vebox-y-tiled
[496.334414] Subtest linear-to-vebox-y-tiled: SKIP (0.000s)
[496.531962] [112/133] (523s left) kms_content_protection (uevent)
[496.684249] Starting subtest: uevent
[496.686313] Subtest uevent: SKIP (0.000s)
[496.818705] [113/133] (522s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt)
[496.899681] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt
[496.901387] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[497.009356] [114/133] (522s left) gem_userptr_blits (sd-probe)
[497.065228] Starting subtest: sd-probe
[497.066236] Subtest sd-probe: SUCCESS (0.000s)
[497.223140] [115/133] (522s left) kms_pm_dc (dc5-dpms-negative)
[498.312061] Starting subtest: dc5-dpms-negative
[498.313715] Subtest dc5-dpms-negative: SKIP (0.000s)
[498.402419] [116/133] (521s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[498.494017] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip
[498.496023] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[498.619680] [117/133] (521s left) sriov_basic (enable-vfs-bind-unbind-each)
[498.661802] Starting subtest: enable-vfs-bind-unbind-each
[498.662787] Starting dynamic subtest: numvfs-1
[498.689286] Dynamic subtest numvfs-1: FAIL (0.005s)
[498.697333] Starting dynamic subtest: numvfs-2
[498.725169] Dynamic subtest numvfs-2: FAIL (0.004s)
[498.732613] Starting dynamic subtest: numvfs-3
[498.758501] Dynamic subtest numvfs-3: FAIL (0.004s)
[498.765856] Starting dynamic subtest: numvfs-4
[498.791532] Dynamic subtest numvfs-4: FAIL (0.003s)
[498.798724] Starting dynamic subtest: numvfs-5
[498.824574] Dynamic subtest numvfs-5: FAIL (0.004s)
[498.831654] Starting dynamic subtest: numvfs-6
[498.857581] Dynamic subtest numvfs-6: FAIL (0.004s)
[498.865231] Starting dynamic subtest: numvfs-7
[498.891099] Dynamic subtest numvfs-7: FAIL (0.004s)
[498.898075] Starting dynamic subtest: numvfs-random
[498.929266] Dynamic subtest numvfs-random: FAIL (0.004s)
[498.930329] Subtest enable-vfs-bind-unbind-each: FAIL (0.036s)
[498.960967] [118/133] (520s left) gem_ctx_exec (basic-invalid-context)
[499.028878] Starting subtest: basic-invalid-context
[499.033064] Subtest basic-invalid-context: SUCCESS (0.004s)
[499.202539] [119/133] (520s left) kms_pipe_crc_basic (nonblocking-crc)
[499.292530] Starting subtest: nonblocking-crc
[499.293621] Starting dynamic subtest: pipe-A-eDP-1
[500.033444] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.740s)
[500.041441] Starting dynamic subtest: pipe-B-eDP-1
[501.410635] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.375s)
[501.418553] Starting dynamic subtest: pipe-C-eDP-1
[502.801742] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.391s)
[502.809822] Starting dynamic subtest: pipe-D-eDP-1
[504.148343] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.345s)
[504.149334] Subtest nonblocking-crc: SUCCESS (4.857s)
[504.956595] [120/133] (515s left) gem_exec_schedule (lateslice)
[505.029168] Starting subtest: lateslice
[505.030082] Starting dynamic subtest: rcs0
[505.046849] Dynamic subtest rcs0: SUCCESS (0.019s)
[505.055107] Starting dynamic subtest: bcs0
[505.063827] Dynamic subtest bcs0: SUCCESS (0.016s)
[505.072334] Starting dynamic subtest: vcs0
[505.081865] Dynamic subtest vcs0: SUCCESS (0.017s)
[505.092616] Starting dynamic subtest: vcs1
[505.100747] Dynamic subtest vcs1: SUCCESS (0.018s)
[505.109045] Starting dynamic subtest: vecs0
[505.119569] Dynamic subtest vecs0: SUCCESS (0.018s)
[505.127107] Starting dynamic subtest: ccs0
[505.137851] Dynamic subtest ccs0: SUCCESS (0.018s)
[505.138701] Subtest lateslice: SUCCESS (0.111s)
[507.011548] [121/133] (513s left) syncobj_basic (create-signaled)
[507.069035] Starting subtest: create-signaled
[507.070108] Subtest create-signaled: SUCCESS (0.000s)
[507.197026] [122/133] (512s left) gem_userptr_blits (forbidden-operations)
[507.255697] Starting subtest: forbidden-operations
[507.257565] Subtest forbidden-operations: SKIP (0.000s)
[507.418576] [123/133] (512s left) i915_pm_rps (basic-api)
[507.473065] Starting subtest: basic-api
[507.474983] Subtest basic-api: SKIP (0.001s)
[507.590112] [124/133] (512s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions-varying-size)
[507.701495] Starting subtest: cursorB-vs-flipA-atomic-transitions-varying-size
[507.704586] Subtest cursorB-vs-flipA-atomic-transitions-varying-size: SKIP (0.001s)
[507.852710] [125/133] (512s left) kms_big_fb (linear-64bpp-rotate-90)
[507.947241] Starting subtest: linear-64bpp-rotate-90
[507.966800] Subtest linear-64bpp-rotate-90: SKIP (0.019s)
[508.110757] [126/133] (512s left) fbdev (pan)
[508.141804] Starting subtest: pan
[508.176882] Subtest pan: SUCCESS (0.035s)
[508.256285] [127/133] (511s left) kms_psr (psr-dpms)
[508.346425] Starting subtest: psr-dpms
[508.347352] Starting dynamic subtest: eDP-1
[511.284078] Dynamic subtest eDP-1: SUCCESS (2.937s)
[511.285092] Subtest psr-dpms: SUCCESS (2.938s)
[512.155859] [128/133] (508s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[512.260579] Starting subtest: y-tiled-32bpp-rotate-0
[512.262230] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[512.382619] [129/133] (507s left) prime_vgem (basic-fence-read)
[512.467743] Starting subtest: basic-fence-read
[512.488447] Subtest basic-fence-read: SKIP (0.020s)
[512.622536] [130/133] (507s left) gem_mmap (big-bo)
[512.672284] Subtest big-bo: SKIP (0.000s)
[512.737973] [131/133] (507s left) kms_getfb (getfb-handle-valid)
[512.819254] Starting subtest: getfb-handle-valid
[512.820157] Subtest getfb-handle-valid: SUCCESS (0.000s)
[512.929894] [132/133] (507s left) kms_draw_crc (draw-method-render)
[513.026591] Starting subtest: draw-method-render
[513.027563] Starting dynamic subtest: xrgb8888-untiled
[513.249265] Dynamic subtest xrgb8888-untiled: SUCCESS (0.222s)
[513.263165] Starting dynamic subtest: rgb565-untiled
[513.460172] Dynamic subtest rgb565-untiled: SUCCESS (0.210s)
[513.469579] Starting dynamic subtest: xrgb2101010-untiled
[513.693582] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.232s)
[513.701758] Starting dynamic subtest: xbgr16161616f-untiled
[513.926943] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.233s)
[513.935404] Starting dynamic subtest: xrgb8888-xtiled
[514.060062] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.132s)
[514.068067] Starting dynamic subtest: rgb565-xtiled
[514.171206] Dynamic subtest rgb565-xtiled: SUCCESS (0.110s)
[514.179483] Starting dynamic subtest: xrgb2101010-xtiled
[514.282546] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.111s)
[514.290989] Starting dynamic subtest: xbgr16161616f-xtiled
[514.404627] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.121s)
[514.414426] Starting dynamic subtest: xrgb8888-4tiled
[514.527241] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.120s)
[514.538122] Starting dynamic subtest: rgb565-4tiled
[514.638119] Dynamic subtest rgb565-4tiled: SUCCESS (0.110s)
[514.646053] Starting dynamic subtest: xrgb2101010-4tiled
[514.760092] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.121s)
[514.768127] Starting dynamic subtest: xbgr16161616f-4tiled
[514.882653] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.122s)
[514.884830] Subtest draw-method-render: SUCCESS (1.857s)
[515.031140] [133/133] (505s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[515.127305] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip
[515.129150] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[515.233282] Closing watchdogs
results: parsing output: 0/ for test: kms_psr
results: parsing output: 1/ for test: gem_exec_reloc
results: parsing output: 2/ for test: kms_addfb_basic
results: parsing output: 3/ for test: gem_mmap_gtt
results: parsing output: 4/ for test: gem_fenced_exec_thrash
results: parsing output: 5/ for test: kms_atomic_transition
results: parsing output: 6/ for test: gem_exec_params
results: parsing output: 7/ for test: kms_colorop
results: parsing output: 8/ for test: kms_cursor_legacy
results: parsing output: 9/ for test: i915_hangman
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: gen9_exec_parse
results: parsing output: 12/ for test: kms_ccs
results: parsing output: 13/ for test: gem_create
results: parsing output: 14/ for test: syncobj_timeline
results: parsing output: 15/ for test: kms_pm_rpm
results: parsing output: 16/ for test: kms_cursor_legacy
results: parsing output: 17/ for test: gem_exec_params
results: parsing output: 18/ for test: vgem_basic
results: parsing output: 19/ for test: kms_colorop
results: parsing output: 20/ for test: gem_softpin
results: parsing output: 21/ for test: kms_cursor_legacy
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_flip
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: gem_exec_balancer
results: parsing output: 26/ for test: kms_psr2_sf
results: parsing output: 27/ for test: gem_ctx_persistence
results: parsing output: 28/ for test: kms_psr2_sf
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: gem_exec_capture
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: perf
results: parsing output: 35/ for test: gem_exec_schedule
results: parsing output: 36/ for test: gem_exec_whisper
results: parsing output: 37/ for test: gem_render_copy
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: vgem_basic
results: parsing output: 40/ for test: i915_pm_rps
results: parsing output: 41/ for test: kms_big_fb
results: parsing output: 42/ for test: gem_sync
results: parsing output: 43/ for test: gem_softpin
results: parsing output: 44/ for test: kms_chamelium_frames
results: parsing output: 45/ for test: core_getstats
results: parsing output: 46/ for test: prime_vgem
results: parsing output: 47/ for test: gen9_exec_parse
results: parsing output: 48/ for test: gem_exec_reloc
results: parsing output: 49/ for test: syncobj_timeline
results: parsing output: 50/ for test: api_intel_allocator
results: parsing output: 51/ for test: perf_pmu
results: parsing output: 52/ for test: kms_flip
results: parsing output: 53/ for test: gem_userptr_blits
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_psr
results: parsing output: 56/ for test: gem_exercise_blt
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: syncobj_wait
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: syncobj_timeline
results: parsing output: 61/ for test: api_intel_bb
results: parsing output: 62/ for test: gem_mmap_gtt
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_flip_scaled_crc
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_plane_multiple
results: parsing output: 67/ for test: kms_psr
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: kms_psr
results: parsing output: 71/ for test: gem_workarounds
results: parsing output: 72/ for test: gem_exec_alignment
results: parsing output: 73/ for test: gem_exec_fence
results: parsing output: 74/ for test: kms_plane_scaling
results: parsing output: 75/ for test: syncobj_timeline
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_scaling_modes
results: parsing output: 78/ for test: kms_async_flips
results: parsing output: 79/ for test: kms_dsc
results: parsing output: 80/ for test: kms_cdclk
results: parsing output: 81/ for test: prime_busy
results: parsing output: 82/ for test: kms_flip
results: parsing output: 83/ for test: syncobj_wait
results: parsing output: 84/ for test: kms_ccs
results: parsing output: 85/ for test: kms_invalid_mode
results: parsing output: 86/ for test: kms_flip
results: parsing output: 87/ for test: kms_chamelium_hpd
results: parsing output: 88/ for test: kms_cursor_crc
results: parsing output: 89/ for test: gem_mmap_gtt
results: parsing output: 90/ for test: gem_tiled_pread_pwrite
results: parsing output: 91/ for test: kms_flip
results: parsing output: 92/ for test: kms_cursor_crc
results: parsing output: 93/ for test: kms_ccs
results: parsing output: 94/ for test: kms_color
results: parsing output: 95/ for test: syncobj_wait
results: parsing output: 96/ for test: kms_rotation_crc
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: syncobj_timeline
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_vblank
results: parsing output: 101/ for test: kms_flip_scaled_crc
results: parsing output: 102/ for test: gem_pwrite
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: gem_userptr_blits
results: parsing output: 105/ for test: kms_properties
results: parsing output: 106/ for test: kms_cursor_legacy
results: parsing output: 107/ for test: kms_invalid_mode
results: parsing output: 108/ for test: kms_plane_alpha_blend
results: parsing output: 109/ for test: gem_sync
results: parsing output: 110/ for test: gem_render_copy
results: parsing output: 111/ for test: kms_content_protection
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: gem_userptr_blits
results: parsing output: 114/ for test: kms_pm_dc
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: sriov_basic
results: parsing output: 117/ for test: gem_ctx_exec
results: parsing output: 118/ for test: kms_pipe_crc_basic
results: parsing output: 119/ for test: gem_exec_schedule
results: parsing output: 120/ for test: syncobj_basic
results: parsing output: 121/ for test: gem_userptr_blits
results: parsing output: 122/ for test: i915_pm_rps
results: parsing output: 123/ for test: kms_cursor_legacy
results: parsing output: 124/ for test: kms_big_fb
results: parsing output: 125/ for test: fbdev
results: parsing output: 126/ for test: kms_psr
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: prime_vgem
results: parsing output: 129/ for test: gem_mmap
results: parsing output: 130/ for test: kms_getfb
results: parsing output: 131/ for test: kms_draw_crc
results: parsing output: 132/ for test: kms_big_fb
Done.