[59.928388] Initializing watchdogs
[59.928511]   /dev/watchdog0
[59.944543] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[59.949853] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.952441] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.954362] [001/133] (960s left) kms_flip (2x-flip-vs-dpms-on-nop-interruptible)
[60.059932] Starting subtest: 2x-flip-vs-dpms-on-nop-interruptible
[60.071789] Subtest 2x-flip-vs-dpms-on-nop-interruptible: SKIP (0.011s)
[60.155854] [002/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt)
[60.257259] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt
[60.259046] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[60.359548] [003/133] (960s left) perf_pmu (init-busy)
[60.397426] Starting subtest: init-busy
[60.398414] Starting dynamic subtest: rcs0
[60.399341] Dynamic subtest rcs0: SUCCESS (0.002s)
[60.406445] Starting dynamic subtest: bcs0
[60.407297] Dynamic subtest bcs0: SUCCESS (0.001s)
[60.412897] Starting dynamic subtest: vcs0
[60.413771] Dynamic subtest vcs0: SUCCESS (0.001s)
[60.419088] Starting dynamic subtest: vcs1
[60.419900] Dynamic subtest vcs1: SUCCESS (0.000s)
[60.425108] Starting dynamic subtest: vecs0
[60.425924] Dynamic subtest vecs0: SUCCESS (0.001s)
[60.431210] Starting dynamic subtest: ccs0
[60.432042] Dynamic subtest ccs0: SUCCESS (0.000s)
[60.433020] Subtest init-busy: SUCCESS (0.005s)
[60.494712] [004/133] (960s left) kms_flip (flip-vs-rmfb)
[60.578883] Starting subtest: flip-vs-rmfb
[60.579823] Starting dynamic subtest: A-eDP1
[69.314896] Dynamic subtest A-eDP1: SUCCESS (8.711s)
[69.330710] Starting dynamic subtest: B-eDP1
[77.959218] Dynamic subtest B-eDP1: SUCCESS (8.636s)
[77.966559] Starting dynamic subtest: C-eDP1
[86.584240] Dynamic subtest C-eDP1: SUCCESS (8.619s)
[86.593191] Starting dynamic subtest: D-eDP1
[95.214965] Dynamic subtest D-eDP1: SUCCESS (8.626s)
[95.219412] Subtest flip-vs-rmfb: SUCCESS (34.605s)
[96.409577] [005/133] (924s left) kms_ccs (bad-rotation-90-4-tiled-dg2-mc-ccs)
[96.502548] Starting subtest: bad-rotation-90-4-tiled-dg2-mc-ccs
[96.503379] Starting dynamic subtest: pipe-A-eDP-1
[96.512021] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[96.521408] Starting dynamic subtest: pipe-B-eDP-1
[96.529525] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[96.538826] Starting dynamic subtest: pipe-C-eDP-1
[96.546722] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[96.555248] Starting dynamic subtest: pipe-D-eDP-1
[96.564527] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[96.566504] Subtest bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[98.766537] [006/133] (921s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[98.826574] Starting subtest: x-tiled-to-vebox-y-tiled
[98.828258] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[99.004093] [007/133] (921s left) kms_frontbuffer_tracking (fbc-1p-shrfb-fliptrack-mmap-gtt)
[99.102244] Starting subtest: fbc-1p-shrfb-fliptrack-mmap-gtt
[99.103917] Subtest fbc-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[99.193602] [008/133] (921s left) gem_ctx_persistence (legacy-engines-mixed-process)
[99.250615] Starting subtest: legacy-engines-mixed-process
[99.251634] Starting dynamic subtest: render
[100.899620] Dynamic subtest render: SUCCESS (1.648s)
[100.909459] Starting dynamic subtest: bsd1
[102.894979] Dynamic subtest bsd1: SUCCESS (1.992s)
[102.905367] Starting dynamic subtest: bsd2
[104.903910] Dynamic subtest bsd2: SUCCESS (2.005s)
[104.914844] Starting dynamic subtest: blt
[106.900559] Dynamic subtest blt: SUCCESS (1.996s)
[106.909791] Starting dynamic subtest: vebox
[108.901183] Dynamic subtest vebox: SUCCESS (1.997s)
[108.902200] Subtest legacy-engines-mixed-process: SUCCESS (9.648s)
[108.970993] [009/133] (911s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes)
[109.020700] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s)
[109.084016] [010/133] (911s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[109.177615] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[115.880776] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.702s)
[116.029372] [011/133] (904s left) gem_exec_fence (basic-await)
[116.221894] Starting subtest: basic-await
[116.223405] Starting dynamic subtest: rcs0
[116.317680] Dynamic subtest rcs0: SUCCESS (0.096s)
[116.328368] Starting dynamic subtest: bcs0
[116.393903] Dynamic subtest bcs0: SUCCESS (0.074s)
[116.402586] Starting dynamic subtest: vcs0
[116.465839] Dynamic subtest vcs0: SUCCESS (0.071s)
[116.476634] Starting dynamic subtest: vcs1
[116.540446] Dynamic subtest vcs1: SUCCESS (0.072s)
[116.550246] Starting dynamic subtest: vecs0
[116.613597] Dynamic subtest vecs0: SUCCESS (0.071s)
[116.622971] Starting dynamic subtest: ccs0
[116.685475] Dynamic subtest ccs0: SUCCESS (0.070s)
[116.686700] Subtest basic-await: SUCCESS (0.466s)
[119.027921] [FACT gem_exec_fence (basic-await)] new: kernel.kmod_is_loaded.vgem: true
[119.029962] [012/133] (901s left) kms_vblank (query-forked)
[119.128201] Starting subtest: query-forked
[119.129081] Starting dynamic subtest: pipe-A-eDP-1
[120.968458] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.838s)
[120.976619] Starting dynamic subtest: pipe-D-eDP-1
[123.511846] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.542s)
[123.512758] Subtest query-forked: SUCCESS (4.384s)
[124.372698] [013/133] (896s left) gem_create (hog-create)
[124.424053] Starting subtest: hog-create
[124.425106] Starting dynamic subtest: smem0
[157.867516] Dynamic subtest smem0: SUCCESS (33.431s)
[157.868824] Subtest hog-create: SUCCESS (33.433s)
[158.058152] [014/133] (862s left) syncobj_wait (single-wait-all-for-submit-signaled)
[158.124009] Starting subtest: single-wait-all-for-submit-signaled
[158.132874] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[158.252601] [015/133] (862s left) gem_exec_balancer (hang)
[158.546413] Starting subtest: hang
[160.299227] Subtest hang: SUCCESS (1.760s)
[160.406752] [016/133] (860s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs)
[160.496570] Starting subtest: crc-primary-suspend-yf-tiled-ccs
[160.497584] Starting dynamic subtest: pipe-A-eDP-1
[160.500897] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[160.508076] Starting dynamic subtest: pipe-B-eDP-1
[160.511840] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[160.520508] Starting dynamic subtest: pipe-C-eDP-1
[160.523608] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[160.530807] Starting dynamic subtest: pipe-D-eDP-1
[160.534918] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[160.536687] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.005s)
[162.729832] [017/133] (858s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)
[162.816424] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc
[162.818259] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[162.913865] [018/133] (858s left) kms_chamelium_hpd (dp-hpd-after-suspend)
[163.289951] Subtest dp-hpd-after-suspend: SKIP (0.000s)
[164.060414] [019/133] (857s left) vgem_basic (bad-flag)
[164.095049] Starting subtest: bad-flag
[164.095948] Subtest bad-flag: SUCCESS (0.000s)
[164.146568] [020/133] (856s left) kms_flip (flip-vs-panning)
[164.227828] Starting subtest: flip-vs-panning
[164.230162] Starting dynamic subtest: A-eDP1
[172.930291] Dynamic subtest A-eDP1: SUCCESS (8.700s)
[172.939571] Starting dynamic subtest: B-eDP1
[181.662361] Dynamic subtest B-eDP1: SUCCESS (8.729s)
[181.671872] Starting dynamic subtest: C-eDP1
[190.387828] Dynamic subtest C-eDP1: SUCCESS (8.723s)
[190.398157] Starting dynamic subtest: D-eDP1
[199.123629] Dynamic subtest D-eDP1: SUCCESS (8.731s)
[199.126604] Subtest flip-vs-panning: SUCCESS (34.897s)
[200.285917] [021/133] (820s left) kms_setmode (invalid-clone-exclusive-crtc)
[200.334016] Starting subtest: invalid-clone-exclusive-crtc
[200.336510] Subtest invalid-clone-exclusive-crtc: SKIP (0.000s)
[200.421068] [022/133] (820s left) gem_exec_reloc (basic-softpin)
[200.468472] Subtest basic-softpin: SKIP (0.000s)
[200.533480] [023/133] (820s left) gen9_exec_parse (unaligned-access)
[200.588064] Subtest unaligned-access: SKIP (0.000s)
[200.639943] [024/133] (820s left) kms_rotation_crc (primary-rotation-180)
[200.729873] Starting subtest: primary-rotation-180
[207.651797] Subtest primary-rotation-180: SUCCESS (6.923s)
[208.832877] [025/133] (812s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[208.947360] Starting subtest: y-tiled-8bpp-rotate-0
[208.949099] Subtest y-tiled-8bpp-rotate-0: SKIP (0.000s)
[209.027944] [026/133] (812s left) kms_pm_rpm (modeset-lpsp-stress-no-wait)
[211.050979] Starting subtest: modeset-lpsp-stress-no-wait
[220.962776] Subtest modeset-lpsp-stress-no-wait: SUCCESS (9.915s)
[221.038050] [027/133] (800s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-blt)
[221.139208] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-blt
[221.140894] Subtest fbc-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[221.238524] [028/133] (800s left) prime_vgem (busy)
[221.312782] Starting subtest: busy
[221.313899] Starting dynamic subtest: rcs0
[221.370527] Dynamic subtest rcs0: SUCCESS (0.057s)
[221.378061] Starting dynamic subtest: bcs0
[221.416778] Dynamic subtest bcs0: SUCCESS (0.045s)
[221.423557] Starting dynamic subtest: vcs0
[221.463346] Dynamic subtest vcs0: SUCCESS (0.046s)
[221.469971] Starting dynamic subtest: vcs1
[221.509207] Dynamic subtest vcs1: SUCCESS (0.045s)
[221.515907] Starting dynamic subtest: vecs0
[221.555189] Dynamic subtest vecs0: SUCCESS (0.045s)
[221.563148] Starting dynamic subtest: ccs0
[221.601058] Dynamic subtest ccs0: SUCCESS (0.044s)
[221.601968] Subtest busy: SUCCESS (0.289s)
[221.717532] [029/133] (799s left) gem_ctx_param (basic)
[221.773540] Starting subtest: basic
[221.776345] Subtest basic: SUCCESS (0.001s)
[221.884134] [030/133] (799s left) syncobj_timeline (multi-wait-signaled)
[221.926260] Starting subtest: multi-wait-signaled
[221.927115] Subtest multi-wait-signaled: SUCCESS (0.001s)
[222.034342] [031/133] (799s left) gem_exec_params (invalid-bsd1-flag-on-blt)
[222.087033] Starting subtest: invalid-bsd1-flag-on-blt
[222.087846] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.000s)
[222.178778] [032/133] (799s left) i915_query (test-query-geometry-subslices)
[222.230574] Starting subtest: test-query-geometry-subslices
[222.231460] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[222.308818] [033/133] (799s left) kms_psr2_su (frontbuffer-xrgb8888)
[222.360029] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[222.409929] [034/133] (799s left) kms_color (ctm-negative)
[222.498521] Starting subtest: ctm-negative
[222.499363] Starting dynamic subtest: pipe-A-eDP-1
[223.228269] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.731s)
[223.234987] Starting dynamic subtest: pipe-B-eDP-1
[224.624641] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.396s)
[224.631349] Starting dynamic subtest: pipe-C-eDP-1
[225.999939] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.374s)
[226.007088] Starting dynamic subtest: pipe-D-eDP-1
[227.325851] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.325s)
[227.326715] Subtest ctm-negative: SUCCESS (4.828s)
[228.129520] [035/133] (793s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[228.236287] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[228.238051] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[228.317605] [036/133] (793s left) gem_fenced_exec_thrash (no-spare-fences-busy)
[228.371647] Subtest no-spare-fences-busy: SKIP (0.000s)
[228.443777] [037/133] (793s left) gem_exec_schedule (independent)
[228.507476] Starting subtest: independent
[228.508371] Starting dynamic subtest: rcs0
[229.921432] Dynamic subtest rcs0: SUCCESS (1.405s)
[229.931675] Starting dynamic subtest: vcs0
[231.914645] Dynamic subtest vcs0: SUCCESS (1.991s)
[231.924877] Starting dynamic subtest: vcs1
[233.958892] Dynamic subtest vcs1: SUCCESS (2.042s)
[233.969439] Starting dynamic subtest: vecs0
[235.948956] Dynamic subtest vecs0: SUCCESS (1.987s)
[235.958812] Starting dynamic subtest: ccs0
[237.921187] Dynamic subtest ccs0: SUCCESS (1.970s)
[237.922554] Subtest independent: SUCCESS (9.406s)
[238.209529] [038/133] (783s left) kms_cursor_crc (cursor-alpha-opaque)
[238.298103] Starting subtest: cursor-alpha-opaque
[238.298946] Starting dynamic subtest: pipe-A-eDP-1
[238.941466] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.641s)
[238.948474] Starting dynamic subtest: pipe-D-eDP-1
[240.204590] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.262s)
[240.205525] Subtest cursor-alpha-opaque: SUCCESS (1.906s)
[240.994238] [039/133] (780s left) gem_mmap_gtt (basic-write-read)
[241.049278] Subtest basic-write-read: SKIP (0.000s)
[241.101532] [040/133] (780s left) gen9_exec_parse (bb-secure)
[241.155140] Subtest bb-secure: SKIP (0.000s)
[241.208563] [041/133] (780s left) api_intel_bb (lot-of-buffers)
[241.254204] Starting subtest: lot-of-buffers
[242.420850] Subtest lot-of-buffers: SUCCESS (1.157s)
[242.788246] [042/133] (779s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[242.820716] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[242.859025] [043/133] (779s left) gem_exec_params (invalid-fence-in)
[242.908687] Starting subtest: invalid-fence-in
[242.909563] Subtest invalid-fence-in: SUCCESS (0.000s)
[243.006354] [044/133] (778s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-onoff)
[243.097286] Starting subtest: psr-1p-primscrn-cur-indfb-onoff
[250.136952] Subtest psr-1p-primscrn-cur-indfb-onoff: SUCCESS (7.040s)
[250.258352] [045/133] (771s left) gem_mmap_gtt (big-bo-tiledy)
[250.312845] Subtest big-bo-tiledY: SKIP (0.000s)
[250.366826] [046/133] (771s left) gem_softpin (evict-single-offset)
[250.413215] Starting subtest: evict-single-offset
[275.873779] Subtest evict-single-offset: SUCCESS (25.449s)
[275.949404] [047/133] (746s left) syncobj_wait (invalid-signal-illegal-handle)
[276.047284] Starting subtest: invalid-signal-illegal-handle
[276.048274] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[276.118395] [048/133] (745s left) kms_addfb_basic (master-rmfb)
[276.174598] Starting subtest: master-rmfb
[276.175947] Subtest master-rmfb: SUCCESS (0.001s)
[276.301089] [049/133] (745s left) kms_atomic_transition (plane-use-after-nonblocking-unbind)
[276.392407] Starting subtest: plane-use-after-nonblocking-unbind
[276.393397] Starting dynamic subtest: pipe-A-eDP-1
[276.456231] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.063s)
[276.760303] Starting dynamic subtest: pipe-B-eDP-1
[277.524785] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.771s)
[277.816451] Subtest plane-use-after-nonblocking-unbind: SUCCESS (1.424s)
[278.687804] [050/133] (743s left) i915_pm_rpm (debugfs-forcewake-user)
[280.245604] Starting subtest: debugfs-forcewake-user
[291.635510] Subtest debugfs-forcewake-user: SUCCESS (11.391s)
[292.006411] [051/133] (730s left) kms_pm_dc (dc5-dpms-negative)
[293.092285] Starting subtest: dc5-dpms-negative
[293.093900] Subtest dc5-dpms-negative: SKIP (0.000s)
[293.162589] [052/133] (729s left) gem_ctx_sseu (engines)
[293.218687] Subtest engines: SKIP (0.000s)
[293.293925] [053/133] (728s left) kms_flip (2x-busy-flip)
[293.381143] Starting subtest: 2x-busy-flip
[293.391411] Subtest 2x-busy-flip: SKIP (0.011s)
[293.466838] [054/133] (728s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-msflip-blt)
[293.554832] Starting subtest: psr-2p-scndscrn-indfb-msflip-blt
[293.556350] Subtest psr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[293.654203] [055/133] (728s left) kms_content_protection (suspend-resume)
[293.784031] Starting subtest: suspend-resume
[293.786117] Subtest suspend-resume: SKIP (0.000s)
[293.894387] [056/133] (728s left) gem_busy (busy)
[293.953900] Starting subtest: busy
[293.954865] Starting dynamic subtest: all-engines
[293.991237] Dynamic subtest all-engines: SUCCESS (0.037s)
[293.999640] Starting dynamic subtest: rcs0
[295.845784] Dynamic subtest rcs0: SUCCESS (1.849s)
[295.853830] Starting dynamic subtest: bcs0
[295.888567] Dynamic subtest bcs0: SUCCESS (0.044s)
[295.897673] Starting dynamic subtest: vcs0
[295.926743] Dynamic subtest vcs0: SUCCESS (0.038s)
[295.936491] Starting dynamic subtest: vcs1
[297.893685] Dynamic subtest vcs1: SUCCESS (1.955s)
[297.903073] Starting dynamic subtest: vecs0
[299.942055] Dynamic subtest vecs0: SUCCESS (2.047s)
[299.951416] Starting dynamic subtest: ccs0
[301.925251] Dynamic subtest ccs0: SUCCESS (1.983s)
[301.926224] Subtest busy: SUCCESS (7.962s)
[302.232686] [057/133] (720s left) kms_chamelium_frames (dp-crc-multiple)
[302.608013] Subtest dp-crc-multiple: SKIP (0.000s)
[303.405541] [058/133] (718s left) gem_userptr_blits (nohangcheck)
[303.466635] Starting subtest: nohangcheck
[303.730852] Subtest nohangcheck: SUCCESS (0.262s)
[303.839755] [059/133] (718s left) kms_invalid_mode (bad-vtotal)
[303.928881] Starting subtest: bad-vtotal
[303.929834] Starting dynamic subtest: pipe-A-eDP-1
[304.215525] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[304.223641] Starting dynamic subtest: pipe-B-eDP-1
[304.224589] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[304.233492] Starting dynamic subtest: pipe-C-eDP-1
[304.234368] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[304.241215] Starting dynamic subtest: pipe-D-eDP-1
[304.242071] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[304.242903] Subtest bad-vtotal: SUCCESS (0.291s)
[305.058689] [060/133] (717s left) gem_partial_pwrite_pread (write-uncached)
[305.113650] Subtest write-uncached: SKIP (0.000s)
[305.168709] [061/133] (717s left) gem_mmap_gtt (bad-object)
[305.212072] Subtest bad-object: SKIP (0.000s)
[305.273962] [062/133] (717s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-cpu)
[305.369564] Starting subtest: psr-rgb565-draw-mmap-cpu
[312.214512] Subtest psr-rgb565-draw-mmap-cpu: SUCCESS (6.846s)
[312.321962] [063/133] (710s left) kms_big_fb (yf-tiled-addfb)
[312.416817] Starting subtest: yf-tiled-addfb
[312.418927] Subtest yf-tiled-addfb: SKIP (0.000s)
[312.553128] [064/133] (710s left) gem_exec_reloc (basic-write-read-active)
[312.620079] Subtest basic-write-read-active: SKIP (0.000s)
[312.684063] [065/133] (709s left) kms_lease (setcrtc-implicit-plane)
[312.764429] Starting subtest: setcrtc-implicit-plane
[312.765364] Starting dynamic subtest: pipe-A-eDP-1
[313.234031] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.469s)
[313.242862] Starting dynamic subtest: pipe-B-eDP-1
[314.420691] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.184s)
[314.428178] Starting dynamic subtest: pipe-C-eDP-1
[315.548372] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.127s)
[315.558067] Starting dynamic subtest: pipe-D-eDP-1
[316.676753] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.126s)
[316.677809] Subtest setcrtc-implicit-plane: SUCCESS (3.913s)
[317.523052] [066/133] (705s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180)
[317.629931] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180
[318.722224] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.092s)
[318.840911] [067/133] (703s left) kms_ccs (crc-primary-basic-y-tiled-gen12-mc-ccs)
[318.935205] Starting subtest: crc-primary-basic-y-tiled-gen12-mc-ccs
[318.936160] Starting dynamic subtest: pipe-A-eDP-1
[318.950896] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[318.959123] Starting dynamic subtest: pipe-B-eDP-1
[318.967729] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[318.976352] Starting dynamic subtest: pipe-C-eDP-1
[318.984376] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[318.991693] Starting dynamic subtest: pipe-D-eDP-1
[319.000174] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[319.001852] Subtest crc-primary-basic-y-tiled-gen12-mc-ccs: SKIP (0.006s)
[321.198233] [068/133] (701s left) kms_chamelium_audio (hdmi-audio-edid)
[321.578283] Subtest hdmi-audio-edid: SKIP (0.000s)
[322.398937] [069/133] (700s left) vgem_basic (sysfs)
[322.433836] Starting subtest: sysfs
[322.434759] Subtest sysfs: SUCCESS (0.000s)
[322.488853] [070/133] (700s left) kms_vrr (negative-basic)
[322.575575] Starting subtest: negative-basic
[322.578526] Starting dynamic subtest: pipe-A-eDP-1
[328.036757] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.413s)
[328.321690] Subtest negative-basic: SUCCESS (5.746s)
[329.164046] [071/133] (693s left) kms_ccs (random-ccs-data-4-tiled-bmg-ccs)
[329.248209] Starting subtest: random-ccs-data-4-tiled-bmg-ccs
[329.250106] Subtest random-ccs-data-4-tiled-bmg-ccs: SKIP (0.000s)
[330.380564] [072/133] (692s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[330.467433] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[330.479188] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.011s)
[330.567522] [073/133] (692s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-modifier)
[330.663530] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-modifier
[330.673304] Subtest pixel-format-4-tiled-dg2-rc-ccs-modifier: SKIP (0.000s)
[330.730783] [074/133] (692s left) gem_exec_whisper (basic-forked)
[330.790600] Starting subtest: basic-forked
[338.785571] Subtest basic-forked: SUCCESS (7.993s)
[338.962049] [075/133] (684s left) gem_exec_reloc (basic-write-read-noreloc)
[339.028102] Subtest basic-write-read-noreloc: SKIP (0.000s)
[339.101968] [076/133] (683s left) kms_rotation_crc (multiplane-rotation-cropping-top)
[339.186823] Starting subtest: multiplane-rotation-cropping-top
[356.701587] Subtest multiplane-rotation-cropping-top: SUCCESS (17.516s)
[356.813269] [077/133] (666s left) gen3_mixed_blits
[356.926551] [078/133] (666s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt)
[357.025503] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt
[363.794460] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.770s)
[363.917672] [079/133] (659s left) kms_hdmi_inject (inject-audio)
[364.258725] Starting subtest: inject-audio
[364.538515] Subtest inject-audio: SUCCESS (0.280s)
[365.164895] [080/133] (658s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[365.264723] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt
[365.266648] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[365.363162] [081/133] (657s left) gem_mmap_gtt (hang-user)
[365.416695] Subtest hang-user: SKIP (0.000s)
[365.470287] [082/133] (657s left) gem_exec_reloc (basic-wc-gtt-noreloc)
[365.528406] Subtest basic-wc-gtt-noreloc: SKIP (0.000s)
[365.590378] [083/133] (657s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[365.675965] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[365.676915] Starting dynamic subtest: pipe-A
[365.695083] Dynamic subtest pipe-A: SKIP (0.019s)
[365.703309] Starting dynamic subtest: pipe-B
[365.728892] Dynamic subtest pipe-B: SKIP (0.032s)
[365.736924] Starting dynamic subtest: pipe-C
[365.762673] Dynamic subtest pipe-C: SKIP (0.034s)
[365.770462] Starting dynamic subtest: pipe-D
[365.798525] Dynamic subtest pipe-D: SKIP (0.034s)
[365.800166] Subtest planes-downscale-factor-0-5-unity-scaling: SKIP (0.122s)
[365.892756] [084/133] (657s left) kms_hdr (static-swap)
[365.984397] Starting subtest: static-swap
[365.987207] Subtest static-swap: SKIP (0.000s)
[366.063345] [085/133] (657s left) gem_exec_fence (syncobj-timeline-repeat)
[366.638301] Starting subtest: syncobj-timeline-repeat
[366.903310] Subtest syncobj-timeline-repeat: SUCCESS (0.265s)
[367.969672] [086/133] (655s left) gem_ctx_isolation (preservation-reset)
[368.149872] Starting subtest: preservation-reset
[368.151374] Starting dynamic subtest: rcs0
[368.427392] Dynamic subtest rcs0: SUCCESS (0.285s)
[368.435751] Starting dynamic subtest: bcs0
[368.797239] Dynamic subtest bcs0: SUCCESS (0.368s)
[368.807612] Starting dynamic subtest: vcs0
[369.143921] Dynamic subtest vcs0: SUCCESS (0.345s)
[369.153706] Starting dynamic subtest: vcs1
[370.268737] Dynamic subtest vcs1: SUCCESS (1.124s)
[370.280568] Starting dynamic subtest: vecs0
[372.242047] Dynamic subtest vecs0: SUCCESS (1.972s)
[372.250305] Starting dynamic subtest: ccs0
[374.222635] Dynamic subtest ccs0: SUCCESS (1.979s)
[374.223949] Subtest preservation-reset: SUCCESS (6.082s)
[374.349881] [087/133] (649s left) kms_async_flips (crc-atomic)
[374.448064] Starting subtest: crc-atomic
[374.838521] Starting dynamic subtest: pipe-A-eDP-1
[377.719746] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.881s)
[378.094654] Starting dynamic subtest: pipe-B-eDP-1
[381.029101] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.941s)
[381.414521] Starting dynamic subtest: pipe-C-eDP-1
[384.301059] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.894s)
[384.682142] Starting dynamic subtest: pipe-D-eDP-1
[387.610869] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.936s)
[387.611672] Subtest crc-atomic: SUCCESS (13.163s)
[388.835696] [088/133] (634s left) kms_cursor_legacy (forked-bo)
[388.945451] Starting subtest: forked-bo
[388.953955] Starting dynamic subtest: pipe-A
[394.460171] Dynamic subtest pipe-A: SUCCESS (5.467s)
[394.470130] Starting dynamic subtest: pipe-B
[399.928491] Dynamic subtest pipe-B: SUCCESS (5.465s)
[399.939470] Starting dynamic subtest: pipe-C
[405.349288] Dynamic subtest pipe-C: SUCCESS (5.462s)
[405.361966] Starting dynamic subtest: pipe-D
[410.859511] Dynamic subtest pipe-D: SUCCESS (5.463s)
[410.872647] Starting dynamic subtest: all-pipes
[416.387881] Dynamic subtest all-pipes: SUCCESS (5.526s)
[416.389272] Subtest forked-bo: SUCCESS (27.395s)
[416.502190] [089/133] (607s left) syncobj_eventfd (timeline-wait-signaled)
[416.554963] Starting subtest: timeline-wait-signaled
[416.555964] Subtest timeline-wait-signaled: SUCCESS (0.000s)
[416.646510] [090/133] (606s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[416.738097] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[424.055773] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.318s)
[424.197391] [091/133] (599s left) syncobj_timeline (invalid-transfer-non-existent-point)
[424.255244] Starting subtest: invalid-transfer-non-existent-point
[424.256104] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[424.344321] [092/133] (599s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions)
[424.464205] Starting subtest: cursorB-vs-flipA-atomic-transitions
[424.466953] Subtest cursorB-vs-flipA-atomic-transitions: SKIP (0.001s)
[424.606637] [093/133] (599s left) kms_big_fb (x-tiled-32bpp-rotate-90)
[424.699243] Starting subtest: x-tiled-32bpp-rotate-90
[424.719379] Subtest x-tiled-32bpp-rotate-90: SKIP (0.019s)
[424.834170] [094/133] (598s left) kms_plane (pixel-format-x-tiled-modifier-source-clamping)
[424.927790] Starting subtest: pixel-format-x-tiled-modifier-source-clamping
[424.954956] Starting dynamic subtest: pipe-A-plane-0
[425.621352] Dynamic subtest pipe-A-plane-0: SUCCESS (0.666s)
[425.630955] Starting dynamic subtest: pipe-A-plane-3
[426.054648] Dynamic subtest pipe-A-plane-3: SUCCESS (0.431s)
[427.197762] Starting dynamic subtest: pipe-B-plane-0
[427.834331] Dynamic subtest pipe-B-plane-0: SUCCESS (0.644s)
[427.842347] Starting dynamic subtest: pipe-B-plane-3
[428.279357] Dynamic subtest pipe-B-plane-3: SUCCESS (0.444s)
[428.596457] Subtest pixel-format-x-tiled-modifier-source-clamping: SUCCESS (3.669s)
[429.428943] [095/133] (594s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move)
[429.514292] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move
[429.516102] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[429.605362] [096/133] (594s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[429.657334] Starting subtest: single-wait-for-submit-available-signaled
[429.658234] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s)
[429.746539] [097/133] (594s left) gem_exec_flush (basic-batch-kernel-default-uc)
[429.802539] Starting subtest: basic-batch-kernel-default-uc
[436.073711] Subtest basic-batch-kernel-default-uc: SUCCESS (6.270s)
[436.257108] [098/133] (587s left) gem_fence_thrash (bo-write-verify-threaded-y)
[436.295800] Starting subtest: bo-write-verify-threaded-y
[436.315408] Subtest bo-write-verify-threaded-y: SKIP (0.019s)
[436.370817] [099/133] (587s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[436.465029] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[436.466643] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[436.564989] [100/133] (587s left) kms_psr2_sf (psr2-cursor-plane-update-sf)
[436.654909] Starting subtest: psr2-cursor-plane-update-sf
[436.655824] Starting dynamic subtest: pipe-A-eDP-1
[437.225351] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.563s)
[437.234838] Starting dynamic subtest: pipe-B-eDP-1
[438.496555] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.277s)
[438.497509] Subtest psr2-cursor-plane-update-sf: SUCCESS (1.843s)
[439.333891] [101/133] (584s left) kms_cursor_crc (cursor-random-256x85)
[439.586698] Starting subtest: cursor-random-256x85
[439.641519] Subtest cursor-random-256x85: SKIP (0.053s)
[439.813829] [102/133] (584s left) gem_mmap_offset (ptrace)
[439.880421] Starting subtest: ptrace
[439.883126] Starting dynamic subtest: smem0-wb
[439.903205] Dynamic subtest smem0-wb: SUCCESS (0.020s)
[439.911767] Starting dynamic subtest: smem0-wc
[439.923524] Dynamic subtest smem0-wc: SUCCESS (0.020s)
[439.931461] Starting dynamic subtest: smem0-uc
[439.944468] Dynamic subtest smem0-uc: SUCCESS (0.020s)
[439.945282] Subtest ptrace: SUCCESS (0.065s)
[440.062253] [103/133] (583s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[440.150469] Starting subtest: compare-crc-sanitycheck-xr24
[440.151556] Starting dynamic subtest: pipe-A-eDP-1
[440.821036] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.668s)
[440.829478] Starting dynamic subtest: pipe-B-eDP-1
[442.104032] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.282s)
[442.117197] Starting dynamic subtest: pipe-C-eDP-1
[443.329025] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.224s)
[443.338763] Starting dynamic subtest: pipe-D-eDP-1
[444.519091] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.188s)
[444.519896] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.369s)
[445.338812] [104/133] (578s left) kms_force_connector_basic (prune-stale-modes)
[445.413444] Starting subtest: prune-stale-modes
[445.850252] Subtest prune-stale-modes: SUCCESS (0.438s)
[445.990809] [105/133] (578s left) kms_psr (psr-cursor-plane-move)
[446.081456] Starting subtest: psr-cursor-plane-move
[446.082364] Starting dynamic subtest: eDP-1
[447.814725] Dynamic subtest eDP-1: SUCCESS (1.732s)
[447.815732] Subtest psr-cursor-plane-move: SUCCESS (1.733s)
[448.634846] [106/133] (575s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[448.741045] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip
[448.743055] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[448.834465] [107/133] (575s left) kms_big_fb (linear-8bpp-rotate-270)
[448.930792] Starting subtest: linear-8bpp-rotate-270
[448.952390] Subtest linear-8bpp-rotate-270: SKIP (0.021s)
[449.066649] [108/133] (575s left) gem_exec_reloc (basic-cpu-wc-noreloc)
[449.117348] Subtest basic-cpu-wc-noreloc: SKIP (0.000s)
[449.183770] [109/133] (575s left) gem_exec_schedule (fairslice-all)
[449.259506] Starting subtest: fairslice-all
[451.316830] Subtest fairslice-all: SUCCESS (2.059s)
[451.627589] [110/133] (572s left) kms_psr (pr-no-drrs)
[451.716466] Starting subtest: pr-no-drrs
[451.718223] Subtest pr-no-drrs: SKIP (0.000s)
[451.801959] [111/133] (572s left) gem_exec_reloc (basic-wc-gtt)
[451.862750] Subtest basic-wc-gtt: SKIP (0.000s)
[451.931976] [112/133] (572s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-sf)
[452.024713] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-sf
[452.026493] Subtest fbc-pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[452.092133] [113/133] (572s left) kms_dsc (dsc-with-bpc)
[452.177597] Starting subtest: dsc-with-bpc
[452.189905] Subtest dsc-with-bpc: SKIP (0.001s)
[452.258944] [114/133] (572s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-cpu)
[452.345738] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-cpu
[452.347603] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[452.440715] [115/133] (572s left) i915_module_load (reload-no-display)
[452.471595] Starting subtest: reload-no-display
[458.441224] Subtest reload-no-display: SUCCESS (5.959s)
[458.464513] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[458.466060] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[458.468011] [116/133] (566s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[460.013855] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[460.116868] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.103s)
[460.154239] [FACT syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[460.155495] [FACT syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)] new: kernel.kmod_is_loaded.i915: true
[460.157596] [117/133] (564s left) dmabuf (all-tests)
[460.187914] Starting subtest: all-tests
[460.188970] Starting dynamic subtest: sanitycheck
[460.269040] Dynamic subtest sanitycheck: SUCCESS (0.080s)
[460.280934] Starting dynamic subtest: dma_fence
[460.455418] Dynamic subtest dma_fence: SUCCESS (0.184s)
[460.466892] Starting dynamic subtest: dma_fence_chain
[470.156266] Dynamic subtest dma_fence_chain: SUCCESS (9.689s)
[470.163298] Starting dynamic subtest: dma_fence_unwrap
[470.239954] Dynamic subtest dma_fence_unwrap: SUCCESS (0.090s)
[470.251763] Starting dynamic subtest: dma_resv
[470.326953] Dynamic subtest dma_resv: SUCCESS (0.085s)
[470.328581] Subtest all-tests: SUCCESS (10.139s)
[470.405178] [118/133] (554s left) syncobj_wait (single-wait-all-for-submit-unsubmitted)
[470.466995] Starting subtest: single-wait-all-for-submit-unsubmitted
[470.572966] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.105s)
[470.674645] [119/133] (553s left) api_intel_allocator (simple-allocator)
[470.726745] Starting subtest: simple-allocator
[470.727731] Starting dynamic subtest: basic
[470.735979] Dynamic subtest basic: SUCCESS (0.009s)
[470.745463] Starting dynamic subtest: parallel-one
[470.947178] Dynamic subtest parallel-one: SUCCESS (0.201s)
[470.960268] Starting dynamic subtest: print
[470.961065] Dynamic subtest print: SUCCESS (0.000s)
[470.967653] Starting dynamic subtest: reuse
[470.968541] Dynamic subtest reuse: SUCCESS (0.000s)
[470.976079] Starting dynamic subtest: reserve
[470.976990] Dynamic subtest reserve: SUCCESS (0.000s)
[470.983451] Starting dynamic subtest: fork-reopen-allocator
[470.984282] Dynamic subtest fork-reopen-allocator: SUCCESS (0.012s)
[470.985030] Subtest simple-allocator: SUCCESS (0.227s)
[471.096627] [120/133] (553s left) kms_big_fb (yf-tiled-16bpp-rotate-180)
[471.193564] Starting subtest: yf-tiled-16bpp-rotate-180
[471.195511] Subtest yf-tiled-16bpp-rotate-180: SKIP (0.000s)
[471.283640] [121/133] (553s left) gem_exec_schedule (u-independent)
[471.357915] Starting subtest: u-independent
[471.358883] Starting dynamic subtest: rcs0
[472.933931] Dynamic subtest rcs0: SUCCESS (1.565s)
[472.943560] Starting dynamic subtest: vcs0
[474.923644] Dynamic subtest vcs0: SUCCESS (1.987s)
[474.933536] Starting dynamic subtest: vcs1
[476.904906] Dynamic subtest vcs1: SUCCESS (1.979s)
[476.914832] Starting dynamic subtest: vecs0
[478.956835] Dynamic subtest vecs0: SUCCESS (2.049s)
[478.967493] Starting dynamic subtest: ccs0
[480.929985] Dynamic subtest ccs0: SUCCESS (1.971s)
[480.931257] Subtest u-independent: SUCCESS (9.563s)
[481.218107] [122/133] (543s left) gem_exec_params (sol-reset-not-gen7)
[481.272724] Starting subtest: sol-reset-not-gen7
[481.279548] Subtest sol-reset-not-gen7: SUCCESS (0.006s)
[481.391311] [123/133] (543s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs)
[481.447993] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs
[481.450257] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[481.630266] [124/133] (543s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite)
[481.726998] Starting subtest: fbcpsr-rgb101010-draw-pwrite
[488.821439] Subtest fbcpsr-rgb101010-draw-pwrite: SUCCESS (7.094s)
[488.916954] [125/133] (535s left) kms_cursor_crc (cursor-suspend)
[489.039494] Starting subtest: cursor-suspend
[489.040365] Starting dynamic subtest: pipe-A-eDP-1
[523.396633] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.043s)
[523.406135] Starting dynamic subtest: pipe-D-eDP-1
[558.374444] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.505s)
[558.375546] Subtest cursor-suspend: SUCCESS (8.551s)
[565.225848] [126/133] (465s left) gem_userptr_blits (sync-unmap-after-close)
[565.292022] Starting subtest: sync-unmap-after-close
[565.307258] Subtest sync-unmap-after-close: SUCCESS (0.015s)
[565.424630] [127/133] (465s left) kms_vblank (ts-continuation-modeset-rpm)
[565.516593] Starting subtest: ts-continuation-modeset-rpm
[565.517455] Starting dynamic subtest: pipe-A-eDP-1
[568.064502] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.489s)
[568.074476] Starting dynamic subtest: pipe-D-eDP-1
[570.349978] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.246s)
[570.350948] Subtest ts-continuation-modeset-rpm: SUCCESS (4.739s)
[571.192609] [128/133] (459s left) gem_userptr_blits (create-destroy-sync)
[571.274486] Starting subtest: create-destroy-sync
[576.331676] Subtest create-destroy-sync: SUCCESS (4.963s)
[576.402590] [129/133] (454s left) gem_sync (basic-many-each)
[576.462968] Starting subtest: basic-many-each
[578.769540] Subtest basic-many-each: SUCCESS (2.293s)
[578.956092] [130/133] (452s left) kms_psr (fbc-psr2-no-drrs)
[579.049832] Starting subtest: fbc-psr2-no-drrs
[579.050727] Starting dynamic subtest: eDP-1
[579.052394] Dynamic subtest eDP-1: SKIP (0.000s)
[579.054214] Subtest fbc-psr2-no-drrs: SKIP (0.002s)
[579.120051] [131/133] (451s left) kms_plane (plane-position-covered)
[579.208514] Starting subtest: plane-position-covered
[579.731403] Starting dynamic subtest: pipe-A-plane-1
[581.022749] Dynamic subtest pipe-A-plane-1: SUCCESS (1.286s)
[581.032608] Starting dynamic subtest: pipe-A-plane-2
[582.342074] Dynamic subtest pipe-A-plane-2: SUCCESS (1.312s)
[582.355969] Starting dynamic subtest: pipe-A-plane-3
[583.572703] Dynamic subtest pipe-A-plane-3: SUCCESS (1.225s)
[583.581658] Starting dynamic subtest: pipe-A-plane-4
[584.819223] Dynamic subtest pipe-A-plane-4: SUCCESS (1.241s)
[584.829780] Starting dynamic subtest: pipe-A-plane-5
[584.845244] Dynamic subtest pipe-A-plane-5: SUCCESS (0.026s)
[586.080319] Starting dynamic subtest: pipe-B-plane-1
[587.382691] Dynamic subtest pipe-B-plane-1: SUCCESS (1.309s)
[587.391136] Starting dynamic subtest: pipe-B-plane-2
[588.637535] Dynamic subtest pipe-B-plane-2: SUCCESS (1.252s)
[588.646103] Starting dynamic subtest: pipe-B-plane-3
[589.965582] Dynamic subtest pipe-B-plane-3: SUCCESS (1.326s)
[589.974222] Starting dynamic subtest: pipe-B-plane-4
[591.304692] Dynamic subtest pipe-B-plane-4: SUCCESS (1.336s)
[591.313222] Starting dynamic subtest: pipe-B-plane-5
[591.331336] Dynamic subtest pipe-B-plane-5: SUCCESS (0.026s)
[591.332248] Subtest plane-position-covered: SUCCESS (12.093s)
[592.194323] [132/133] (438s left) kms_psr (fbc-psr-sprite-render)
[592.283604] Starting subtest: fbc-psr-sprite-render
[592.284424] Starting dynamic subtest: eDP-1
[592.286143] Dynamic subtest eDP-1: SKIP (0.000s)
[592.287925] Subtest fbc-psr-sprite-render: SKIP (0.001s)
[592.367886] [133/133] (438s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-pwrite)
[592.460049] Starting subtest: psr-2p-primscrn-pri-indfb-draw-pwrite
[592.461702] Subtest psr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[592.555830] Closing watchdogs
results: parsing output: 0/ for test: kms_flip
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: perf_pmu
results: parsing output: 3/ for test: kms_flip
results: parsing output: 4/ for test: kms_ccs
results: parsing output: 5/ for test: gem_render_copy
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: gem_ctx_persistence
results: parsing output: 8/ for test: kms_pipe_b_c_ivb
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: gem_exec_fence
results: parsing output: 11/ for test: kms_vblank
results: parsing output: 12/ for test: gem_create
results: parsing output: 13/ for test: syncobj_wait
results: parsing output: 14/ for test: gem_exec_balancer
results: parsing output: 15/ for test: kms_ccs
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_chamelium_hpd
results: parsing output: 18/ for test: vgem_basic
results: parsing output: 19/ for test: kms_flip
results: parsing output: 20/ for test: kms_setmode
results: parsing output: 21/ for test: gem_exec_reloc
results: parsing output: 22/ for test: gen9_exec_parse
results: parsing output: 23/ for test: kms_rotation_crc
results: parsing output: 24/ for test: kms_big_fb
results: parsing output: 25/ for test: kms_pm_rpm
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: prime_vgem
results: parsing output: 28/ for test: gem_ctx_param
results: parsing output: 29/ for test: syncobj_timeline
results: parsing output: 30/ for test: gem_exec_params
results: parsing output: 31/ for test: i915_query
results: parsing output: 32/ for test: kms_psr2_su
results: parsing output: 33/ for test: kms_color
results: parsing output: 34/ for test: kms_flip_scaled_crc
results: parsing output: 35/ for test: gem_fenced_exec_thrash
results: parsing output: 36/ for test: gem_exec_schedule
results: parsing output: 37/ for test: kms_cursor_crc
results: parsing output: 38/ for test: gem_mmap_gtt
results: parsing output: 39/ for test: gen9_exec_parse
results: parsing output: 40/ for test: api_intel_bb
results: parsing output: 41/ for test: gem_lmem_swapping
results: parsing output: 42/ for test: gem_exec_params
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: gem_mmap_gtt
results: parsing output: 45/ for test: gem_softpin
results: parsing output: 46/ for test: syncobj_wait
results: parsing output: 47/ for test: kms_addfb_basic
results: parsing output: 48/ for test: kms_atomic_transition
results: parsing output: 49/ for test: i915_pm_rpm
results: parsing output: 50/ for test: kms_pm_dc
results: parsing output: 51/ for test: gem_ctx_sseu
results: parsing output: 52/ for test: kms_flip
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_content_protection
results: parsing output: 55/ for test: gem_busy
results: parsing output: 56/ for test: kms_chamelium_frames
results: parsing output: 57/ for test: gem_userptr_blits
results: parsing output: 58/ for test: kms_invalid_mode
results: parsing output: 59/ for test: gem_partial_pwrite_pread
results: parsing output: 60/ for test: gem_mmap_gtt
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: gem_exec_reloc
results: parsing output: 64/ for test: kms_lease
results: parsing output: 65/ for test: kms_big_fb
results: parsing output: 66/ for test: kms_ccs
results: parsing output: 67/ for test: kms_chamelium_audio
results: parsing output: 68/ for test: vgem_basic
results: parsing output: 69/ for test: kms_vrr
results: parsing output: 70/ for test: kms_ccs
results: parsing output: 71/ for test: kms_flip
results: parsing output: 72/ for test: kms_plane
results: parsing output: 73/ for test: gem_exec_whisper
results: parsing output: 74/ for test: gem_exec_reloc
results: parsing output: 75/ for test: kms_rotation_crc
results: parsing output: 76/ for test: gen3_mixed_blits
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_hdmi_inject
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: gem_mmap_gtt
results: parsing output: 81/ for test: gem_exec_reloc
results: parsing output: 82/ for test: kms_plane_scaling
results: parsing output: 83/ for test: kms_hdr
results: parsing output: 84/ for test: gem_exec_fence
results: parsing output: 85/ for test: gem_ctx_isolation
results: parsing output: 86/ for test: kms_async_flips
results: parsing output: 87/ for test: kms_cursor_legacy
results: parsing output: 88/ for test: syncobj_eventfd
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: syncobj_timeline
results: parsing output: 91/ for test: kms_cursor_legacy
results: parsing output: 92/ for test: kms_big_fb
results: parsing output: 93/ for test: kms_plane
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: syncobj_timeline
results: parsing output: 96/ for test: gem_exec_flush
results: parsing output: 97/ for test: gem_fence_thrash
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_psr2_sf
results: parsing output: 100/ for test: kms_cursor_crc
results: parsing output: 101/ for test: gem_mmap_offset
results: parsing output: 102/ for test: kms_pipe_crc_basic
results: parsing output: 103/ for test: kms_force_connector_basic
results: parsing output: 104/ for test: kms_psr
results: parsing output: 105/ for test: kms_big_fb
results: parsing output: 106/ for test: kms_big_fb
results: parsing output: 107/ for test: gem_exec_reloc
results: parsing output: 108/ for test: gem_exec_schedule
results: parsing output: 109/ for test: kms_psr
results: parsing output: 110/ for test: gem_exec_reloc
results: parsing output: 111/ for test: kms_psr2_sf
results: parsing output: 112/ for test: kms_dsc
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: i915_module_load
results: parsing output: 115/ for test: syncobj_timeline
results: parsing output: 116/ for test: dmabuf
results: parsing output: 117/ for test: syncobj_wait
results: parsing output: 118/ for test: api_intel_allocator
results: parsing output: 119/ for test: kms_big_fb
results: parsing output: 120/ for test: gem_exec_schedule
results: parsing output: 121/ for test: gem_exec_params
results: parsing output: 122/ for test: gem_render_copy
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_cursor_crc
results: parsing output: 125/ for test: gem_userptr_blits
results: parsing output: 126/ for test: kms_vblank
results: parsing output: 127/ for test: gem_userptr_blits
results: parsing output: 128/ for test: gem_sync
results: parsing output: 129/ for test: kms_psr
results: parsing output: 130/ for test: kms_plane
results: parsing output: 131/ for test: kms_psr
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.