[60.263124] Initializing watchdogs
[60.263232]   /dev/watchdog0
[60.277428] [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]
[60.281850] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[60.283997] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.287638] [001/133] (960s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[60.406365] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[60.410394] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[60.493509] [002/133] (960s left) kms_atomic_transition (plane-all-transition-nonblocking)
[60.588819] Starting subtest: plane-all-transition-nonblocking
[60.591249] Starting dynamic subtest: pipe-A-eDP-1
[63.127368] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.542s)
[63.443623] Starting dynamic subtest: pipe-B-eDP-1
[66.709808] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.274s)
[67.008267] Subtest plane-all-transition-nonblocking: SUCCESS (6.421s)
[67.838136] [003/133] (953s left) gem_lmem_swapping (smem-oom)
[67.913329] Subtest smem-oom: SKIP (0.000s)
[67.959624] [004/133] (952s left) syncobj_eventfd (invalid-bad-flags)
[68.053896] Starting subtest: invalid-bad-flags
[68.056313] Subtest invalid-bad-flags: SUCCESS (0.000s)
[68.239256] [005/133] (952s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[68.339937] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[69.373085] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.034s)
[69.507318] [006/133] (951s left) gem_pxp (create-regular-context-2)
[69.639186] Starting subtest: create-regular-context-2
[69.641316] Subtest create-regular-context-2: SUCCESS (0.002s)
[69.753032] [007/133] (951s left) kms_psr (psr-sprite-mmap-cpu)
[69.843301] Starting subtest: psr-sprite-mmap-cpu
[69.845289] Starting dynamic subtest: eDP-1
[71.564038] Dynamic subtest eDP-1: SUCCESS (1.719s)
[71.566327] Subtest psr-sprite-mmap-cpu: SUCCESS (1.720s)
[72.404132] [008/133] (948s left) kms_addfb_basic (bad-pitch-999)
[72.465433] Starting subtest: bad-pitch-999
[72.467881] Subtest bad-pitch-999: SUCCESS (0.000s)
[72.607402] [009/133] (948s left) kms_async_flips (test-cursor)
[72.683934] Starting subtest: test-cursor
[73.054479] Starting dynamic subtest: pipe-A-eDP-1
[73.884059] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.830s)
[74.273574] Starting dynamic subtest: pipe-B-eDP-1
[75.014121] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.747s)
[75.396632] Starting dynamic subtest: pipe-C-eDP-1
[76.137574] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.748s)
[76.504856] Starting dynamic subtest: pipe-D-eDP-1
[77.262765] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.765s)
[77.265185] Subtest test-cursor: SUCCESS (4.582s)
[78.425972] [010/133] (942s left) kms_color (ctm-0-50)
[78.514347] Starting subtest: ctm-0-50
[78.516524] Starting dynamic subtest: pipe-A-eDP-1
[82.063278] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.548s)
[82.070293] Starting dynamic subtest: pipe-B-eDP-1
[86.338425] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.275s)
[86.346035] Starting dynamic subtest: pipe-C-eDP-1
[90.397388] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.057s)
[90.405893] Starting dynamic subtest: pipe-D-eDP-1
[94.399779] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.004s)
[94.402241] Subtest ctm-0-50: SUCCESS (15.887s)
[95.224954] [011/133] (925s left) kms_addfb_basic (basic)
[95.290079] Starting subtest: basic
[95.292364] Subtest basic: SUCCESS (0.000s)
[95.435919] [012/133] (925s left) prime_mmap_coherency (read)
[95.502075] Starting subtest: read
[100.881865] Subtest read: SUCCESS (5.378s)
[101.011851] [013/133] (920s left) prime_busy (after-wait)
[101.077877] Starting subtest: after-wait
[101.083604] Starting dynamic subtest: rcs0
[101.129284] Dynamic subtest rcs0: SUCCESS (0.049s)
[101.143521] Starting dynamic subtest: bcs0
[101.181909] Dynamic subtest bcs0: SUCCESS (0.052s)
[101.191791] Starting dynamic subtest: vcs0
[101.222550] Dynamic subtest vcs0: SUCCESS (0.040s)
[101.233254] Starting dynamic subtest: vcs1
[101.265103] Dynamic subtest vcs1: SUCCESS (0.042s)
[101.274529] Starting dynamic subtest: vecs0
[101.309158] Dynamic subtest vecs0: SUCCESS (0.043s)
[101.323415] Starting dynamic subtest: ccs0
[101.358854] Dynamic subtest ccs0: SUCCESS (0.048s)
[101.468084] Subtest after-wait: SUCCESS (0.389s)
[101.538480] [014/133] (919s left) gem_exec_fence (submit-chain)
[101.725183] Starting subtest: submit-chain
[101.760225] Subtest submit-chain: SUCCESS (0.037s)
[103.950021] [FACT gem_exec_fence (submit-chain)] new: kernel.kmod_is_loaded.vgem: true
[103.953372] [015/133] (917s left) kms_dsc (dsc-with-output-formats)
[104.044947] Starting subtest: dsc-with-output-formats
[104.067763] Subtest dsc-with-output-formats: SKIP (0.001s)
[104.115468] [016/133] (917s left) kms_busy (extended-modeset-hang-newfb-with-reset)
[104.222450] Starting subtest: extended-modeset-hang-newfb-with-reset
[104.224686] Starting dynamic subtest: pipe-A
[118.300679] Dynamic subtest pipe-A: SUCCESS (14.075s)
[118.309947] Starting dynamic subtest: pipe-D
[133.811081] Dynamic subtest pipe-D: SUCCESS (15.511s)
[133.813404] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (29.590s)
[134.622973] [017/133] (886s left) kms_cursor_crc (cursor-random-32x10)
[134.789099] Starting subtest: cursor-random-32x10
[134.833438] Subtest cursor-random-32x10: SKIP (0.040s)
[135.086942] [018/133] (886s left) api_intel_allocator (simple-allocator)
[135.145589] Starting subtest: simple-allocator
[135.148323] Starting dynamic subtest: basic
[135.150842] Dynamic subtest basic: SUCCESS (0.003s)
[135.166906] Starting dynamic subtest: parallel-one
[135.333795] Dynamic subtest parallel-one: SUCCESS (0.186s)
[135.341418] Starting dynamic subtest: print
[135.343699] Dynamic subtest print: SUCCESS (0.000s)
[135.351177] Starting dynamic subtest: reuse
[135.352975] Dynamic subtest reuse: SUCCESS (0.000s)
[135.359937] Starting dynamic subtest: reserve
[135.361804] Dynamic subtest reserve: SUCCESS (0.000s)
[135.368628] Starting dynamic subtest: fork-reopen-allocator
[135.370485] Dynamic subtest fork-reopen-allocator: SUCCESS (0.011s)
[135.372335] Subtest simple-allocator: SUCCESS (0.206s)
[135.482028] [019/133] (886s left) gem_exec_whisper (basic-fds-priority-all)
[135.557883] Starting subtest: basic-fds-priority-all
[159.054988] Subtest basic-fds-priority-all: SUCCESS (23.497s)
[159.237945] [020/133] (862s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-plflip-blt)
[159.327260] Starting subtest: psr-2p-primscrn-indfb-plflip-blt
[159.331554] Subtest psr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[159.413327] [021/133] (862s left) gem_exec_alignment (pi-isolated)
[159.482893] Starting subtest: pi-isolated
[212.710724] Subtest pi-isolated: SUCCESS (53.224s)
[213.703740] [022/133] (807s left) sysfs_timeslice_duration (timeout)
[213.803703] Starting subtest: timeout
[213.806063] Starting dynamic subtest: vecs0
[222.926081] Dynamic subtest vecs0: SUCCESS (9.119s)
[222.938115] Starting dynamic subtest: ccs0
[224.230622] Dynamic subtest ccs0: SUCCESS (1.304s)
[224.239043] Starting dynamic subtest: vcs0
[233.865898] Dynamic subtest vcs0: SUCCESS (9.632s)
[233.877085] Starting dynamic subtest: bcs0
[234.509654] Dynamic subtest bcs0: SUCCESS (0.645s)
[234.523558] Starting dynamic subtest: rcs0
[235.731852] Dynamic subtest rcs0: SUCCESS (1.219s)
[235.743276] Starting dynamic subtest: vcs1
[244.884985] Dynamic subtest vcs1: SUCCESS (9.150s)
[244.888846] Subtest timeout: SUCCESS (31.080s)
[244.970393] [023/133] (776s left) kms_big_fb (x-tiled-64bpp-rotate-90)
[245.081926] Starting subtest: x-tiled-64bpp-rotate-90
[245.103848] Subtest x-tiled-64bpp-rotate-90: SKIP (0.022s)
[245.206363] [024/133] (776s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled)
[245.260313] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled
[245.264681] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[245.445788] [025/133] (776s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-sf)
[245.540725] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-sf
[245.542967] Starting dynamic subtest: pipe-A-eDP-1
[245.614198] Dynamic subtest pipe-A-eDP-1: SKIP (0.077s)
[245.623051] Starting dynamic subtest: pipe-B-eDP-1
[246.772098] Dynamic subtest pipe-B-eDP-1: SKIP (1.155s)
[246.776975] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-sf: SKIP (1.234s)
[247.955772] [026/133] (773s left) gem_mmap_offset (partial-mmap)
[248.015950] Starting subtest: partial-mmap
[248.018273] Starting dynamic subtest: smem0
[248.020620] Dynamic subtest smem0: SUCCESS (0.003s)
[248.022790] Subtest partial-mmap: SUCCESS (0.004s)
[248.146806] [027/133] (773s left) gem_ctx_persistence (legacy-engines-mixed)
[248.213569] Starting subtest: legacy-engines-mixed
[248.215912] Starting dynamic subtest: render
[248.302386] Dynamic subtest render: SUCCESS (0.088s)
[248.314254] Starting dynamic subtest: bsd1
[248.348711] Dynamic subtest bsd1: SUCCESS (0.044s)
[248.359103] Starting dynamic subtest: bsd2
[248.412990] Dynamic subtest bsd2: SUCCESS (0.062s)
[248.428056] Starting dynamic subtest: blt
[248.474374] Dynamic subtest blt: SUCCESS (0.060s)
[248.485800] Starting dynamic subtest: vebox
[248.522917] Dynamic subtest vebox: SUCCESS (0.047s)
[248.525705] Subtest legacy-engines-mixed: SUCCESS (0.310s)
[248.600137] [028/133] (773s left) kms_cursor_legacy (cursorb-vs-flipa-legacy)
[248.727499] Starting subtest: cursorB-vs-flipA-legacy
[248.732560] Subtest cursorB-vs-flipA-legacy: SKIP (0.001s)
[248.868121] [029/133] (773s left) i915_pm_rpm (reg-read-ioctl)
[251.022727] Starting subtest: reg-read-ioctl
[253.326821] Subtest reg-read-ioctl: SUCCESS (2.304s)
[253.703641] [030/133] (768s left) kms_pm_rpm (dpms-mode-unset-non-lpsp)
[255.233043] Starting subtest: dpms-mode-unset-non-lpsp
[256.385706] Subtest dpms-mode-unset-non-lpsp: SKIP (1.153s)
[256.775667] [031/133] (765s left) gem_ctx_persistence (engines-mixed-process)
[256.843631] Starting subtest: engines-mixed-process
[256.845934] Starting dynamic subtest: rcs0
[258.920218] Dynamic subtest rcs0: SUCCESS (2.076s)
[258.929283] Starting dynamic subtest: bcs0
[260.901805] Dynamic subtest bcs0: SUCCESS (1.980s)
[260.912062] Starting dynamic subtest: vcs0
[262.886726] Dynamic subtest vcs0: SUCCESS (1.983s)
[262.897848] Starting dynamic subtest: vcs1
[264.936703] Dynamic subtest vcs1: SUCCESS (2.048s)
[264.946181] Starting dynamic subtest: vecs0
[266.921793] Dynamic subtest vecs0: SUCCESS (1.984s)
[266.932358] Starting dynamic subtest: ccs0
[268.882326] Dynamic subtest ccs0: SUCCESS (1.959s)
[268.887131] Subtest engines-mixed-process: SUCCESS (12.038s)
[268.960203] [032/133] (753s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[269.046715] Starting subtest: primary-x-tiled-reflect-x-180
[275.948554] Subtest primary-x-tiled-reflect-x-180: SUCCESS (6.904s)
[277.143829] [033/133] (744s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-cpu)
[277.233722] Starting subtest: psr-rgb101010-draw-mmap-cpu
[284.343228] Subtest psr-rgb101010-draw-mmap-cpu: SUCCESS (7.112s)
[284.448509] [034/133] (737s left) kms_plane_lowres (tiling-yf)
[284.546379] Starting subtest: tiling-yf
[284.550421] Subtest tiling-yf: SKIP (0.000s)
[284.618275] [035/133] (737s left) gem_create (create-valid-nonaligned)
[284.670988] Starting subtest: create-valid-nonaligned
[284.673391] Subtest create-valid-nonaligned: SUCCESS (0.001s)
[284.869009] [036/133] (737s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[284.927584] Starting subtest: rel-constants-invalid-rel-gen5
[284.929978] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s)
[285.039415] [037/133] (737s left) syncobj_timeline (multi-wait-available-unsubmitted-signaled)
[285.103258] Starting subtest: multi-wait-available-unsubmitted-signaled
[285.105575] Subtest multi-wait-available-unsubmitted-signaled: SUCCESS (0.001s)
[285.188873] [038/133] (737s left) kms_content_protection (type1)
[285.336635] Starting subtest: type1
[285.340878] Subtest type1: SKIP (0.000s)
[285.450088] [039/133] (736s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs)
[285.550606] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs
[285.552838] Starting dynamic subtest: pipe-A-eDP-1
[287.641865] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.092s)
[287.650458] Starting dynamic subtest: pipe-B-eDP-1
[289.903999] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.261s)
[289.912915] Starting dynamic subtest: pipe-C-eDP-1
[291.942246] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.037s)
[291.955044] Starting dynamic subtest: pipe-D-eDP-1
[294.051872] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.109s)
[294.053840] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SUCCESS (8.504s)
[295.303156] [040/133] (727s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[295.400617] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[295.404974] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[295.500827] [041/133] (726s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[295.604387] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu
[302.188104] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.586s)
[302.339601] [042/133] (720s left) kms_flip (flip-vs-fences)
[302.434400] Starting subtest: flip-vs-fences
[302.438455] Subtest flip-vs-fences: SKIP (0.000s)
[302.539899] [043/133] (719s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-mc-ccs)
[302.637274] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-mc-ccs
[302.639534] Starting dynamic subtest: pipe-A-eDP-1
[302.698271] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[302.707697] Starting dynamic subtest: pipe-B-eDP-1
[302.766274] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[302.776615] Starting dynamic subtest: pipe-C-eDP-1
[302.833657] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[302.843247] Starting dynamic subtest: pipe-D-eDP-1
[302.900121] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[302.904578] Subtest crc-sprite-planes-basic-4-tiled-dg2-mc-ccs: SKIP (0.008s)
[304.867133] [044/133] (717s left) kms_cursor_crc (cursor-offscreen-32x32)
[305.028988] Starting subtest: cursor-offscreen-32x32
[305.076240] Subtest cursor-offscreen-32x32: SKIP (0.044s)
[305.374059] [045/133] (717s left) syncobj_wait (wait-for-submit-complex)
[305.421416] Starting subtest: wait-for-submit-complex
[305.481374] Subtest wait-for-submit-complex: SUCCESS (0.061s)
[305.572042] [046/133] (717s left) kms_async_flips (async-flip-with-page-flip-events-tiled)
[305.674327] Starting subtest: async-flip-with-page-flip-events-tiled
[306.046449] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs
[308.838762] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.792s)
[308.847634] Starting dynamic subtest: pipe-A-eDP-1-4
[311.013951] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.174s)
[311.025894] Starting dynamic subtest: pipe-A-eDP-1-4
[313.024067] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.009s)
[313.034353] Starting dynamic subtest: pipe-A-eDP-1-x
[315.214491] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.188s)
[315.580885] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs
[318.360122] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.785s)
[318.375666] Starting dynamic subtest: pipe-B-eDP-1-4
[320.545944] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.185s)
[320.554898] Starting dynamic subtest: pipe-B-eDP-1-4
[322.556430] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.009s)
[322.564990] Starting dynamic subtest: pipe-B-eDP-1-x
[324.746076] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.188s)
[325.110141] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs
[327.891254] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.788s)
[327.900079] Starting dynamic subtest: pipe-C-eDP-1-4
[330.144344] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.251s)
[330.153489] Starting dynamic subtest: pipe-C-eDP-1-4
[332.155297] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s)
[332.167232] Starting dynamic subtest: pipe-C-eDP-1-x
[334.333295] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.177s)
[334.698072] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs
[337.431705] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.739s)
[337.440887] Starting dynamic subtest: pipe-D-eDP-1-4
[339.606182] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.174s)
[339.617528] Starting dynamic subtest: pipe-D-eDP-1-4
[341.616664] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s)
[341.625550] Starting dynamic subtest: pipe-D-eDP-1-x
[343.806597] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.189s)
[343.808877] Subtest async-flip-with-page-flip-events-tiled: SUCCESS (38.133s)
[345.019559] [047/133] (677s left) kms_chamelium_edid (dp-edid-stress-resolution-non-4k)
[345.404306] Subtest dp-edid-stress-resolution-non-4k: SKIP (0.000s)
[346.228429] [048/133] (676s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render)
[346.326324] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render
[346.330263] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[346.417729] [049/133] (676s left) gem_ctx_exec (basic-invalid-context)
[346.471619] Starting subtest: basic-invalid-context
[346.476208] Subtest basic-invalid-context: SUCCESS (0.004s)
[346.585085] [050/133] (676s left) perf (oa-exponents)
[346.723752] Starting subtest: oa-exponents
[346.725872] Starting dynamic subtest: 0-rcs0
[348.492082] Dynamic subtest 0-rcs0: SUCCESS (1.768s)
[348.501790] Starting dynamic subtest: 1-vecs0
[350.321479] Dynamic subtest 1-vecs0: SUCCESS (1.828s)
[350.324068] Subtest oa-exponents: SUCCESS (3.599s)
[350.369943] [051/133] (672s left) gem_exec_schedule (preempt-engines)
[350.443253] Starting subtest: preempt-engines
[350.445458] Starting dynamic subtest: rcs0
[352.741466] Dynamic subtest rcs0: SUCCESS (2.306s)
[352.753517] Starting dynamic subtest: bcs0
[355.029365] Dynamic subtest bcs0: SUCCESS (2.285s)
[355.040715] Starting dynamic subtest: vcs0
[357.310315] Dynamic subtest vcs0: SUCCESS (2.279s)
[357.322988] Starting dynamic subtest: vcs1
[359.579084] Dynamic subtest vcs1: SUCCESS (2.266s)
[359.590902] Starting dynamic subtest: vecs0
[361.848702] Dynamic subtest vecs0: SUCCESS (2.267s)
[361.860719] Starting dynamic subtest: ccs0
[364.170971] Dynamic subtest ccs0: SUCCESS (2.320s)
[364.173572] Subtest preempt-engines: SUCCESS (13.736s)
[364.476231] [052/133] (658s left) kms_plane_scaling (2x-scaler-multi-pipe)
[364.579157] Starting subtest: 2x-scaler-multi-pipe
[364.583434] Subtest 2x-scaler-multi-pipe: SKIP (0.001s)
[364.681255] [053/133] (658s left) kms_plane_scaling (plane-upscale-factor-0-25-with-pixel-format)
[364.781281] Starting subtest: plane-upscale-factor-0-25-with-pixel-format
[364.783482] Starting dynamic subtest: pipe-A
[365.839846] Dynamic subtest pipe-A: SUCCESS (1.061s)
[365.847997] Starting dynamic subtest: pipe-B
[367.947612] Dynamic subtest pipe-B: SUCCESS (2.107s)
[367.956999] Starting dynamic subtest: pipe-C
[369.156676] Dynamic subtest pipe-C: SUCCESS (1.208s)
[369.165453] Starting dynamic subtest: pipe-D
[370.301797] Dynamic subtest pipe-D: SUCCESS (1.143s)
[370.304911] Subtest plane-upscale-factor-0-25-with-pixel-format: SUCCESS (5.523s)
[371.500773] [054/133] (651s left) gem_tiled_blits (basic)
[371.558401] Subtest basic: SKIP (0.000s)
[371.630577] [055/133] (651s left) core_setmaster_vs_auth
[371.783398] [056/133] (651s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted)
[371.838808] Starting subtest: etime-multi-wait-for-submit-unsubmitted
[371.946102] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.107s)
[372.023708] [057/133] (651s left) gen7_exec_parse (load-register-reg)
[372.082669] Subtest load-register-reg: SKIP (0.000s)
[372.151415] [058/133] (650s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-mc-ccs)
[372.233293] Starting subtest: crc-primary-suspend-4-tiled-dg2-mc-ccs
[372.235571] Starting dynamic subtest: pipe-A-eDP-1
[372.244664] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[372.254152] Starting dynamic subtest: pipe-B-eDP-1
[372.263250] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[372.271920] Starting dynamic subtest: pipe-C-eDP-1
[372.280504] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[372.288826] Starting dynamic subtest: pipe-D-eDP-1
[372.297301] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[372.301229] Subtest crc-primary-suspend-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[374.389199] [059/133] (648s left) kms_psr (fbc-psr-sprite-mmap-gtt)
[374.479327] Starting subtest: fbc-psr-sprite-mmap-gtt
[374.481285] Starting dynamic subtest: eDP-1
[374.485380] Dynamic subtest eDP-1: SKIP (0.000s)
[374.489613] Subtest fbc-psr-sprite-mmap-gtt: SKIP (0.001s)
[374.565241] [060/133] (648s left) syncobj_wait (single-wait-submitted)
[374.619988] Starting subtest: single-wait-submitted
[374.721288] Subtest single-wait-submitted: SUCCESS (0.101s)
[374.809755] [061/133] (648s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier)
[374.905317] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier
[374.909700] Subtest pixel-format-4-tiled-lnl-ccs-modifier: SKIP (0.000s)
[374.977900] [062/133] (648s left) gem_softpin (zero)
[375.036044] Starting subtest: zero
[375.040602] Subtest zero: SUCCESS (0.004s)
[375.176945] [063/133] (648s left) gem_exec_params (secure-non-master)
[375.234633] Starting subtest: secure-non-master
[375.239303] Subtest secure-non-master: SKIP (0.000s)
[375.343411] [064/133] (648s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[375.434456] Starting subtest: fbc-rgb565-draw-mmap-wc
[379.432384] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (4.000s)
[380.613324] [065/133] (642s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[380.709360] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[387.948992] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.242s)
[388.082779] [066/133] (635s left) kms_frontbuffer_tracking (fbc-farfromfence-mmap-gtt)
[388.187292] Starting subtest: fbc-farfromfence-mmap-gtt
[388.191135] Subtest fbc-farfromfence-mmap-gtt: SKIP (0.000s)
[388.297662] [067/133] (635s left) kms_lease (lease-unleased-connector)
[388.390986] Starting subtest: lease-unleased-connector
[388.393219] Starting dynamic subtest: pipe-A-eDP-1
[388.395452] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.006s)
[388.408187] Starting dynamic subtest: pipe-B-eDP-1
[388.410409] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.006s)
[388.419316] Starting dynamic subtest: pipe-C-eDP-1
[388.421102] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.006s)
[388.428968] Starting dynamic subtest: pipe-D-eDP-1
[388.430803] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.006s)
[388.432614] Subtest lease-unleased-connector: SUCCESS (0.029s)
[388.520534] [068/133] (634s left) gem_ctx_param (invalid-size-set)
[388.580763] Starting subtest: invalid-size-set
[388.583032] Subtest invalid-size-set: SUCCESS (0.001s)
[388.696295] [069/133] (634s left) gem_softpin (noreloc-interruptible)
[388.754355] Starting subtest: noreloc-interruptible
[394.149654] Subtest noreloc-interruptible: SUCCESS (5.397s)
[394.284914] [070/133] (629s left) gem_render_copy (yf-tiled-ccs-to-linear)
[394.336939] Starting subtest: yf-tiled-ccs-to-linear
[394.341478] Subtest yf-tiled-ccs-to-linear: SKIP (0.000s)
[394.519460] [071/133] (629s left) gem_exec_schedule (smoketest)
[394.711871] Starting subtest: smoketest
[394.714608] Starting dynamic subtest: rcs0
[400.263773] Dynamic subtest rcs0: SUCCESS (5.507s)
[400.272604] Starting dynamic subtest: bcs0
[405.790316] Dynamic subtest bcs0: SUCCESS (5.525s)
[405.800320] Starting dynamic subtest: vcs0
[411.305731] Dynamic subtest vcs0: SUCCESS (5.512s)
[411.316495] Starting dynamic subtest: vcs1
[416.805326] Dynamic subtest vcs1: SUCCESS (5.497s)
[416.815721] Starting dynamic subtest: vecs0
[422.317209] Dynamic subtest vecs0: SUCCESS (5.511s)
[422.328597] Starting dynamic subtest: ccs0
[427.819338] Dynamic subtest ccs0: SUCCESS (5.502s)
[427.821447] Subtest smoketest: SUCCESS (33.060s)
[427.952963] [072/133] (595s left) kms_vblank (ts-continuation-dpms-rpm)
[428.048938] Starting subtest: ts-continuation-dpms-rpm
[428.051207] Starting dynamic subtest: pipe-A-eDP-1
[430.586852] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.537s)
[430.601061] Starting dynamic subtest: pipe-D-eDP-1
[432.833737] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.246s)
[432.836299] Subtest ts-continuation-dpms-rpm: SUCCESS (4.787s)
[433.707230] [073/133] (589s left) kms_psr2_su (page_flip-xrgb8888)
[433.773457] Subtest page_flip-XRGB8888: SKIP (0.000s)
[433.837839] [074/133] (589s left) kms_big_fb (4-tiled-16bpp-rotate-90)
[433.934513] Starting subtest: 4-tiled-16bpp-rotate-90
[433.953793] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.019s)
[434.077406] [075/133] (589s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-blt)
[434.178183] Starting subtest: psr-1p-primscrn-cur-indfb-draw-blt
[440.980841] Subtest psr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (6.805s)
[441.107889] [076/133] (582s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt)
[441.206224] Starting subtest: fbc-rgb101010-draw-blt
[445.841785] Subtest fbc-rgb101010-draw-blt: SUCCESS (4.637s)
[446.945475] [077/133] (576s left) gem_exec_basic (basic)
[447.000435] Starting subtest: basic
[447.002787] Starting dynamic subtest: rcs0-smem
[447.005183] Dynamic subtest rcs0-smem: SUCCESS (0.002s)
[447.019124] Starting dynamic subtest: bcs0-smem
[447.021051] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[447.031441] Starting dynamic subtest: vcs0-smem
[447.033322] Dynamic subtest vcs0-smem: SUCCESS (0.002s)
[447.041127] Starting dynamic subtest: vcs1-smem
[447.042943] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[447.050670] Starting dynamic subtest: vecs0-smem
[447.052539] Dynamic subtest vecs0-smem: SUCCESS (0.002s)
[447.060377] Starting dynamic subtest: ccs0-smem
[447.062252] Dynamic subtest ccs0-smem: SUCCESS (0.002s)
[447.064139] Subtest basic: SUCCESS (0.014s)
[448.957452] [078/133] (574s left) kms_psr (psr2-cursor-mmap-gtt)
[449.059951] Starting subtest: psr2-cursor-mmap-gtt
[449.062132] Starting dynamic subtest: eDP-1
[450.736097] Dynamic subtest eDP-1: SUCCESS (1.675s)
[450.737964] Subtest psr2-cursor-mmap-gtt: SUCCESS (1.676s)
[451.548037] [079/133] (572s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[451.642306] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[455.209593] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (3.571s)
[456.419424] [080/133] (567s left) kms_plane_scaling (plane-scaler-unity-scaling-with-rotation)
[456.511267] Starting subtest: plane-scaler-unity-scaling-with-rotation
[456.513563] Starting dynamic subtest: pipe-A
[456.737877] Dynamic subtest pipe-A: SUCCESS (0.229s)
[456.747679] Starting dynamic subtest: pipe-B
[458.004323] Dynamic subtest pipe-B: SUCCESS (1.265s)
[458.013329] Starting dynamic subtest: pipe-C
[459.349876] Dynamic subtest pipe-C: SUCCESS (1.345s)
[459.359315] Starting dynamic subtest: pipe-D
[460.689204] Dynamic subtest pipe-D: SUCCESS (1.338s)
[460.691328] Subtest plane-scaler-unity-scaling-with-rotation: SUCCESS (4.182s)
[461.847237] [081/133] (562s left) kms_universal_plane (universal-plane-functional)
[461.938352] Starting subtest: universal-plane-functional
[461.940379] Starting dynamic subtest: pipe-A-eDP-1
[465.790171] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.851s)
[465.800246] Starting dynamic subtest: pipe-B-eDP-1
[470.298065] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.507s)
[470.308018] Starting dynamic subtest: pipe-C-eDP-1
[474.901774] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.601s)
[474.911057] Starting dynamic subtest: pipe-D-eDP-1
[479.408075] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.505s)
[479.410654] Subtest universal-plane-functional: SUCCESS (17.470s)
[480.281791] [082/133] (543s left) gem_userptr_blits (vma-merge)
[480.372665] Starting subtest: vma-merge
[480.410283] Subtest vma-merge: SUCCESS (0.037s)
[480.592676] [083/133] (543s left) kms_psr (fbc-psr2-cursor-blt)
[480.697124] Starting subtest: fbc-psr2-cursor-blt
[480.699376] Starting dynamic subtest: eDP-1
[480.703704] Dynamic subtest eDP-1: SKIP (0.000s)
[480.708113] Subtest fbc-psr2-cursor-blt: SKIP (0.001s)
[480.782991] [084/133] (543s left) gem_mmap_gtt (basic-read-write-distinct)
[480.840786] Subtest basic-read-write-distinct: SKIP (0.000s)
[480.902911] [085/133] (543s left) kms_big_fb (linear-64bpp-rotate-90)
[481.012784] Starting subtest: linear-64bpp-rotate-90
[481.033520] Subtest linear-64bpp-rotate-90: SKIP (0.020s)
[481.138087] [086/133] (543s left) kms_chamelium_hpd (dp-hpd-with-enabled-mode)
[481.514190] Subtest dp-hpd-with-enabled-mode: SKIP (0.000s)
[482.291809] [087/133] (542s left) gem_set_tiling_vs_pwrite
[482.399105] [088/133] (541s left) perf_pmu (busy-no-semaphores)
[482.439628] Starting subtest: busy-no-semaphores
[482.441993] Starting dynamic subtest: rcs0
[483.000734] Dynamic subtest rcs0: SUCCESS (0.558s)
[483.013199] Starting dynamic subtest: bcs0
[483.552044] Dynamic subtest bcs0: SUCCESS (0.549s)
[483.563885] Starting dynamic subtest: vcs0
[484.101372] Dynamic subtest vcs0: SUCCESS (0.546s)
[484.113865] Starting dynamic subtest: vcs1
[485.400480] Dynamic subtest vcs1: SUCCESS (1.295s)
[485.412949] Starting dynamic subtest: vecs0
[487.448715] Dynamic subtest vecs0: SUCCESS (2.045s)
[487.460546] Starting dynamic subtest: ccs0
[489.433671] Dynamic subtest ccs0: SUCCESS (1.981s)
[489.437040] Subtest busy-no-semaphores: SUCCESS (6.993s)
[489.553271] [089/133] (534s left) gen9_exec_parse (shadow-peek)
[489.610852] Subtest shadow-peek: SKIP (0.000s)
[489.679497] [090/133] (534s left) gem_mmap_gtt (fault-concurrent)
[489.745824] Subtest fault-concurrent: SKIP (0.000s)
[489.811125] [091/133] (534s left) kms_invalid_mode (bad-htotal)
[489.908184] Starting subtest: bad-htotal
[489.910390] Starting dynamic subtest: pipe-A-eDP-1
[490.193244] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.287s)
[490.203423] Starting dynamic subtest: pipe-B-eDP-1
[490.205335] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[490.213821] Starting dynamic subtest: pipe-C-eDP-1
[490.216188] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[490.231326] Starting dynamic subtest: pipe-D-eDP-1
[490.233867] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[490.236968] Subtest bad-htotal: SUCCESS (0.293s)
[491.047576] [092/133] (533s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc)
[491.140374] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc
[491.142625] Starting dynamic subtest: pipe-A-eDP-1
[491.867565] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.719s)
[491.878284] Starting dynamic subtest: pipe-B-eDP-1
[493.655262] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.786s)
[493.664208] Starting dynamic subtest: pipe-C-eDP-1
[495.400571] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.744s)
[495.410503] Starting dynamic subtest: pipe-D-eDP-1
[497.128910] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.728s)
[497.130970] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.982s)
[498.315219] [093/133] (526s left) syncobj_wait (wait-all-snapshot)
[498.376405] Starting subtest: wait-all-snapshot
[498.456260] Subtest wait-all-snapshot: SUCCESS (0.081s)
[498.534816] [094/133] (526s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[498.646998] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[506.015809] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.371s)
[506.150943] [095/133] (518s left) i915_query (query-regions-garbage-items)
[506.218247] Starting subtest: query-regions-garbage-items
[506.220570] Subtest query-regions-garbage-items: SUCCESS (0.000s)
[506.300777] [096/133] (518s left) gem_bad_reloc (negative-reloc)
[506.364291] Subtest negative-reloc: SKIP (0.000s)
[506.436593] [097/133] (518s left) gem_tiled_wc
[506.548463] [098/133] (518s left) gem_ctx_bad_destroy (double-destroy)
[506.603806] Starting subtest: double-destroy
[506.606142] Subtest double-destroy: SUCCESS (0.000s)
[506.686674] [099/133] (518s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-sf)
[506.788025] Starting subtest: fbc-psr2-overlay-plane-move-continuous-sf
[506.790331] Starting dynamic subtest: pipe-A-eDP-1
[506.886933] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s)
[506.896686] Starting dynamic subtest: pipe-B-eDP-1
[508.081394] Dynamic subtest pipe-B-eDP-1: SKIP (1.190s)
[508.086121] Subtest fbc-psr2-overlay-plane-move-continuous-sf: SKIP (1.293s)
[509.266541] [100/133] (515s left) syncobj_timeline (invalid-transfer-non-existent-point)
[509.328602] Starting subtest: invalid-transfer-non-existent-point
[509.330585] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[509.448741] [101/133] (515s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[509.555960] Starting subtest: psr-farfromfence-mmap-gtt
[509.560336] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[509.678805] [102/133] (515s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[509.788800] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[509.793251] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[509.900078] [103/133] (515s left) kms_dp_link_training (uhbr-mst)
[509.997363] Starting subtest: uhbr-mst
[510.006565] Subtest uhbr-mst: SKIP (0.000s)
[510.071150] [104/133] (514s left) kms_flip (2x-flip-vs-wf_vblank)
[510.180306] Starting subtest: 2x-flip-vs-wf_vblank
[510.188386] Subtest 2x-flip-vs-wf_vblank: SKIP (0.010s)
[510.289579] [105/133] (514s left) kms_pm_rpm (pm-tiling)
[512.014263] Starting subtest: pm-tiling
[512.019152] Subtest pm-tiling: SKIP (0.000s)
[512.506686] [106/133] (512s left) syncobj_timeline (wait-all-interrupted)
[512.563512] Starting subtest: wait-all-interrupted
[512.664368] Subtest wait-all-interrupted: SUCCESS (0.101s)
[512.754031] [107/133] (512s left) kms_cursor_legacy (short-flip-after-cursor-toggle)
[512.864526] Starting subtest: short-flip-after-cursor-toggle
[513.797075] Subtest short-flip-after-cursor-toggle: SUCCESS (0.931s)
[514.635242] [108/133] (510s left) kms_psr (pr-primary-mmap-cpu)
[514.725452] Starting subtest: pr-primary-mmap-cpu
[514.729945] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[514.809192] [109/133] (510s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[514.923802] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[514.928216] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[515.027264] [110/133] (510s left) gem_exec_reloc (basic-scanout)
[515.082755] Subtest basic-scanout: SKIP (0.000s)
[515.155379] [111/133] (510s left) i915_pm_freq_api (freq-reset-multiple)
[515.214693] Starting subtest: freq-reset-multiple
[515.217089] Starting dynamic subtest: gt0
[524.308131] Dynamic subtest gt0: SUCCESS (9.090s)
[524.317643] Starting dynamic subtest: gt1
[532.159703] Dynamic subtest gt1: SUCCESS (7.848s)
[532.161630] Subtest freq-reset-multiple: SUCCESS (16.941s)
[532.240619] [112/133] (493s left) gem_mmap_wc (read-write-distinct)
[532.311395] Subtest read-write-distinct: SKIP (0.000s)
[532.379830] [113/133] (493s left) kms_flip (2x-plain-flip-ts-check)
[532.482395] Starting subtest: 2x-plain-flip-ts-check
[532.493363] Subtest 2x-plain-flip-ts-check: SKIP (0.010s)
[532.569892] [114/133] (492s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset)
[532.668137] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset
[532.680214] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset: SKIP (0.011s)
[532.773673] [115/133] (492s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-render)
[532.896043] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-render
[532.900457] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[532.999044] [116/133] (492s left) gem_exec_balancer (parallel-balancer)
[533.246377] Starting subtest: parallel-balancer
[534.117973] Subtest parallel-balancer: SUCCESS (0.871s)
[534.217706] [117/133] (491s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling)
[534.309338] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling
[534.311674] Starting dynamic subtest: pipe-A-default-mode
[535.479631] Dynamic subtest pipe-A-default-mode: SKIP (1.168s)
[535.483923] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (1.170s)
[535.615302] [118/133] (490s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[535.716332] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[535.720286] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[535.822190] [119/133] (489s left) kms_pipe_crc_basic (nonblocking-crc)
[535.906434] Starting subtest: nonblocking-crc
[535.908660] Starting dynamic subtest: pipe-A-eDP-1
[536.677239] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.770s)
[536.687180] Starting dynamic subtest: pipe-B-eDP-1
[538.062443] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.386s)
[538.071604] Starting dynamic subtest: pipe-C-eDP-1
[539.453518] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.389s)
[539.466010] Starting dynamic subtest: pipe-D-eDP-1
[540.791413] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.337s)
[540.793700] Subtest nonblocking-crc: SUCCESS (4.887s)
[541.591547] [120/133] (484s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-wc)
[541.689066] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-wc
[548.253343] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (6.567s)
[548.375476] [121/133] (477s left) kms_force_connector_basic (force-load-detect)
[548.468043] Starting subtest: force-load-detect
[548.472639] Subtest force-load-detect: SKIP (0.000s)
[548.582795] [122/133] (477s left) core_getversion (all-cards)
[548.621835] Starting subtest: all-cards
[548.629643] Subtest all-cards: SUCCESS (0.011s)
[548.668380] [123/133] (477s left) gem_lmem_swapping (massive-random)
[548.714261] Subtest massive-random: SKIP (0.000s)
[548.762239] [124/133] (477s left) perf_pmu (busy-hang)
[548.807487] Starting subtest: busy-hang
[548.809840] Starting dynamic subtest: rcs0
[550.059760] Dynamic subtest rcs0: SUCCESS (1.254s)
[550.071476] Starting dynamic subtest: bcs0
[551.273302] Dynamic subtest bcs0: SUCCESS (1.212s)
[551.285256] Starting dynamic subtest: vcs0
[553.432728] Dynamic subtest vcs0: SUCCESS (2.154s)
[553.442779] Starting dynamic subtest: vcs1
[555.418733] Dynamic subtest vcs1: SUCCESS (1.983s)
[555.437970] Starting dynamic subtest: vecs0
[557.398575] Dynamic subtest vecs0: SUCCESS (1.982s)
[557.411158] Starting dynamic subtest: ccs0
[558.608285] Dynamic subtest ccs0: SUCCESS (1.208s)
[558.610771] Subtest busy-hang: SUCCESS (9.804s)
[558.712960] [125/133] (467s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling)
[558.812087] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling
[558.816664] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.000s)
[558.888026] [126/133] (467s left) gem_partial_pwrite_pread (writes-after-reads-snoop)
[558.949068] Subtest writes-after-reads-snoop: SKIP (0.000s)
[559.015590] [127/133] (467s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[559.102711] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[559.104951] Starting dynamic subtest: pipe-A-eDP-1
[559.125083] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[559.135073] Starting dynamic subtest: pipe-B-eDP-1
[559.153786] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[559.162812] Starting dynamic subtest: pipe-C-eDP-1
[559.181541] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[559.190397] Starting dynamic subtest: pipe-D-eDP-1
[559.208898] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[559.211019] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.007s)
[561.368976] [128/133] (464s left) syncobj_wait (wait-any-snapshot)
[561.436346] Starting subtest: wait-any-snapshot
[561.517989] Subtest wait-any-snapshot: SUCCESS (0.082s)
[561.595577] [129/133] (464s left) api_intel_bb (offset-control)
[561.660132] Starting subtest: offset-control
[561.665971] Subtest offset-control: SUCCESS (0.007s)
[561.781546] [130/133] (464s left) kms_cursor_edge_walk (64x64-right-edge)
[561.874899] Starting subtest: 64x64-right-edge
[561.877125] Starting dynamic subtest: pipe-A-eDP-1
[565.357301] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.483s)
[565.367611] Starting dynamic subtest: pipe-D-eDP-1
[568.555632] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.197s)
[568.557834] Subtest 64x64-right-edge: SUCCESS (6.682s)
[569.366519] [131/133] (456s left) kms_atomic_transition (plane-all-modeset-transition-fencing-internal-panels)
[569.474835] Starting subtest: plane-all-modeset-transition-fencing-internal-panels
[569.476976] Starting dynamic subtest: pipe-A-eDP-1
[570.819503] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.343s)
[571.097947] Starting dynamic subtest: pipe-B-eDP-1
[572.144596] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.055s)
[572.413536] Subtest plane-all-modeset-transition-fencing-internal-panels: SUCCESS (2.938s)
[573.247569] [132/133] (452s left) tools_test (sysfs_l3_parity)
[573.295752] Starting subtest: sysfs_l3_parity
[573.367556] Subtest sysfs_l3_parity: SKIP (0.084s)
[573.421098] [133/133] (452s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions-varying-size)
[573.539880] Starting subtest: cursorB-vs-flipA-atomic-transitions-varying-size
[573.544659] Subtest cursorB-vs-flipA-atomic-transitions-varying-size: SKIP (0.001s)
[573.688872] Closing watchdogs
results: parsing output: 0/ for test: kms_big_fb
results: parsing output: 1/ for test: kms_atomic_transition
results: parsing output: 2/ for test: gem_lmem_swapping
results: parsing output: 3/ for test: syncobj_eventfd
results: parsing output: 4/ for test: kms_big_fb
results: parsing output: 5/ for test: gem_pxp
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: kms_addfb_basic
results: parsing output: 8/ for test: kms_async_flips
results: parsing output: 9/ for test: kms_color
results: parsing output: 10/ for test: kms_addfb_basic
results: parsing output: 11/ for test: prime_mmap_coherency
results: parsing output: 12/ for test: prime_busy
results: parsing output: 13/ for test: gem_exec_fence
results: parsing output: 14/ for test: kms_dsc
results: parsing output: 15/ for test: kms_busy
results: parsing output: 16/ for test: kms_cursor_crc
results: parsing output: 17/ for test: api_intel_allocator
results: parsing output: 18/ for test: gem_exec_whisper
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: gem_exec_alignment
results: parsing output: 21/ for test: sysfs_timeslice_duration
results: parsing output: 22/ for test: kms_big_fb
results: parsing output: 23/ for test: gem_render_copy
results: parsing output: 24/ for test: kms_psr2_sf
results: parsing output: 25/ for test: gem_mmap_offset
results: parsing output: 26/ for test: gem_ctx_persistence
results: parsing output: 27/ for test: kms_cursor_legacy
results: parsing output: 28/ for test: i915_pm_rpm
results: parsing output: 29/ for test: kms_pm_rpm
results: parsing output: 30/ for test: gem_ctx_persistence
results: parsing output: 31/ for test: kms_rotation_crc
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_plane_lowres
results: parsing output: 34/ for test: gem_create
results: parsing output: 35/ for test: gem_exec_params
results: parsing output: 36/ for test: syncobj_timeline
results: parsing output: 37/ for test: kms_content_protection
results: parsing output: 38/ for test: kms_ccs
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_flip
results: parsing output: 42/ for test: kms_ccs
results: parsing output: 43/ for test: kms_cursor_crc
results: parsing output: 44/ for test: syncobj_wait
results: parsing output: 45/ for test: kms_async_flips
results: parsing output: 46/ for test: kms_chamelium_edid
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_ctx_exec
results: parsing output: 49/ for test: perf
results: parsing output: 50/ for test: gem_exec_schedule
results: parsing output: 51/ for test: kms_plane_scaling
results: parsing output: 52/ for test: kms_plane_scaling
results: parsing output: 53/ for test: gem_tiled_blits
results: parsing output: 54/ for test: core_setmaster_vs_auth
results: parsing output: 55/ for test: syncobj_timeline
results: parsing output: 56/ for test: gen7_exec_parse
results: parsing output: 57/ for test: kms_ccs
results: parsing output: 58/ for test: kms_psr
results: parsing output: 59/ for test: syncobj_wait
results: parsing output: 60/ for test: kms_plane
results: parsing output: 61/ for test: gem_softpin
results: parsing output: 62/ for test: gem_exec_params
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_lease
results: parsing output: 67/ for test: gem_ctx_param
results: parsing output: 68/ for test: gem_softpin
results: parsing output: 69/ for test: gem_render_copy
results: parsing output: 70/ for test: gem_exec_schedule
results: parsing output: 71/ for test: kms_vblank
results: parsing output: 72/ for test: kms_psr2_su
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: gem_exec_basic
results: parsing output: 77/ for test: kms_psr
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_plane_scaling
results: parsing output: 80/ for test: kms_universal_plane
results: parsing output: 81/ for test: gem_userptr_blits
results: parsing output: 82/ for test: kms_psr
results: parsing output: 83/ for test: gem_mmap_gtt
results: parsing output: 84/ for test: kms_big_fb
results: parsing output: 85/ for test: kms_chamelium_hpd
results: parsing output: 86/ for test: gem_set_tiling_vs_pwrite
results: parsing output: 87/ for test: perf_pmu
results: parsing output: 88/ for test: gen9_exec_parse
results: parsing output: 89/ for test: gem_mmap_gtt
results: parsing output: 90/ for test: kms_invalid_mode
results: parsing output: 91/ for test: kms_ccs
results: parsing output: 92/ for test: syncobj_wait
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: i915_query
results: parsing output: 95/ for test: gem_bad_reloc
results: parsing output: 96/ for test: gem_tiled_wc
results: parsing output: 97/ for test: gem_ctx_bad_destroy
results: parsing output: 98/ for test: kms_psr2_sf
results: parsing output: 99/ for test: syncobj_timeline
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_dp_link_training
results: parsing output: 103/ for test: kms_flip
results: parsing output: 104/ for test: kms_pm_rpm
results: parsing output: 105/ for test: syncobj_timeline
results: parsing output: 106/ for test: kms_cursor_legacy
results: parsing output: 107/ for test: kms_psr
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: gem_exec_reloc
results: parsing output: 110/ for test: i915_pm_freq_api
results: parsing output: 111/ for test: gem_mmap_wc
results: parsing output: 112/ for test: kms_flip
results: parsing output: 113/ for test: kms_flip
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: gem_exec_balancer
results: parsing output: 116/ for test: kms_flip_scaled_crc
results: parsing output: 117/ for test: kms_big_fb
results: parsing output: 118/ for test: kms_pipe_crc_basic
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: kms_force_connector_basic
results: parsing output: 121/ for test: core_getversion
results: parsing output: 122/ for test: gem_lmem_swapping
results: parsing output: 123/ for test: perf_pmu
results: parsing output: 124/ for test: kms_flip_scaled_crc
results: parsing output: 125/ for test: gem_partial_pwrite_pread
results: parsing output: 126/ for test: kms_ccs
results: parsing output: 127/ for test: syncobj_wait
results: parsing output: 128/ for test: api_intel_bb
results: parsing output: 129/ for test: kms_cursor_edge_walk
results: parsing output: 130/ for test: kms_atomic_transition
results: parsing output: 131/ for test: tools_test
results: parsing output: 132/ for test: kms_cursor_legacy
Done.