[57.805710] Initializing watchdogs
[57.805755]   /dev/watchdog0
[57.820016] [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]
[57.824501] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.827070] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.830530] [001/133] (960s left) kms_content_protection (dp-mst-lic-type-0-hdcp14)
[58.004684] Starting subtest: dp-mst-lic-type-0-hdcp14
[58.009275] Subtest dp-mst-lic-type-0-hdcp14: SKIP (0.000s)
[58.129540] [002/133] (960s left) core_getversion (all-cards)
[58.162342] Starting subtest: all-cards
[58.168851] Subtest all-cards: SUCCESS (0.009s)
[58.202663] [003/133] (960s left) kms_atomic_interruptible (legacy-dpms)
[58.298032] Starting subtest: legacy-dpms
[58.300458] Starting dynamic subtest: pipe-A-eDP-1
[66.527767] Dynamic subtest pipe-A-eDP-1: SUCCESS (8.229s)
[66.529924] Subtest legacy-dpms: SUCCESS (8.230s)
[66.935035] [004/133] (951s left) kms_plane (pixel-format-y-tiled-ccs-modifier-source-clamping)
[67.147726] Starting subtest: pixel-format-y-tiled-ccs-modifier-source-clamping
[67.162112] Subtest pixel-format-y-tiled-ccs-modifier-source-clamping: SKIP (0.000s)
[67.262683] [005/133] (951s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait)
[67.455845] Starting subtest: plane-primary-toggle-with-vblank-wait
[67.458328] Starting dynamic subtest: pipe-A-eDP-1
[67.629270] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.175s)
[67.931998] Starting dynamic subtest: pipe-B-eDP-1
[68.797204] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.872s)
[69.093190] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.639s)
[69.956837] [006/133] (948s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[70.058804] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[70.063147] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[70.190040] [007/133] (948s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[70.287739] Starting subtest: fbc-psr2-primary-mmap-cpu
[70.290031] Starting dynamic subtest: eDP-1
[70.294435] Dynamic subtest eDP-1: SKIP (0.000s)
[70.298877] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.000s)
[70.367554] [008/133] (948s left) perf (invalid-oa-exponent)
[70.493368] Starting subtest: invalid-oa-exponent
[70.506606] Subtest invalid-oa-exponent: SUCCESS (0.012s)
[70.543565] [009/133] (948s left) gem_eio (create-ext)
[70.704973] Starting subtest: create-ext
[70.881223] Subtest create-ext: SUCCESS (0.175s)
[71.036363] [010/133] (947s left) kms_color (invalid-degamma-lut-sizes)
[71.134534] Starting subtest: invalid-degamma-lut-sizes
[71.136462] Starting dynamic subtest: pipe-A
[71.421823] Dynamic subtest pipe-A: SUCCESS (0.286s)
[71.431699] Starting dynamic subtest: pipe-B
[71.434067] Dynamic subtest pipe-B: SUCCESS (0.001s)
[71.441313] Starting dynamic subtest: pipe-C
[71.443649] Dynamic subtest pipe-C: SUCCESS (0.000s)
[71.450864] Starting dynamic subtest: pipe-D
[71.453253] Dynamic subtest pipe-D: SUCCESS (0.000s)
[71.455505] Subtest invalid-degamma-lut-sizes: SUCCESS (0.289s)
[72.299189] [011/133] (946s left) gem_softpin (allocator-basic)
[72.354102] Starting subtest: allocator-basic
[72.423963] Subtest allocator-basic: SUCCESS (0.070s)
[72.574751] [012/133] (946s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area)
[72.673759] Starting subtest: psr2-overlay-plane-update-sf-dmg-area
[72.676076] Starting dynamic subtest: pipe-A-eDP-1
[78.544512] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.875s)
[78.553745] Starting dynamic subtest: pipe-B-eDP-1
[85.197376] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.652s)
[85.199811] Subtest psr2-overlay-plane-update-sf-dmg-area: SUCCESS (12.529s)
[86.076351] [013/133] (932s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0)
[86.177598] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0
[86.181708] Subtest y-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[86.309188] [014/133] (932s left) kms_psr (pr-primary-render)
[86.402765] Starting subtest: pr-primary-render
[86.407193] Subtest pr-primary-render: SKIP (0.000s)
[86.484656] [015/133] (932s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite)
[86.594645] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite
[86.598917] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[86.719557] [016/133] (932s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-sf)
[86.826171] Starting subtest: pr-cursor-plane-move-continuous-exceed-sf
[86.830233] Subtest pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[86.899611] [017/133] (932s left) gem_ccs (ctrl-surf-copy)
[86.961427] Starting subtest: ctrl-surf-copy
[86.966033] Subtest ctrl-surf-copy: SKIP (0.000s)
[87.086009] [018/133] (931s left) perf (invalid-oa-metric-set-id)
[87.179997] Starting subtest: invalid-oa-metric-set-id
[87.189301] Subtest invalid-oa-metric-set-id: SUCCESS (0.009s)
[87.227907] [019/133] (931s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite)
[87.331179] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite
[87.334682] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[87.425404] [020/133] (931s left) gem_pxp (create-regular-buffer)
[87.539509] Starting subtest: create-regular-buffer
[87.541631] Subtest create-regular-buffer: SUCCESS (0.000s)
[87.667454] [021/133] (931s left) gem_eio (in-flight-contexts-10ms)
[87.865167] Starting subtest: in-flight-contexts-10ms
[101.935845] Subtest in-flight-contexts-10ms: SUCCESS (14.070s)
[102.115976] [022/133] (917s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[102.218685] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[108.979436] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SUCCESS (6.764s)
[109.138227] [023/133] (910s left) gem_exec_schedule (u-fairslice-all)
[109.223430] Starting subtest: u-fairslice-all
[111.283795] Subtest u-fairslice-all: SUCCESS (2.062s)
[111.602690] [024/133] (907s left) core_getstats (basic)
[111.662070] Starting subtest: basic
[111.664466] Subtest basic: SUCCESS (0.000s)
[111.799749] [025/133] (907s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs)
[111.888656] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs
[111.890857] Starting dynamic subtest: pipe-A-eDP-1
[112.745822] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.852s)
[112.755131] Starting dynamic subtest: pipe-B-eDP-1
[114.310533] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.561s)
[114.319210] Starting dynamic subtest: pipe-C-eDP-1
[115.809701] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.495s)
[115.822563] Starting dynamic subtest: pipe-D-eDP-1
[117.354218] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.546s)
[117.356491] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SUCCESS (5.459s)
[118.532718] [026/133] (900s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[118.630104] Starting subtest: bad-pixel-format-4-tiled-dg2-mc-ccs
[118.632324] Starting dynamic subtest: pipe-A-eDP-1
[118.654999] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[118.664297] Starting dynamic subtest: pipe-B-eDP-1
[118.688503] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[118.696038] Starting dynamic subtest: pipe-C-eDP-1
[118.716192] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[118.724374] Starting dynamic subtest: pipe-D-eDP-1
[118.746698] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[118.751154] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[120.903303] [027/133] (898s left) sw_sync (alloc_fence)
[120.941772] Starting subtest: alloc_fence
[120.944048] Subtest alloc_fence: SUCCESS (0.000s)
[121.004525] [028/133] (898s left) i915_pm_rps (basic-api)
[121.071393] Starting subtest: basic-api
[121.076086] Subtest basic-api: SKIP (0.001s)
[121.176657] [029/133] (898s left) kms_cursor_legacy (cursorb-vs-flipa-toggle)
[121.307613] Starting subtest: cursorB-vs-flipA-toggle
[121.312390] Subtest cursorB-vs-flipA-toggle: SKIP (0.001s)
[121.475252] [030/133] (897s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[121.699804] Starting subtest: cursor-rapid-movement-128x42
[121.744447] Subtest cursor-rapid-movement-128x42: SKIP (0.042s)
[121.999936] [031/133] (897s left) kms_dp_link_training (non-uhbr-sst)
[122.083355] Starting subtest: non-uhbr-sst
[122.090515] Subtest non-uhbr-sst: SKIP (0.000s)
[122.168189] [032/133] (897s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[122.262281] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[122.265862] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[122.353388] [033/133] (897s left) gem_exec_parallel (engines)
[122.424114] Starting subtest: engines
[122.426125] Starting dynamic subtest: basic
[123.971394] Dynamic subtest basic: SUCCESS (1.546s)
[123.982212] Starting dynamic subtest: contexts
[128.286691] Dynamic subtest contexts: SUCCESS (4.312s)
[128.297739] Starting dynamic subtest: fds
[132.217533] Dynamic subtest fds: SUCCESS (3.929s)
[132.231157] Starting dynamic subtest: userptr
[133.940081] Dynamic subtest userptr: SUCCESS (1.721s)
[133.942756] Subtest engines: SUCCESS (11.515s)
[134.141654] [034/133] (885s left) gem_eio (in-flight-immediate)
[134.393628] Starting subtest: in-flight-immediate
[143.182135] Subtest in-flight-immediate: SUCCESS (8.788s)
[143.376466] [FACT gem_eio (in-flight-immediate)] new: kernel.kmod_is_loaded.vgem: true
[143.379914] [035/133] (876s left) prime_mmap (test_forked)
[143.441065] Starting subtest: test_forked
[143.443054] Starting dynamic subtest: test_forked-smem
[143.477486] Dynamic subtest test_forked-smem: SUCCESS (0.038s)
[143.480000] Subtest test_forked: SUCCESS (0.040s)
[143.595885] [036/133] (876s left) kms_dsc (dsc-with-formats)
[143.678861] Starting subtest: dsc-with-formats
[143.716691] Subtest dsc-with-formats: SKIP (0.001s)
[143.761237] [037/133] (876s left) prime_busy (hang)
[143.808942] Starting subtest: hang
[143.811174] Starting dynamic subtest: rcs0
[170.418112] Dynamic subtest rcs0: SUCCESS (26.605s)
[170.426439] Starting dynamic subtest: bcs0
[177.571490] Dynamic subtest bcs0: SUCCESS (7.150s)
[177.581788] Starting dynamic subtest: vcs0
[184.545578] Dynamic subtest vcs0: SUCCESS (6.976s)
[184.554094] Starting dynamic subtest: vcs1
[191.586853] Dynamic subtest vcs1: SUCCESS (7.040s)
[191.595784] Starting dynamic subtest: vecs0
[198.554958] Dynamic subtest vecs0: SUCCESS (6.967s)
[198.563638] Starting dynamic subtest: ccs0
[212.400132] Dynamic subtest ccs0: SUCCESS (13.843s)
[212.402644] Subtest hang: SUCCESS (68.588s)
[212.554546] [038/133] (807s left) kms_vblank (wait-idle)
[212.662082] Starting subtest: wait-idle
[212.663985] Starting dynamic subtest: pipe-A-eDP-1
[214.424388] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.763s)
[214.439064] Starting dynamic subtest: pipe-D-eDP-1
[216.903064] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.475s)
[216.905304] Subtest wait-idle: SUCCESS (4.242s)
[217.737191] [039/133] (802s left) kms_pm_rpm (package-g7)
[219.265344] Starting subtest: package-g7
[219.270078] Subtest package-g7: SKIP (0.000s)
[219.982817] [040/133] (799s left) kms_cursor_legacy (flip-vs-cursor-varying-size)
[220.095663] Starting subtest: flip-vs-cursor-varying-size
[228.661387] Subtest flip-vs-cursor-varying-size: SUCCESS (8.565s)
[229.499783] [041/133] (790s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[229.607238] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[236.955784] Subtest psr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.352s)
[237.133376] [042/133] (782s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[237.187384] Starting subtest: single-wait-all-for-submit-signaled
[237.189378] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[237.305197] [043/133] (782s left) perf (gen12-group-exclusive-stream-ctx-handle)
[237.399657] Starting subtest: gen12-group-exclusive-stream-ctx-handle
[237.426270] Subtest gen12-group-exclusive-stream-ctx-handle: SUCCESS (0.025s)
[237.467044] [044/133] (782s left) gem_wait (busy)
[238.911936] Starting subtest: busy
[238.914444] Starting dynamic subtest: all-engines
[240.918091] Dynamic subtest all-engines: SUCCESS (2.004s)
[240.929445] Starting dynamic subtest: rcs0
[241.460134] Dynamic subtest rcs0: SUCCESS (0.542s)
[241.470781] Starting dynamic subtest: bcs0
[242.000220] Dynamic subtest bcs0: SUCCESS (0.539s)
[242.010643] Starting dynamic subtest: vcs0
[243.925749] Dynamic subtest vcs0: SUCCESS (1.923s)
[243.936435] Starting dynamic subtest: vcs1
[245.922998] Dynamic subtest vcs1: SUCCESS (1.982s)
[245.933526] Starting dynamic subtest: vecs0
[247.894273] Dynamic subtest vecs0: SUCCESS (1.982s)
[247.906678] Starting dynamic subtest: ccs0
[248.435980] Dynamic subtest ccs0: SUCCESS (0.541s)
[248.438443] Subtest busy: SUCCESS (9.524s)
[248.657061] [045/133] (771s left) gen9_exec_parse (bb-secure)
[248.726530] Subtest bb-secure: SKIP (0.000s)
[248.795390] [046/133] (771s left) kms_cursor_edge_walk (128x128-right-edge)
[248.903850] Starting subtest: 128x128-right-edge
[248.906154] Starting dynamic subtest: pipe-A-eDP-1
[252.340924] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.438s)
[252.349875] Starting dynamic subtest: pipe-D-eDP-1
[255.463838] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.119s)
[255.466158] Subtest 128x128-right-edge: SUCCESS (6.559s)
[256.293354] [047/133] (763s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[256.392482] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-gtt
[256.396763] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[256.509413] [048/133] (763s left) prime_mmap (test_forked_cpu_write)
[256.563432] Starting subtest: test_forked_cpu_write
[256.565414] Starting dynamic subtest: test_forked_cpu_write-smem
[256.570333] Dynamic subtest test_forked_cpu_write-smem: SUCCESS (0.007s)
[256.572510] Subtest test_forked_cpu_write: SUCCESS (0.008s)
[256.680742] [049/133] (763s left) kms_addfb_basic (small-bo)
[256.769112] Starting subtest: small-bo
[256.770994] Subtest small-bo: SUCCESS (0.000s)
[256.891629] [050/133] (763s left) kms_chamelium_audio (dp-audio)
[257.277979] Subtest dp-audio: SKIP (0.000s)
[258.091319] [051/133] (762s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[258.486213] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[259.313643] [052/133] (761s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[259.414078] Starting subtest: psr-shrfb-scaledprimary
[265.222414] Subtest psr-shrfb-scaledprimary: SUCCESS (5.811s)
[265.373742] [053/133] (755s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling)
[265.467298] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling
[265.471281] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.000s)
[265.566138] [054/133] (754s left) perf (i915-ref-count)
[265.645957] Starting subtest: i915-ref-count
[265.670525] Subtest i915-ref-count: SUCCESS (0.025s)
[265.727183] [055/133] (754s left) kms_joiner (invalid-modeset-force-big-joiner)
[265.828279] Starting subtest: invalid-modeset-force-big-joiner
[265.832515] Subtest invalid-modeset-force-big-joiner: SKIP (0.000s)
[265.904600] [056/133] (754s left) kms_cursor_crc (cursor-alpha-opaque)
[265.999174] Starting subtest: cursor-alpha-opaque
[266.001246] Starting dynamic subtest: pipe-A-eDP-1
[266.595115] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.597s)
[266.604529] Starting dynamic subtest: pipe-D-eDP-1
[267.893663] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.297s)
[267.896277] Subtest cursor-alpha-opaque: SUCCESS (1.897s)
[268.696610] [057/133] (751s left) kms_legacy_colorkey (basic)
[268.794208] Starting subtest: basic
[268.796432] Starting dynamic subtest: pipe-A
[268.837374] Dynamic subtest pipe-A: SUCCESS (0.045s)
[268.848086] Starting dynamic subtest: pipe-B
[268.850633] Dynamic subtest pipe-B: SUCCESS (0.000s)
[268.858769] Starting dynamic subtest: pipe-C
[268.861075] Dynamic subtest pipe-C: SUCCESS (0.000s)
[268.868873] Starting dynamic subtest: pipe-D
[268.870798] Dynamic subtest pipe-D: SUCCESS (0.000s)
[268.872685] Subtest basic: SUCCESS (0.050s)
[268.919041] [058/133] (751s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180-hflip)
[269.044187] Starting subtest: linear-max-hw-stride-64bpp-rotate-180-hflip
[269.048985] Subtest linear-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[269.187894] [059/133] (751s left) kms_addfb_basic (bad-pitch-32)
[269.255408] Starting subtest: bad-pitch-32
[269.257633] Subtest bad-pitch-32: SUCCESS (0.000s)
[269.437384] [060/133] (751s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[269.504768] Starting subtest: x-tiled-to-vebox-y-tiled
[269.509262] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[269.699594] [061/133] (751s left) gem_exec_reloc (basic-range)
[269.766070] Subtest basic-range: SKIP (0.000s)
[269.854057] [062/133] (750s left) kms_big_fb (yf-tiled-64bpp-rotate-0)
[269.949861] Starting subtest: yf-tiled-64bpp-rotate-0
[269.954248] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s)
[270.077280] [063/133] (750s left) syncobj_wait (wait-all-for-submit-snapshot)
[270.133047] Starting subtest: wait-all-for-submit-snapshot
[270.214095] Subtest wait-all-for-submit-snapshot: SUCCESS (0.081s)
[270.316103] [064/133] (750s left) kms_async_flips (invalid-async-flip)
[270.405969] Starting subtest: invalid-async-flip
[270.789019] Starting dynamic subtest: pipe-A-eDP-1
[271.614458] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.826s)
[271.971242] Starting dynamic subtest: pipe-B-eDP-1
[272.745771] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.782s)
[273.101515] Starting dynamic subtest: pipe-C-eDP-1
[273.872048] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.778s)
[274.231942] Starting dynamic subtest: pipe-D-eDP-1
[275.005663] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.780s)
[275.008060] Subtest invalid-async-flip: SUCCESS (4.601s)
[276.173900] [065/133] (744s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[276.289386] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[276.291725] Starting dynamic subtest: A-eDP1
[279.867184] Dynamic subtest A-eDP1: SUCCESS (3.575s)
[279.885208] Starting dynamic subtest: B-eDP1
[283.284514] Dynamic subtest B-eDP1: SUCCESS (3.414s)
[283.296174] Starting dynamic subtest: C-eDP1
[286.406099] Dynamic subtest C-eDP1: SUCCESS (3.123s)
[286.415536] Starting dynamic subtest: D-eDP1
[289.519215] Dynamic subtest D-eDP1: SUCCESS (3.109s)
[289.521423] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (13.229s)
[290.334218] [066/133] (730s left) kms_frontbuffer_tracking (fbc-suspend)
[290.461666] Starting subtest: fbc-suspend
[330.961240] Subtest fbc-suspend: SUCCESS (10.289s)
[333.171118] [067/133] (688s left) syncobj_timeline (invalid-transfer-bad-pad)
[333.235050] Starting subtest: invalid-transfer-bad-pad
[333.237455] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s)
[333.362281] [068/133] (688s left) kms_big_fb (4-tiled-64bpp-rotate-90)
[333.469288] Starting subtest: 4-tiled-64bpp-rotate-90
[333.489727] Subtest 4-tiled-64bpp-rotate-90: SKIP (0.020s)
[333.622228] [069/133] (688s left) gem_ctx_persistence (saturated-hostile-nopreempt)
[333.688610] Starting subtest: saturated-hostile-nopreempt
[333.690565] Starting dynamic subtest: rcs0
[333.745902] Dynamic subtest rcs0: SKIP (0.058s)
[333.757050] Starting dynamic subtest: bcs0
[333.801807] Dynamic subtest bcs0: SKIP (0.054s)
[333.811583] Starting dynamic subtest: vcs0
[333.820537] Dynamic subtest vcs0: SKIP (0.017s)
[333.829975] Starting dynamic subtest: vcs1
[333.834536] Dynamic subtest vcs1: SKIP (0.011s)
[333.843455] Starting dynamic subtest: vecs0
[333.855537] Dynamic subtest vecs0: SKIP (0.022s)
[333.864696] Starting dynamic subtest: ccs0
[333.878662] Dynamic subtest ccs0: SKIP (0.022s)
[333.883182] Subtest saturated-hostile-nopreempt: SKIP (0.192s)
[333.996084] [070/133] (688s left) gem_exec_big (single)
[334.060644] Starting subtest: single
[336.557994] Subtest single: SUCCESS (2.495s)
[336.808673] [071/133] (685s left) gem_exec_fence (submit67)
[337.023212] Starting subtest: submit67
[337.027917] Subtest submit67: SKIP (0.000s)
[339.186768] [072/133] (683s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[339.308511] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[339.312923] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[339.478311] [073/133] (682s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[339.575098] Starting subtest: fbc-rgb101010-draw-mmap-wc
[344.156850] Subtest fbc-rgb101010-draw-mmap-wc: SUCCESS (4.581s)
[345.380386] [074/133] (677s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-gtt)
[345.491866] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-gtt
[345.496012] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[345.633877] [075/133] (676s left) i915_drm_fdinfo (busy-idle)
[345.676604] Starting subtest: busy-idle
[345.678565] Starting dynamic subtest: rcs0
[345.713087] Dynamic subtest rcs0: SKIP (0.037s)
[345.725057] Starting dynamic subtest: bcs0
[345.728996] Dynamic subtest bcs0: SKIP (0.000s)
[345.738572] Starting dynamic subtest: vcs0
[345.742635] Dynamic subtest vcs0: SKIP (0.000s)
[345.751864] Starting dynamic subtest: vcs1
[345.755702] Dynamic subtest vcs1: SKIP (0.000s)
[345.764858] Starting dynamic subtest: vecs0
[345.768723] Dynamic subtest vecs0: SKIP (0.000s)
[345.778030] Starting dynamic subtest: ccs0
[345.781912] Dynamic subtest ccs0: SKIP (0.000s)
[345.785926] Subtest busy-idle: SKIP (0.044s)
[345.824053] [076/133] (676s left) kms_psr (psr2-primary-page-flip)
[345.923323] Starting subtest: psr2-primary-page-flip
[345.925693] Starting dynamic subtest: eDP-1
[347.627395] Dynamic subtest eDP-1: SUCCESS (1.703s)
[347.629547] Subtest psr2-primary-page-flip: SUCCESS (1.704s)
[348.525323] [077/133] (674s left) kms_cursor_legacy (cursora-vs-flipb-atomic)
[348.650713] Starting subtest: cursorA-vs-flipB-atomic
[348.655248] Subtest cursorA-vs-flipB-atomic: SKIP (0.001s)
[348.831613] [078/133] (673s left) kms_prop_blob (blob-prop-lifetime)
[348.887444] Starting subtest: blob-prop-lifetime
[348.889695] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[349.013176] [079/133] (673s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats)
[349.101077] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats
[349.103282] Starting dynamic subtest: pipe-A
[349.221540] Dynamic subtest pipe-A: SKIP (0.117s)
[349.232279] Starting dynamic subtest: pipe-B
[350.390984] Dynamic subtest pipe-B: SKIP (1.168s)
[350.403498] Starting dynamic subtest: pipe-C
[351.530236] Dynamic subtest pipe-C: SUCCESS (1.144s)
[351.540435] Starting dynamic subtest: pipe-D
[352.672900] Dynamic subtest pipe-D: SUCCESS (1.141s)
[352.675352] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (3.574s)
[353.886177] [080/133] (668s left) kms_pipe_crc_basic (hang-read-crc)
[353.990213] Starting subtest: hang-read-crc
[353.992176] Starting dynamic subtest: pipe-A-eDP-1
[356.054617] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.063s)
[356.065724] Starting dynamic subtest: pipe-B-eDP-1
[358.751890] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.695s)
[358.763257] Starting dynamic subtest: pipe-C-eDP-1
[361.438411] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.686s)
[361.450039] Starting dynamic subtest: pipe-D-eDP-1
[364.090732] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.651s)
[364.093191] Subtest hang-read-crc: SUCCESS (10.101s)
[364.934721] [081/133] (657s left) kms_selftest (drm_format)
[364.990243] Starting subtest: drm_format
[365.001256] Starting dynamic subtest: drm_test_format_block_width_invalid
[365.133208] Dynamic subtest drm_test_format_block_width_invalid: SUCCESS (0.130s)
[365.144702] Starting dynamic subtest: drm_test_format_block_width_one_plane
[365.223347] Dynamic subtest drm_test_format_block_width_one_plane: SUCCESS (0.090s)
[365.234828] Starting dynamic subtest: drm_test_format_block_width_two_plane
[365.331156] Dynamic subtest drm_test_format_block_width_two_plane: SUCCESS (0.107s)
[365.342553] Starting dynamic subtest: drm_test_format_block_width_three_plane
[365.482134] Dynamic subtest drm_test_format_block_width_three_plane: SUCCESS (0.150s)
[365.493650] Starting dynamic subtest: drm_test_format_block_width_tiled
[365.636163] Dynamic subtest drm_test_format_block_width_tiled: SUCCESS (0.153s)
[365.645894] Starting dynamic subtest: drm_test_format_block_height_invalid
[365.795228] Dynamic subtest drm_test_format_block_height_invalid: SUCCESS (0.159s)
[365.806150] Starting dynamic subtest: drm_test_format_block_height_one_plane
[365.934490] Dynamic subtest drm_test_format_block_height_one_plane: SUCCESS (0.136s)
[365.945790] Starting dynamic subtest: drm_test_format_block_height_two_plane
[366.087076] Dynamic subtest drm_test_format_block_height_two_plane: SUCCESS (0.153s)
[366.098347] Starting dynamic subtest: drm_test_format_block_height_three_plane
[366.245334] Dynamic subtest drm_test_format_block_height_three_plane: SUCCESS (0.157s)
[366.254776] Starting dynamic subtest: drm_test_format_block_height_tiled
[366.390847] Dynamic subtest drm_test_format_block_height_tiled: SUCCESS (0.144s)
[366.402291] Starting dynamic subtest: drm_test_format_min_pitch_invalid
[366.534546] Dynamic subtest drm_test_format_min_pitch_invalid: SUCCESS (0.144s)
[366.544286] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_8bpp
[366.694349] Dynamic subtest drm_test_format_min_pitch_one_plane_8bpp: SUCCESS (0.158s)
[366.705754] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_16bpp
[366.828233] Dynamic subtest drm_test_format_min_pitch_one_plane_16bpp: SUCCESS (0.134s)
[366.838004] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_24bpp
[366.965010] Dynamic subtest drm_test_format_min_pitch_one_plane_24bpp: SUCCESS (0.135s)
[366.976008] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_32bpp
[367.110180] Dynamic subtest drm_test_format_min_pitch_one_plane_32bpp: SUCCESS (0.145s)
[367.121314] Starting dynamic subtest: drm_test_format_min_pitch_two_plane
[367.256189] Dynamic subtest drm_test_format_min_pitch_two_plane: SUCCESS (0.145s)
[367.267292] Starting dynamic subtest: drm_test_format_min_pitch_three_plane_8bpp
[367.422840] Dynamic subtest drm_test_format_min_pitch_three_plane_8bpp: SUCCESS (0.166s)
[367.433986] Starting dynamic subtest: drm_test_format_min_pitch_tiled
[367.569291] Dynamic subtest drm_test_format_min_pitch_tiled: SUCCESS (0.144s)
[367.571605] Subtest drm_format: SUCCESS (2.575s)
[367.794191] [082/133] (654s left) gem_close_race (multigpu-basic-process)
[367.882997] Starting subtest: multigpu-basic-process
[367.887155] Subtest multigpu-basic-process: SKIP (0.000s)
[368.154160] [083/133] (654s left) gem_set_tiling_vs_gtt
[368.275145] [084/133] (654s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[368.378962] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[368.381253] Starting dynamic subtest: pipe-A
[368.398847] Dynamic subtest pipe-A: SKIP (0.017s)
[368.409601] Starting dynamic subtest: pipe-B
[368.431462] Dynamic subtest pipe-B: SKIP (0.031s)
[368.442743] Starting dynamic subtest: pipe-C
[368.463789] Dynamic subtest pipe-C: SKIP (0.030s)
[368.474665] Starting dynamic subtest: pipe-D
[368.493864] Dynamic subtest pipe-D: SKIP (0.031s)
[368.498348] Subtest planes-downscale-factor-0-5-unity-scaling: SKIP (0.112s)
[368.629177] [085/133] (654s left) kms_addfb_basic (basic-y-tiled-legacy)
[368.692862] Starting subtest: basic-y-tiled-legacy
[368.697116] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[368.860681] [086/133] (654s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0)
[368.971289] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0
[370.049459] Subtest x-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.079s)
[370.222097] [087/133] (652s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs)
[370.281927] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs
[370.285723] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[370.490829] [088/133] (652s left) gem_caching (writes)
[370.547699] Subtest writes: SKIP (0.000s)
[370.644101] [089/133] (652s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted)
[370.708254] Starting subtest: etime-multi-wait-for-submit-unsubmitted
[370.816162] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.108s)
[370.904485] [090/133] (652s left) kms_flip (wf_vblank-ts-check)
[371.012441] Starting subtest: wf_vblank-ts-check
[371.014807] Starting dynamic subtest: A-eDP1
[379.969194] Dynamic subtest A-eDP1: SUCCESS (8.957s)
[379.980747] Starting dynamic subtest: B-eDP1
[388.896756] Dynamic subtest B-eDP1: SUCCESS (8.925s)
[388.907024] Starting dynamic subtest: C-eDP1
[397.823808] Dynamic subtest C-eDP1: SUCCESS (8.924s)
[397.836906] Starting dynamic subtest: D-eDP1
[406.752537] Dynamic subtest D-eDP1: SUCCESS (8.927s)
[406.758619] Subtest wf_vblank-ts-check: SUCCESS (35.742s)
[408.003790] [091/133] (615s left) gem_lmem_evict (dontneed-evict-race)
[408.053582] Subtest dontneed-evict-race: SKIP (0.000s)
[408.102921] [092/133] (615s left) gem_mmap_gtt (medium-copy-odd)
[408.163997] Subtest medium-copy-odd: SKIP (0.000s)
[408.232699] [093/133] (615s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier)
[408.327318] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier
[408.340454] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier: SKIP (0.000s)
[408.412799] [094/133] (614s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc)
[408.515168] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc
[408.517477] Starting dynamic subtest: pipe-A-eDP-1
[408.576684] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[408.588578] Starting dynamic subtest: pipe-B-eDP-1
[408.646625] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[408.658829] Starting dynamic subtest: pipe-C-eDP-1
[408.716183] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[408.727298] Starting dynamic subtest: pipe-D-eDP-1
[408.784005] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[408.788452] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.009s)
[410.756554] [095/133] (612s left) gem_exec_suspend (basic-s0)
[410.821679] Starting subtest: basic-S0
[410.826135] Starting dynamic subtest: smem
[430.445677] Dynamic subtest smem: SUCCESS (6.292s)
[430.448577] Subtest basic-S0: SUCCESS (6.294s)
[430.646434] [096/133] (592s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[430.763434] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[431.844124] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.079s)
[432.011273] [097/133] (591s left) gem_mmap_offset (bad-extensions)
[432.079807] Starting subtest: bad-extensions
[432.081856] Subtest bad-extensions: SUCCESS (0.000s)
[432.215801] [098/133] (591s left) kms_cursor_legacy (2x-long-nonblocking-modeset-vs-cursor-atomic)
[432.345438] Starting subtest: 2x-long-nonblocking-modeset-vs-cursor-atomic
[432.349261] Subtest 2x-long-nonblocking-modeset-vs-cursor-atomic: SKIP (0.001s)
[432.513806] [099/133] (591s left) gem_mmap_gtt (cpuset-big-copy-odd)
[432.574782] Subtest cpuset-big-copy-odd: SKIP (0.000s)
[432.646271] [100/133] (590s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[432.744811] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[432.748416] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[432.861861] [101/133] (590s left) kms_psr (fbc-psr2-sprite-render)
[432.950431] Starting subtest: fbc-psr2-sprite-render
[432.952332] Starting dynamic subtest: eDP-1
[432.955815] Dynamic subtest eDP-1: SKIP (0.000s)
[432.959242] Subtest fbc-psr2-sprite-render: SKIP (0.001s)
[433.047422] [102/133] (590s left) kms_frontbuffer_tracking (fbcpsr-1p-shrfb-fliptrack-mmap-gtt)
[433.146722] Starting subtest: fbcpsr-1p-shrfb-fliptrack-mmap-gtt
[433.150089] Subtest fbcpsr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[433.292752] [103/133] (590s left) kms_ccs (crc-primary-basic-y-tiled-ccs)
[433.381833] Starting subtest: crc-primary-basic-y-tiled-ccs
[433.383671] Starting dynamic subtest: pipe-A-eDP-1
[433.402590] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[433.415021] Starting dynamic subtest: pipe-B-eDP-1
[433.434065] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[433.445603] Starting dynamic subtest: pipe-C-eDP-1
[433.463877] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[433.475316] Starting dynamic subtest: pipe-D-eDP-1
[433.493856] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[433.497421] Subtest crc-primary-basic-y-tiled-ccs: SKIP (0.006s)
[435.561166] [104/133] (588s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[435.665275] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[435.669486] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[435.814475] [105/133] (588s left) api_intel_bb (add-remove-objects)
[435.867057] Starting subtest: add-remove-objects
[435.872442] Subtest add-remove-objects: SUCCESS (0.007s)
[436.041735] [106/133] (587s left) sysfs_heartbeat_interval (nopreempt)
[436.106727] Starting subtest: nopreempt
[436.109167] Starting dynamic subtest: vecs0
[445.506875] Dynamic subtest vecs0: SUCCESS (9.393s)
[445.519817] Starting dynamic subtest: ccs0
[449.602166] Dynamic subtest ccs0: SUCCESS (4.091s)
[449.615405] Starting dynamic subtest: vcs0
[459.453478] Dynamic subtest vcs0: SUCCESS (9.844s)
[459.469935] Starting dynamic subtest: bcs0
[463.467480] Dynamic subtest bcs0: SUCCESS (4.014s)
[463.480500] Starting dynamic subtest: rcs0
[467.550801] Dynamic subtest rcs0: SUCCESS (4.084s)
[467.563665] Starting dynamic subtest: vcs1
[477.448349] Dynamic subtest vcs1: SUCCESS (9.895s)
[477.451032] Subtest nopreempt: SUCCESS (41.333s)
[477.536620] [107/133] (546s left) kms_getfb (getfb2-into-addfb2)
[477.643443] Starting subtest: getfb2-into-addfb2
[477.645716] Subtest getfb2-into-addfb2: SUCCESS (0.000s)
[477.785560] [108/133] (546s left) gem_close (basic)
[477.851838] Starting subtest: basic
[477.854176] Subtest basic: SUCCESS (0.000s)
[477.982401] [109/133] (546s left) gem_exec_schedule (preemptive-hang)
[478.175070] Starting subtest: preemptive-hang
[478.177124] Starting dynamic subtest: rcs0
[487.579664] Dynamic subtest rcs0: SUCCESS (9.405s)
[487.590918] Starting dynamic subtest: bcs0
[496.599060] Dynamic subtest bcs0: SUCCESS (9.019s)
[496.611215] Starting dynamic subtest: vcs0
[505.564782] Dynamic subtest vcs0: SUCCESS (8.962s)
[505.574974] Starting dynamic subtest: vcs1
[514.581471] Dynamic subtest vcs1: SUCCESS (9.012s)
[514.591943] Starting dynamic subtest: vecs0
[523.539502] Dynamic subtest vecs0: SUCCESS (8.954s)
[523.550186] Starting dynamic subtest: ccs0
[532.567407] Dynamic subtest ccs0: SUCCESS (9.027s)
[532.569656] Subtest preemptive-hang: SUCCESS (54.393s)
[532.823912] [110/133] (491s left) i915_drm_fdinfo (virtual-busy-idle)
[532.867216] Starting subtest: virtual-busy-idle
[532.871952] Subtest virtual-busy-idle: SKIP (0.000s)
[532.947368] [111/133] (491s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-wc)
[533.058236] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-wc
[537.042153] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (3.986s)
[538.237667] [112/133] (485s left) gem_linear_blits (interruptible)
[538.457111] Starting subtest: interruptible
[542.674643] Subtest interruptible: SUCCESS (4.217s)
[542.835053] [113/133] (481s left) gem_ctx_persistence (engines-mixed)
[542.940445] Starting subtest: engines-mixed
[542.942772] Starting dynamic subtest: rcs0
[543.050593] Dynamic subtest rcs0: SUCCESS (0.109s)
[543.063426] Starting dynamic subtest: bcs0
[543.147874] Dynamic subtest bcs0: SUCCESS (0.095s)
[543.165840] Starting dynamic subtest: vcs0
[543.188692] Dynamic subtest vcs0: SUCCESS (0.039s)
[543.199345] Starting dynamic subtest: vcs1
[543.319123] Dynamic subtest vcs1: SUCCESS (0.129s)
[543.331240] Starting dynamic subtest: vecs0
[543.405129] Dynamic subtest vecs0: SUCCESS (0.084s)
[543.417999] Starting dynamic subtest: ccs0
[543.446667] Dynamic subtest ccs0: SUCCESS (0.040s)
[543.448998] Subtest engines-mixed: SUCCESS (0.507s)
[543.602497] [114/133] (480s left) perf_pmu (init-wait)
[543.647929] Starting subtest: init-wait
[543.650159] Starting dynamic subtest: rcs0
[543.652464] Dynamic subtest rcs0: SUCCESS (0.002s)
[543.663423] Starting dynamic subtest: bcs0
[543.665203] Dynamic subtest bcs0: SUCCESS (0.000s)
[543.674468] Starting dynamic subtest: vcs0
[543.676345] Dynamic subtest vcs0: SUCCESS (0.001s)
[543.685473] Starting dynamic subtest: vcs1
[543.686987] Dynamic subtest vcs1: SUCCESS (0.001s)
[543.695896] Starting dynamic subtest: vecs0
[543.698003] Dynamic subtest vecs0: SUCCESS (0.001s)
[543.707354] Starting dynamic subtest: ccs0
[543.709107] Dynamic subtest ccs0: SUCCESS (0.000s)
[543.710879] Subtest init-wait: SUCCESS (0.008s)
[543.781396] [115/133] (480s left) gem_exec_reloc (basic-gtt-cpu-active)
[543.849254] Subtest basic-gtt-cpu-active: SKIP (0.000s)
[543.945039] [116/133] (480s left) kms_pm_lpsp (screens-disabled)
[545.052392] Starting subtest: screens-disabled
[545.056618] Subtest screens-disabled: SKIP (0.000s)
[545.136325] [117/133] (479s left) kms_flip (flip-vs-expired-vblank-interruptible)
[545.234719] Starting subtest: flip-vs-expired-vblank-interruptible
[545.237136] Starting dynamic subtest: A-eDP1
[553.916416] Dynamic subtest A-eDP1: SUCCESS (8.681s)
[553.927789] Starting dynamic subtest: B-eDP1
[562.548573] Dynamic subtest B-eDP1: SUCCESS (8.631s)
[562.560894] Starting dynamic subtest: C-eDP1
[571.174535] Dynamic subtest C-eDP1: SUCCESS (8.624s)
[571.191297] Starting dynamic subtest: D-eDP1
[579.806785] Dynamic subtest D-eDP1: SUCCESS (8.630s)
[579.812771] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (34.575s)
[580.995221] [118/133] (443s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move)
[581.106109] Starting subtest: psr-1p-primscrn-cur-indfb-move
[588.445390] Subtest psr-1p-primscrn-cur-indfb-move: SUCCESS (7.341s)
[588.614999] [119/133] (435s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[588.724488] Starting subtest: plane-all-modeset-transition-internal-panels
[588.726388] Starting dynamic subtest: pipe-A-eDP-1
[590.057094] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.332s)
[590.340501] Starting dynamic subtest: pipe-B-eDP-1
[591.378397] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.050s)
[591.646202] Subtest plane-all-modeset-transition-internal-panels: SUCCESS (2.923s)
[592.498825] [120/133] (431s left) gem_userptr_blits (stress-mm)
[592.576908] Starting subtest: stress-mm
[597.946394] Subtest stress-mm: SUCCESS (5.369s)
[598.103766] [121/133] (426s left) syncobj_eventfd (invalid-bad-flags)
[598.172025] Starting subtest: invalid-bad-flags
[598.174540] Subtest invalid-bad-flags: SUCCESS (0.000s)
[598.279639] [122/133] (426s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[598.338856] Starting subtest: framebuffer-vs-set-tiling
[598.343250] Subtest framebuffer-vs-set-tiling: SKIP (0.000s)
[598.498292] [123/133] (426s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt)
[598.611807] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt
[598.615988] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[598.733658] [124/133] (425s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled)
[598.794423] Starting subtest: multi-wait-for-submit-available-submitted-signaled
[598.796804] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.000s)
[598.925685] [125/133] (425s left) kms_flip (2x-modeset-vs-vblank-race)
[599.021218] Starting subtest: 2x-modeset-vs-vblank-race
[599.030572] Subtest 2x-modeset-vs-vblank-race: SKIP (0.011s)
[599.155592] [126/133] (425s left) i915_query (query-regions-garbage-items)
[599.215712] Starting subtest: query-regions-garbage-items
[599.217607] Subtest query-regions-garbage-items: SUCCESS (0.000s)
[599.360362] [127/133] (425s left) kms_psr_stress_test (flip-primary-invalidate-overlay)
[599.454652] Starting subtest: flip-primary-invalidate-overlay
[611.109101] Subtest flip-primary-invalidate-overlay: SUCCESS (11.654s)
[611.306603] [128/133] (413s left) gem_exec_balancer (full-late)
[611.384782] Starting subtest: full-late
[616.359004] Subtest full-late: SUCCESS (4.973s)
[616.669370] [129/133] (408s left) gem_exec_reloc (basic-write-wc)
[616.733844] Subtest basic-write-wc: SKIP (0.000s)
[616.822341] [130/133] (408s left) kms_force_connector_basic (force-load-detect)
[616.905097] Starting subtest: force-load-detect
[616.909461] Subtest force-load-detect: SKIP (0.000s)
[617.035812] [131/133] (407s left) kms_chamelium_hpd (hdmi-hpd-fast)
[617.425966] Subtest hdmi-hpd-fast: SKIP (0.000s)
[618.209098] [132/133] (406s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-upscaling)
[618.296306] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-upscaling
[618.299140] Starting dynamic subtest: pipe-A-default-mode
[621.087897] Dynamic subtest pipe-A-default-mode: SUCCESS (2.792s)
[621.090244] Subtest flip-64bpp-xtile-to-32bpp-xtile-upscaling: SUCCESS (2.793s)
[621.925402] [133/133] (403s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[622.025515] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu
[622.029568] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[622.150842] Closing watchdogs
results: parsing output: 0/ for test: kms_content_protection
results: parsing output: 1/ for test: core_getversion
results: parsing output: 2/ for test: kms_atomic_interruptible
results: parsing output: 3/ for test: kms_plane
results: parsing output: 4/ for test: kms_atomic_transition
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: perf
results: parsing output: 8/ for test: gem_eio
results: parsing output: 9/ for test: kms_color
results: parsing output: 10/ for test: gem_softpin
results: parsing output: 11/ for test: kms_psr2_sf
results: parsing output: 12/ for test: kms_big_fb
results: parsing output: 13/ for test: kms_psr
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_psr2_sf
results: parsing output: 16/ for test: gem_ccs
results: parsing output: 17/ for test: perf
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: gem_pxp
results: parsing output: 20/ for test: gem_eio
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: gem_exec_schedule
results: parsing output: 23/ for test: core_getstats
results: parsing output: 24/ for test: kms_ccs
results: parsing output: 25/ for test: kms_ccs
results: parsing output: 26/ for test: sw_sync
results: parsing output: 27/ for test: i915_pm_rps
results: parsing output: 28/ for test: kms_cursor_legacy
results: parsing output: 29/ for test: kms_cursor_crc
results: parsing output: 30/ for test: kms_dp_link_training
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: gem_exec_parallel
results: parsing output: 33/ for test: gem_eio
results: parsing output: 34/ for test: prime_mmap
results: parsing output: 35/ for test: kms_dsc
results: parsing output: 36/ for test: prime_busy
results: parsing output: 37/ for test: kms_vblank
results: parsing output: 38/ for test: kms_pm_rpm
results: parsing output: 39/ for test: kms_cursor_legacy
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: syncobj_timeline
results: parsing output: 42/ for test: perf
results: parsing output: 43/ for test: gem_wait
results: parsing output: 44/ for test: gen9_exec_parse
results: parsing output: 45/ for test: kms_cursor_edge_walk
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: prime_mmap
results: parsing output: 48/ for test: kms_addfb_basic
results: parsing output: 49/ for test: kms_chamelium_audio
results: parsing output: 50/ for test: kms_chamelium_edid
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_flip_scaled_crc
results: parsing output: 53/ for test: perf
results: parsing output: 54/ for test: kms_joiner
results: parsing output: 55/ for test: kms_cursor_crc
results: parsing output: 56/ for test: kms_legacy_colorkey
results: parsing output: 57/ for test: kms_big_fb
results: parsing output: 58/ for test: kms_addfb_basic
results: parsing output: 59/ for test: gem_render_copy
results: parsing output: 60/ for test: gem_exec_reloc
results: parsing output: 61/ for test: kms_big_fb
results: parsing output: 62/ for test: syncobj_wait
results: parsing output: 63/ for test: kms_async_flips
results: parsing output: 64/ for test: kms_flip
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: syncobj_timeline
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: gem_ctx_persistence
results: parsing output: 69/ for test: gem_exec_big
results: parsing output: 70/ for test: gem_exec_fence
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: i915_drm_fdinfo
results: parsing output: 75/ for test: kms_psr
results: parsing output: 76/ for test: kms_cursor_legacy
results: parsing output: 77/ for test: kms_prop_blob
results: parsing output: 78/ for test: kms_plane_scaling
results: parsing output: 79/ for test: kms_pipe_crc_basic
results: parsing output: 80/ for test: kms_selftest
results: parsing output: 81/ for test: gem_close_race
results: parsing output: 82/ for test: gem_set_tiling_vs_gtt
results: parsing output: 83/ for test: kms_plane_scaling
results: parsing output: 84/ for test: kms_addfb_basic
results: parsing output: 85/ for test: kms_big_fb
results: parsing output: 86/ for test: gem_render_copy
results: parsing output: 87/ for test: gem_caching
results: parsing output: 88/ for test: syncobj_timeline
results: parsing output: 89/ for test: kms_flip
results: parsing output: 90/ for test: gem_lmem_evict
results: parsing output: 91/ for test: gem_mmap_gtt
results: parsing output: 92/ for test: kms_plane
results: parsing output: 93/ for test: kms_ccs
results: parsing output: 94/ for test: gem_exec_suspend
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: gem_mmap_offset
results: parsing output: 97/ for test: kms_cursor_legacy
results: parsing output: 98/ for test: gem_mmap_gtt
results: parsing output: 99/ for test: kms_big_fb
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: api_intel_bb
results: parsing output: 105/ for test: sysfs_heartbeat_interval
results: parsing output: 106/ for test: kms_getfb
results: parsing output: 107/ for test: gem_close
results: parsing output: 108/ for test: gem_exec_schedule
results: parsing output: 109/ for test: i915_drm_fdinfo
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: gem_linear_blits
results: parsing output: 112/ for test: gem_ctx_persistence
results: parsing output: 113/ for test: perf_pmu
results: parsing output: 114/ for test: gem_exec_reloc
results: parsing output: 115/ for test: kms_pm_lpsp
results: parsing output: 116/ for test: kms_flip
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_atomic_transition
results: parsing output: 119/ for test: gem_userptr_blits
results: parsing output: 120/ for test: syncobj_eventfd
results: parsing output: 121/ for test: kms_addfb_basic
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: syncobj_timeline
results: parsing output: 124/ for test: kms_flip
results: parsing output: 125/ for test: i915_query
results: parsing output: 126/ for test: kms_psr_stress_test
results: parsing output: 127/ for test: gem_exec_balancer
results: parsing output: 128/ for test: gem_exec_reloc
results: parsing output: 129/ for test: kms_force_connector_basic
results: parsing output: 130/ for test: kms_chamelium_hpd
results: parsing output: 131/ for test: kms_flip_scaled_crc
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.