[61.801308] Initializing watchdogs
[61.801372]   /dev/watchdog0
[61.821747] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[61.832289] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[61.835890] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[61.838551] [001/134] (960s left) gem_ccs (block-multicopy-compressed)
[61.924239] Starting subtest: block-multicopy-compressed
[61.925160] Starting dynamic subtest: linear-compressed-compfmt0-smem-lmem0-multicopy
[61.976111] Dynamic subtest linear-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.051s)
[61.983810] Starting dynamic subtest: linear-compressed-compfmt0-lmem0-lmem0-multicopy
[62.077970] Dynamic subtest linear-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.101s)
[62.085308] Starting dynamic subtest: xmajor-compressed-compfmt0-smem-lmem0-multicopy
[62.094223] Dynamic subtest xmajor-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.016s)
[62.101753] Starting dynamic subtest: xmajor-compressed-compfmt0-lmem0-lmem0-multicopy
[62.200271] Dynamic subtest xmajor-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.105s)
[62.207624] Starting dynamic subtest: tile4-compressed-compfmt0-smem-lmem0-multicopy
[62.216479] Dynamic subtest tile4-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.016s)
[62.223973] Starting dynamic subtest: tile4-compressed-compfmt0-lmem0-lmem0-multicopy
[62.324613] Dynamic subtest tile4-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.107s)
[62.332142] Starting dynamic subtest: tile64-compressed-compfmt0-smem-lmem0-multicopy
[62.342148] Dynamic subtest tile64-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.017s)
[62.349416] Starting dynamic subtest: tile64-compressed-compfmt0-lmem0-lmem0-multicopy
[62.441761] Dynamic subtest tile64-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.099s)
[62.442654] Subtest block-multicopy-compressed: SUCCESS (0.516s)
[62.623597] [002/134] (959s left) kms_vrr (negative-basic)
[62.812765] Starting subtest: negative-basic
[62.815295] Starting dynamic subtest: pipe-A-DP-3
[68.258339] Dynamic subtest pipe-A-DP-3: SUCCESS (5.428s)
[68.348233] Subtest negative-basic: SUCCESS (5.521s)
[68.660952] [003/134] (953s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-pgflip-blt)
[68.846498] Starting subtest: fbc-2p-primscrn-indfb-pgflip-blt
[68.848180] Subtest fbc-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[69.041907] [004/134] (953s left) gem_mmap_offset (partial-remap)
[69.113008] Starting subtest: partial-remap
[69.113947] Starting dynamic subtest: lmem0
[69.116545] Dynamic subtest lmem0: SUCCESS (0.004s)
[69.124619] Starting dynamic subtest: smem0
[69.126853] Dynamic subtest smem0: SUCCESS (0.004s)
[69.128032] Subtest partial-remap: SUCCESS (0.009s)
[69.328606] [005/134] (953s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[69.507727] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[69.509429] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[69.707368] [006/134] (953s left) kms_plane_scaling (planes-downscale-factor-0-75)
[69.882925] Starting subtest: planes-downscale-factor-0-75
[69.883680] Starting dynamic subtest: pipe-A
[69.967923] Dynamic subtest pipe-A: SUCCESS (0.086s)
[69.976014] Starting dynamic subtest: pipe-B
[70.165058] Dynamic subtest pipe-B: SUCCESS (0.196s)
[70.177713] Starting dynamic subtest: pipe-C
[70.397169] Dynamic subtest pipe-C: SUCCESS (0.232s)
[70.405162] Starting dynamic subtest: pipe-D
[70.594018] Dynamic subtest pipe-D: SUCCESS (0.196s)
[70.594960] Subtest planes-downscale-factor-0-75: SUCCESS (0.711s)
[70.956634] [007/134] (951s left) gem_exec_whisper (basic-queues-all)
[71.038423] Starting subtest: basic-queues-all
[92.863558] Subtest basic-queues-all: SUCCESS (21.807s)
[93.130257] [008/134] (929s left) kms_plane (plane-position-covered)
[93.315175] Starting subtest: plane-position-covered
[93.755814] Starting dynamic subtest: pipe-A-plane-1
[94.206689] Dynamic subtest pipe-A-plane-1: SUCCESS (0.451s)
[94.217442] Starting dynamic subtest: pipe-A-plane-2
[94.666522] Dynamic subtest pipe-A-plane-2: SUCCESS (0.460s)
[94.676426] Starting dynamic subtest: pipe-A-plane-3
[95.123326] Dynamic subtest pipe-A-plane-3: SUCCESS (0.456s)
[95.132279] Starting dynamic subtest: pipe-A-plane-4
[95.566585] Dynamic subtest pipe-A-plane-4: SUCCESS (0.443s)
[95.577176] Starting dynamic subtest: pipe-A-plane-5
[95.592650] Dynamic subtest pipe-A-plane-5: SUCCESS (0.025s)
[95.948961] Starting dynamic subtest: pipe-B-plane-1
[96.364297] Dynamic subtest pipe-B-plane-1: SUCCESS (0.423s)
[96.372581] Starting dynamic subtest: pipe-B-plane-2
[96.786116] Dynamic subtest pipe-B-plane-2: SUCCESS (0.421s)
[96.794380] Starting dynamic subtest: pipe-B-plane-3
[97.204286] Dynamic subtest pipe-B-plane-3: SUCCESS (0.418s)
[97.212506] Starting dynamic subtest: pipe-B-plane-4
[97.640132] Dynamic subtest pipe-B-plane-4: SUCCESS (0.436s)
[97.648313] Starting dynamic subtest: pipe-B-plane-5
[97.662241] Dynamic subtest pipe-B-plane-5: SUCCESS (0.021s)
[97.663115] Subtest plane-position-covered: SUCCESS (4.345s)
[97.954363] [009/134] (925s left) gem_ctx_isolation (clean)
[98.032629] Starting subtest: clean
[98.033850] Starting dynamic subtest: rcs0
[98.153057] Dynamic subtest rcs0: SUCCESS (0.119s)
[98.161544] Starting dynamic subtest: bcs0
[98.280504] Dynamic subtest bcs0: SUCCESS (0.128s)
[98.288613] Starting dynamic subtest: vcs0
[98.405567] Dynamic subtest vcs0: SUCCESS (0.123s)
[98.413816] Starting dynamic subtest: vcs1
[98.515038] Dynamic subtest vcs1: SUCCESS (0.111s)
[98.523098] Starting dynamic subtest: vecs0
[98.646785] Dynamic subtest vecs0: SUCCESS (0.131s)
[98.655199] Starting dynamic subtest: vecs1
[98.772546] Dynamic subtest vecs1: SUCCESS (0.124s)
[98.780968] Starting dynamic subtest: ccs0
[98.868674] Dynamic subtest ccs0: SUCCESS (0.097s)
[98.869565] Subtest clean: SUCCESS (0.836s)
[99.180319] [010/134] (923s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[99.370902] Starting subtest: y-tiled-8bpp-rotate-0
[99.372548] Subtest y-tiled-8bpp-rotate-0: SKIP (0.000s)
[99.561572] [011/134] (923s left) sw_sync (sync_multi_consumer)
[99.611854] Starting subtest: sync_multi_consumer
[99.953993] Subtest sync_multi_consumer: SUCCESS (0.342s)
[100.050604] [012/134] (923s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite)
[100.235313] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite
[100.237050] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[100.427204] [013/134] (922s left) kms_cursor_crc (cursor-rapid-movement-64x21)
[100.766321] Starting subtest: cursor-rapid-movement-64x21
[100.771005] Starting dynamic subtest: pipe-A-DP-3
[101.244021] Dynamic subtest pipe-A-DP-3: SUCCESS (0.473s)
[101.289709] Starting dynamic subtest: pipe-D-DP-3
[101.673032] Dynamic subtest pipe-D-DP-3: SUCCESS (0.390s)
[101.674121] Subtest cursor-rapid-movement-64x21: SUCCESS (0.906s)
[102.173859] [014/134] (921s left) kms_chamelium_frames (hdmi-crc-single)
[102.436342] Subtest hdmi-crc-single: SKIP (0.000s)
[102.582874] [015/134] (920s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[102.763904] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[102.765513] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[102.957357] [016/134] (920s left) gem_mmap_wc (invalid-flags)
[103.026239] Subtest invalid-flags: SKIP (0.000s)
[103.084105] [017/134] (920s left) gem_flink_race (flink_name)
[103.125220] Starting subtest: flink_name
[108.529553] Subtest flink_name: SUCCESS (5.401s)
[108.727879] [018/134] (914s left) gem_exec_params (invalid-fence-in)
[108.847419] Starting subtest: invalid-fence-in
[108.848330] Subtest invalid-fence-in: SUCCESS (0.000s)
[109.037061] [019/134] (914s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[109.111350] Starting subtest: rel-constants-invalid-rel-gen5
[109.112368] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s)
[109.303581] [020/134] (914s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs-cc)
[109.480913] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs-cc
[109.481823] Starting dynamic subtest: pipe-A-DP-3
[109.490064] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[109.498144] Starting dynamic subtest: pipe-B-DP-3
[109.506382] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[109.514244] Starting dynamic subtest: pipe-C-DP-3
[109.522321] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[109.530038] Starting dynamic subtest: pipe-D-DP-3
[109.538880] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[109.541143] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[109.953815] [021/134] (913s left) gem_exec_schedule (preempt-engines)
[110.037364] Starting subtest: preempt-engines
[110.038295] Starting dynamic subtest: rcs0
[112.259848] Dynamic subtest rcs0: SUCCESS (2.221s)
[112.291280] Starting dynamic subtest: bcs0
[114.460217] Dynamic subtest bcs0: SUCCESS (2.198s)
[114.472057] Starting dynamic subtest: vcs0
[116.739768] Dynamic subtest vcs0: SUCCESS (2.278s)
[116.752172] Starting dynamic subtest: vcs1
[119.022853] Dynamic subtest vcs1: SUCCESS (2.281s)
[119.032393] Starting dynamic subtest: vecs0
[121.295775] Dynamic subtest vecs0: SUCCESS (2.271s)
[121.308041] Starting dynamic subtest: vecs1
[123.567595] Dynamic subtest vecs1: SUCCESS (2.270s)
[123.580362] Starting dynamic subtest: ccs0
[125.774869] Dynamic subtest ccs0: SUCCESS (2.206s)
[125.776961] Subtest preempt-engines: SUCCESS (15.734s)
[126.172695] [022/134] (897s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[126.357537] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[126.359213] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[126.541665] [023/134] (897s left) api_intel_bb (blit-reloc-keep-cache)
[126.611096] Starting subtest: blit-reloc-keep-cache
[126.613011] Subtest blit-reloc-keep-cache: SKIP (0.000s)
[126.804966] [024/134] (897s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[126.874145] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[126.981737] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.107s)
[127.112972] [025/134] (897s left) kms_sequence (get-idle)
[127.289168] Starting subtest: get-idle
[127.290125] Starting dynamic subtest: pipe-A-DP-3
[129.687058] Dynamic subtest pipe-A-DP-3: SUCCESS (2.398s)
[129.698081] Starting dynamic subtest: pipe-B-DP-3
[132.009278] Dynamic subtest pipe-B-DP-3: SUCCESS (2.320s)
[132.018904] Starting dynamic subtest: pipe-C-DP-3
[134.315296] Dynamic subtest pipe-C-DP-3: SUCCESS (2.304s)
[134.325409] Starting dynamic subtest: pipe-D-DP-3
[136.626535] Dynamic subtest pipe-D-DP-3: SUCCESS (2.310s)
[136.627514] Subtest get-idle: SUCCESS (9.337s)
[136.929671] [026/134] (887s left) kms_flip (flip-vs-suspend)
[137.108358] Starting subtest: flip-vs-suspend
[137.112395] Starting dynamic subtest: A-DP3
[176.547391] Dynamic subtest A-DP3: SUCCESS (7.855s)
[176.559979] Starting dynamic subtest: B-DP3
[215.406975] Dynamic subtest B-DP3: SUCCESS (7.265s)
[215.417906] Starting dynamic subtest: C-DP3
[254.395063] Dynamic subtest C-DP3: SUCCESS (7.306s)
[254.408276] Starting dynamic subtest: D-DP3
[293.264627] Dynamic subtest D-DP3: SUCCESS (7.212s)
[293.265396] Subtest flip-vs-suspend: SUCCESS (29.648s)
[293.562492] [027/134] (730s left) intel_hwmon (hwmon-read)
[293.633127] Starting subtest: hwmon-read
[293.634032] Subtest hwmon-read: SUCCESS (0.001s)
[293.819151] [028/134] (730s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area)
[294.004592] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.000s)
[294.063615] [029/134] (730s left) kms_atomic_interruptible (legacy-setmode)
[294.239876] Starting subtest: legacy-setmode
[294.240747] Starting dynamic subtest: pipe-A-DP-3
[300.760875] Dynamic subtest pipe-A-DP-3: SUCCESS (6.519s)
[300.761840] Subtest legacy-setmode: SUCCESS (6.521s)
[301.356831] [030/134] (723s left) gem_exec_endless (dispatch)
[301.442540] Starting subtest: dispatch
[301.443422] Starting dynamic subtest: rcs0
[301.451220] Dynamic subtest rcs0: SUCCESS (0.008s)
[301.461539] Starting dynamic subtest: bcs0
[301.463253] Dynamic subtest bcs0: SUCCESS (0.009s)
[301.473543] Starting dynamic subtest: vcs0
[301.475053] Dynamic subtest vcs0: SUCCESS (0.006s)
[301.485195] Starting dynamic subtest: vcs1
[301.486942] Dynamic subtest vcs1: SUCCESS (0.006s)
[301.497237] Starting dynamic subtest: vecs0
[301.498881] Dynamic subtest vecs0: SUCCESS (0.006s)
[301.510274] Starting dynamic subtest: vecs1
[301.512246] Dynamic subtest vecs1: SUCCESS (0.007s)
[301.522271] Starting dynamic subtest: ccs0
[301.524330] Dynamic subtest ccs0: SUCCESS (0.008s)
[301.525181] Subtest dispatch: SUCCESS (0.056s)
[301.720124] [031/134] (722s left) kms_addfb_basic (addfb25-bad-modifier)
[301.904826] Starting subtest: addfb25-bad-modifier
[301.905726] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[302.105144] [032/134] (722s left) gem_ctx_param (invalid-size-get)
[302.175182] Starting subtest: invalid-size-get
[302.177166] Subtest invalid-size-get: SUCCESS (0.001s)
[302.370515] [033/134] (722s left) vgem_basic (second-client)
[302.490863] Starting subtest: second-client
[302.523993] Subtest second-client: SUCCESS (0.033s)
[302.634675] [FACT vgem_basic (second-client)] new: kernel.kmod_is_loaded.vgem: true
[302.636505] [034/134] (722s left) kms_big_fb (4-tiled-16bpp-rotate-180)
[302.843091] Starting subtest: 4-tiled-16bpp-rotate-180
[304.708103] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.864s)
[304.906579] [035/134] (719s left) gem_render_copy (y-tiled-ccs-to-linear)
[304.991257] Starting subtest: y-tiled-ccs-to-linear
[304.993241] Subtest y-tiled-ccs-to-linear: SKIP (0.000s)
[305.208525] [036/134] (719s left) kms_frontbuffer_tracking (fbcpsr-abgr161616f-draw-mmap-cpu)
[305.396042] Starting subtest: fbcpsr-abgr161616f-draw-mmap-cpu
[305.397775] Subtest fbcpsr-abgr161616f-draw-mmap-cpu: SKIP (0.000s)
[305.590498] [037/134] (719s left) gem_exec_reloc (basic-wc-read)
[305.681544] Subtest basic-wc-read: SKIP (0.000s)
[305.776566] [038/134] (719s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite)
[305.970486] Starting subtest: psr-rgb101010-draw-pwrite
[305.972074] Subtest psr-rgb101010-draw-pwrite: SKIP (0.000s)
[306.174324] [039/134] (718s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[306.363619] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc
[306.365248] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[306.572863] [040/134] (718s left) gem_exec_reloc (basic-cpu-gtt-active)
[306.669612] Subtest basic-cpu-gtt-active: SKIP (0.000s)
[306.753855] [041/134] (718s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[306.943574] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[306.945228] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[307.143253] [042/134] (718s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[307.335418] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[307.336995] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[307.496116] [043/134] (717s left) kms_psr (psr-dpms)
[307.682361] Subtest psr-dpms: SKIP (0.000s)
[307.734394] [044/134] (717s left) gem_mmap (big-bo)
[307.815765] Subtest big-bo: SKIP (0.000s)
[307.884965] [045/134] (717s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render)
[308.075295] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render
[308.077134] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[308.274817] [046/134] (717s left) gem_ctx_engines (execute-allforone)
[308.367082] Starting subtest: execute-allforone
[308.408811] Subtest execute-allforone: SUCCESS (0.041s)
[308.742599] [047/134] (716s left) kms_flip (2x-wf_vblank-ts-check-interruptible)
[308.932076] Starting subtest: 2x-wf_vblank-ts-check-interruptible
[308.947711] Subtest 2x-wf_vblank-ts-check-interruptible: SKIP (0.015s)
[309.078534] [048/134] (716s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0)
[309.278835] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0
[309.280665] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[309.476939] [049/134] (716s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render)
[309.666343] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render
[309.668014] Subtest psr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[309.826109] [050/134] (716s left) kms_content_protection (legacy-hdcp14)
[310.080094] Starting subtest: legacy-hdcp14
[310.361808] Starting dynamic subtest: pipe-A-DP-3
[431.681000] Dynamic subtest pipe-A-DP-3: FAIL (121.038s)
[431.682008] Subtest legacy-hdcp14: FAIL (121.428s)
[431.844162] [051/134] (594s left) i915_pm_freq_api (freq-reset-multiple)
[431.930937] Starting subtest: freq-reset-multiple
[431.931889] Starting dynamic subtest: gt0
[453.252904] Dynamic subtest gt0: SUCCESS (21.318s)
[453.253743] Subtest freq-reset-multiple: SUCCESS (21.319s)
[453.379508] [052/134] (572s left) gem_exec_params (mmapped)
[453.461583] Starting subtest: mmapped
[453.463807] Subtest mmapped: SUCCESS (0.002s)
[453.665365] [053/134] (572s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[453.747276] Starting subtest: x-tiled-to-vebox-y-tiled
[453.749156] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[453.997039] [054/134] (572s left) gen7_exec_parse (load-register-reg)
[454.079167] Subtest load-register-reg: SKIP (0.000s)
[454.160489] [055/134] (572s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[454.355659] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[455.630823] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.274s)
[455.865854] [056/134] (570s left) kms_pm_backlight (fade-with-suspend)
[456.047102] Subtest fade-with-suspend: SKIP (0.000s)
[456.107096] [057/134] (570s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[456.300186] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[456.301929] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[456.499510] [058/134] (569s left) kms_psr (fbc-pr-cursor-mmap-cpu)
[456.684898] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s)
[456.740483] [059/134] (569s left) sysfs_timeslice_duration (timeout)
[456.825846] Starting subtest: timeout
[456.826757] Starting dynamic subtest: vecs0
[458.824944] Dynamic subtest vecs0: SUCCESS (1.998s)
[458.836907] Starting dynamic subtest: ccs0
[460.656920] Dynamic subtest ccs0: SUCCESS (1.831s)
[460.668162] Starting dynamic subtest: vcs0
[462.386564] Dynamic subtest vcs0: SUCCESS (1.729s)
[462.398057] Starting dynamic subtest: bcs0
[463.585670] Dynamic subtest bcs0: SUCCESS (1.198s)
[463.597181] Starting dynamic subtest: vecs1
[465.391061] Dynamic subtest vecs1: SUCCESS (1.804s)
[465.403213] Starting dynamic subtest: rcs0
[467.121818] Dynamic subtest rcs0: SUCCESS (1.730s)
[467.133153] Starting dynamic subtest: vcs1
[468.871000] Dynamic subtest vcs1: SUCCESS (1.748s)
[468.871888] Subtest timeout: SUCCESS (12.045s)
[469.055034] [060/134] (557s left) kms_cdclk (mode-transition-all-outputs)
[469.240361] Starting subtest: mode-transition-all-outputs
[469.324667] Subtest mode-transition-all-outputs: SKIP (0.082s)
[469.576050] [061/134] (557s left) gem_pxp (create-valid-protected-context)
[472.183214] Starting subtest: create-valid-protected-context
[472.185143] Subtest create-valid-protected-context: SKIP (0.000s)
[472.326943] [062/134] (554s left) gem_ctx_shared (exec-shared-gtt)
[472.417179] Starting subtest: exec-shared-gtt
[472.418043] Starting dynamic subtest: rcs0
[472.426871] Dynamic subtest rcs0: SUCCESS (0.009s)
[472.438140] Starting dynamic subtest: bcs0
[472.439049] Dynamic subtest bcs0: SUCCESS (0.008s)
[472.451693] Starting dynamic subtest: vcs0
[472.452613] Dynamic subtest vcs0: SUCCESS (0.007s)
[472.463934] Starting dynamic subtest: vcs1
[472.464859] Dynamic subtest vcs1: SUCCESS (0.007s)
[472.475924] Starting dynamic subtest: vecs0
[472.476832] Dynamic subtest vecs0: SUCCESS (0.008s)
[472.488319] Starting dynamic subtest: vecs1
[472.489478] Dynamic subtest vecs1: SUCCESS (0.006s)
[472.500623] Starting dynamic subtest: ccs0
[472.501923] Dynamic subtest ccs0: SUCCESS (0.007s)
[472.503142] Subtest exec-shared-gtt: SUCCESS (0.058s)
[472.760661] [063/134] (554s left) prime_vgem (basic-fence-flip)
[472.848781] Starting subtest: basic-fence-flip
[472.979084] Subtest basic-fence-flip: SKIP (0.129s)
[473.180500] [064/134] (553s left) kms_cursor_legacy (cursora-vs-flipb-varying-size)
[473.371985] Starting subtest: cursorA-vs-flipB-varying-size
[473.373713] Subtest cursorA-vs-flipB-varying-size: SKIP (0.001s)
[473.486902] [065/134] (553s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[473.682861] Starting subtest: nonblocking-crc-frame-sequence
[473.683816] Starting dynamic subtest: pipe-A-DP-3
[474.467764] Dynamic subtest pipe-A-DP-3: SUCCESS (0.783s)
[474.480241] Starting dynamic subtest: pipe-B-DP-3
[475.099506] Dynamic subtest pipe-B-DP-3: SUCCESS (0.630s)
[475.111991] Starting dynamic subtest: pipe-C-DP-3
[475.722147] Dynamic subtest pipe-C-DP-3: SUCCESS (0.621s)
[475.737345] Starting dynamic subtest: pipe-D-DP-3
[476.352696] Dynamic subtest pipe-D-DP-3: SUCCESS (0.628s)
[476.353789] Subtest nonblocking-crc-frame-sequence: SUCCESS (2.670s)
[476.724411] [066/134] (550s left) syncobj_timeline (etime-single-wait-all-submitted)
[476.802242] Starting subtest: etime-single-wait-all-submitted
[476.906107] Subtest etime-single-wait-all-submitted: SUCCESS (0.103s)
[477.077568] [067/134] (550s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling)
[477.262580] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling
[477.264977] Starting dynamic subtest: pipe-A-valid-mode
[480.275222] Dynamic subtest pipe-A-valid-mode: SUCCESS (3.010s)
[480.276643] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SUCCESS (3.013s)
[480.809191] [068/134] (546s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[480.889077] Starting subtest: multi-wait-for-submit-submitted-signaled
[480.889982] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s)
[481.077543] [069/134] (546s left) gem_mmap_gtt (cpuset-medium-copy)
[481.155825] Subtest cpuset-medium-copy: SKIP (0.000s)
[481.242575] [070/134] (546s left) kms_psr (fbc-psr2-cursor-plane-onoff)
[481.432355] Subtest fbc-psr2-cursor-plane-onoff: SKIP (0.000s)
[481.490068] [071/134] (545s left) gem_exec_schedule (wide)
[481.698924] Starting subtest: wide
[481.699862] Starting dynamic subtest: rcs0
[494.022827] Dynamic subtest rcs0: SUCCESS (12.326s)
[494.035691] Starting dynamic subtest: bcs0
[506.911449] Dynamic subtest bcs0: SUCCESS (12.887s)
[506.923736] Starting dynamic subtest: vcs0
[520.208483] Dynamic subtest vcs0: SUCCESS (13.296s)
[520.220896] Starting dynamic subtest: vcs1
[533.577834] Dynamic subtest vcs1: SUCCESS (13.368s)
[533.589683] Starting dynamic subtest: vecs0
[546.792997] Dynamic subtest vecs0: SUCCESS (13.213s)
[546.805075] Starting dynamic subtest: vecs1
[559.822774] Dynamic subtest vecs1: SUCCESS (13.028s)
[559.834955] Starting dynamic subtest: ccs0
[573.140284] Dynamic subtest ccs0: SUCCESS (13.316s)
[573.141165] Subtest wide: SUCCESS (91.440s)
[575.211437] [072/134] (452s left) gem_pipe_control_store_loop (fresh-buffer)
[575.293101] Starting subtest: fresh-buffer
[577.474811] Subtest fresh-buffer: SUCCESS (2.180s)
[577.696574] [073/134] (449s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier)
[577.882249] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier
[577.918627] Starting dynamic subtest: pipe-A-plane-0
[577.920322] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[577.932185] Starting dynamic subtest: pipe-A-plane-3
[577.934204] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[577.945678] Starting dynamic subtest: pipe-A-plane-5
[577.947499] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[578.154411] Starting dynamic subtest: pipe-B-plane-0
[578.156533] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[578.175832] Starting dynamic subtest: pipe-B-plane-3
[578.177756] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[578.190524] Starting dynamic subtest: pipe-B-plane-5
[578.192176] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[578.242121] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier: SKIP (0.359s)
[578.502110] [074/134] (449s left) gem_eio (hibernate)
[578.830344] Starting subtest: hibernate
[594.136963] Subtest hibernate: SUCCESS (15.306s)
[601.906427] [075/134] (432s left) kms_psr (fbc-psr-sprite-plane-onoff)
[602.095792] Subtest fbc-psr-sprite-plane-onoff: SKIP (0.000s)
[602.160054] [076/134] (432s left) kms_cursor_crc (cursor-onscreen-128x42)
[602.567625] Starting subtest: cursor-onscreen-128x42
[602.572697] Starting dynamic subtest: pipe-A-DP-3
[605.309339] Dynamic subtest pipe-A-DP-3: SUCCESS (2.736s)
[605.356073] Starting dynamic subtest: pipe-D-DP-3
[608.033842] Dynamic subtest pipe-D-DP-3: SUCCESS (2.688s)
[608.034938] Subtest cursor-onscreen-128x42: SUCCESS (5.465s)
[608.484642] [077/134] (426s left) kms_cursor_crc (cursor-sliding-max-size)
[608.989899] Starting subtest: cursor-sliding-max-size
[608.992690] Subtest cursor-sliding-max-size: SKIP (0.000s)
[609.184628] [078/134] (425s left) gem_softpin (noreloc-s3)
[609.269994] Starting subtest: noreloc-S3
[629.576120] Subtest noreloc-S3: SUCCESS (5.509s)
[629.735714] [079/134] (405s left) syncobj_timeline (wait-all-complex)
[629.816696] Starting subtest: wait-all-complex
[630.030637] Subtest wait-all-complex: SUCCESS (0.214s)
[630.192700] [080/134] (405s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[630.385784] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu
[630.387595] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[630.559087] [081/134] (404s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[630.651830] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[630.653729] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[630.920375] [082/134] (404s left) kms_ccs (crc-primary-suspend-4-tiled-lnl-ccs)
[631.111231] Starting subtest: crc-primary-suspend-4-tiled-lnl-ccs
[631.112968] Subtest crc-primary-suspend-4-tiled-lnl-ccs: SKIP (0.000s)
[631.436424] [083/134] (404s left) kms_rotation_crc (multiplane-rotation-cropping-top)
[631.623090] Starting subtest: multiplane-rotation-cropping-top
[659.588164] Subtest multiplane-rotation-cropping-top: SUCCESS (27.962s)
[659.839814] [084/134] (375s left) gem_pread (display)
[659.919524] Subtest display: SKIP (0.000s)
[659.999267] [085/134] (375s left) gem_exec_fence (syncobj-timeline-invalid-wait)
[660.700037] Starting subtest: syncobj-timeline-invalid-wait
[660.701402] Subtest syncobj-timeline-invalid-wait: SUCCESS (0.004s)
[660.981788] [086/134] (374s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[661.176489] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu
[661.178191] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[661.373980] [087/134] (374s left) gem_exec_balancer (full-pulse)
[661.465895] Starting subtest: full-pulse
[663.566857] Subtest full-pulse: SUCCESS (2.101s)
[664.009265] [088/134] (371s left) gem_exec_reloc (basic-gtt-wc)
[664.099585] Subtest basic-gtt-wc: SKIP (0.000s)
[664.182378] [089/134] (371s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier-source-clamping)
[664.367605] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier-source-clamping
[664.401610] Starting dynamic subtest: pipe-A-plane-0
[664.403440] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[664.417657] Starting dynamic subtest: pipe-A-plane-3
[664.419502] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[664.433984] Starting dynamic subtest: pipe-A-plane-5
[664.435730] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[664.661717] Starting dynamic subtest: pipe-B-plane-0
[664.663682] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[664.681223] Starting dynamic subtest: pipe-B-plane-3
[664.683882] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[664.697535] Starting dynamic subtest: pipe-B-plane-5
[664.699295] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[664.737486] Subtest pixel-format-4-tiled-bmg-ccs-modifier-source-clamping: SKIP (0.369s)
[665.016784] [090/134] (370s left) kms_big_fb (linear-8bpp-rotate-90)
[665.210500] Starting subtest: linear-8bpp-rotate-90
[665.261929] Subtest linear-8bpp-rotate-90: SKIP (0.051s)
[665.463238] [091/134] (370s left) gem_eio (in-flight-contexts-10ms)
[665.760446] Starting subtest: in-flight-contexts-10ms
[679.264127] Subtest in-flight-contexts-10ms: SUCCESS (13.504s)
[679.534614] [092/134] (356s left) gem_spin_batch (spin-all-new)
[679.619662] Starting subtest: spin-all-new
[679.670788] Subtest spin-all-new: SUCCESS (0.051s)
[680.021571] [093/134] (356s left) api_intel_bb (destroy-bb)
[680.097812] Starting subtest: destroy-bb
[680.135759] Subtest destroy-bb: SUCCESS (0.037s)
[680.317353] [094/134] (356s left) gem_exec_schedule (thriceslice)
[680.406859] Starting subtest: thriceslice
[680.407749] Starting dynamic subtest: rcs0
[680.462031] Dynamic subtest rcs0: SUCCESS (0.054s)
[680.479427] Starting dynamic subtest: bcs0
[680.494081] Dynamic subtest bcs0: SUCCESS (0.031s)
[680.511738] Starting dynamic subtest: vcs0
[680.547583] Dynamic subtest vcs0: SUCCESS (0.052s)
[680.572717] Starting dynamic subtest: vcs1
[680.585634] Dynamic subtest vcs1: SUCCESS (0.036s)
[680.609917] Starting dynamic subtest: vecs0
[680.622055] Dynamic subtest vecs0: SUCCESS (0.035s)
[680.639067] Starting dynamic subtest: vecs1
[680.656614] Dynamic subtest vecs1: SUCCESS (0.033s)
[680.674074] Starting dynamic subtest: ccs0
[680.688270] Dynamic subtest ccs0: SUCCESS (0.030s)
[680.689235] Subtest thriceslice: SUCCESS (0.282s)
[681.134323] [095/134] (355s left) syncobj_wait (reset-signaled)
[681.213699] Starting subtest: reset-signaled
[681.214617] Subtest reset-signaled: SUCCESS (0.000s)
[681.401653] [096/134] (355s left) gem_ctx_persistence (process)
[681.484754] Starting subtest: process
[681.697230] Subtest process: SUCCESS (0.212s)
[681.878064] [097/134] (354s left) kms_joiner (basic-max-non-joiner)
[682.072488] Starting subtest: basic-max-non-joiner
[682.074143] Subtest basic-max-non-joiner: SKIP (0.000s)
[682.226705] [098/134] (354s left) kms_getfb (getfb-reject-nv12)
[682.417713] Starting subtest: getfb-reject-nv12
[682.418610] Subtest getfb-reject-nv12: SUCCESS (0.002s)
[682.648691] [099/134] (354s left) kms_frontbuffer_tracking (fbc-indfb-scaledprimary)
[682.837721] Starting subtest: fbc-indfb-scaledprimary
[685.314015] Subtest fbc-indfb-scaledprimary: SUCCESS (2.477s)
[685.552763] [100/134] (351s left) perf_pmu (most-busy-idle-check-all)
[685.622586] Starting subtest: most-busy-idle-check-all
[685.623551] Starting dynamic subtest: rcs0
[686.331354] Dynamic subtest rcs0: SUCCESS (0.708s)
[686.352243] Starting dynamic subtest: bcs0
[686.992826] Dynamic subtest bcs0: SUCCESS (0.658s)
[687.009268] Starting dynamic subtest: vcs0
[687.644964] Dynamic subtest vcs0: SUCCESS (0.651s)
[687.661563] Starting dynamic subtest: vcs1
[688.301941] Dynamic subtest vcs1: SUCCESS (0.656s)
[688.318244] Starting dynamic subtest: vecs0
[688.956058] Dynamic subtest vecs0: SUCCESS (0.653s)
[688.972384] Starting dynamic subtest: vecs1
[689.609927] Dynamic subtest vecs1: SUCCESS (0.653s)
[689.626402] Starting dynamic subtest: ccs0
[690.265998] Dynamic subtest ccs0: SUCCESS (0.655s)
[690.266892] Subtest most-busy-idle-check-all: SUCCESS (4.644s)
[690.483896] [101/134] (346s left) gen9_exec_parse (unaligned-jump)
[690.567470] Subtest unaligned-jump: SKIP (0.000s)
[690.659889] [102/134] (346s left) kms_prime (basic-modeset-hybrid)
[690.847629] Subtest basic-modeset-hybrid: SKIP (0.000s)
[691.067232] [103/134] (346s left) kms_flip (dpms-off-confusion)
[691.250916] Starting subtest: dpms-off-confusion
[691.255687] Starting dynamic subtest: A-DP3
[699.092307] Dynamic subtest A-DP3: SUCCESS (7.836s)
[699.109479] Starting dynamic subtest: B-DP3
[706.863305] Dynamic subtest B-DP3: SUCCESS (7.769s)
[706.879552] Starting dynamic subtest: C-DP3
[714.633257] Dynamic subtest C-DP3: SUCCESS (7.768s)
[714.649485] Starting dynamic subtest: D-DP3
[722.410246] Dynamic subtest D-DP3: SUCCESS (7.775s)
[722.412586] Subtest dpms-off-confusion: SUCCESS (31.159s)
[722.763867] [104/134] (314s left) i915_pm_rps (waitboost)
[722.850683] Starting subtest: waitboost
[728.701015] Subtest waitboost: SUCCESS (5.851s)
[728.861720] [105/134] (308s left) kms_color (degamma)
[729.054762] Starting subtest: degamma
[729.055666] Starting dynamic subtest: pipe-A-DP-3
[729.774571] Dynamic subtest pipe-A-DP-3: SUCCESS (0.717s)
[729.805782] Starting dynamic subtest: pipe-B-DP-3
[730.392261] Dynamic subtest pipe-B-DP-3: SUCCESS (0.616s)
[730.412017] Starting dynamic subtest: pipe-C-DP-3
[730.987536] Dynamic subtest pipe-C-DP-3: SUCCESS (0.594s)
[731.004030] Starting dynamic subtest: pipe-D-DP-3
[731.595651] Dynamic subtest pipe-D-DP-3: SUCCESS (0.608s)
[731.596530] Subtest degamma: SUCCESS (2.543s)
[731.915962] [106/134] (305s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[732.105411] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[732.107194] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[732.293237] [107/134] (305s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[732.552515] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[732.704548] [108/134] (304s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs)
[732.898960] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs
[732.901480] Starting dynamic subtest: pipe-A-DP-3
[732.909945] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[732.923980] Starting dynamic subtest: pipe-B-DP-3
[732.932451] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[732.946385] Starting dynamic subtest: pipe-C-DP-3
[732.955134] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[732.969200] Starting dynamic subtest: pipe-D-DP-3
[732.979873] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[732.981858] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs: SKIP (0.009s)
[733.394198] [109/134] (304s left) kms_fb_coherency (memset-crc)
[733.583601] Starting subtest: memset-crc
[733.584498] Starting dynamic subtest: mmap-offset-fixed
[734.120451] Dynamic subtest mmap-offset-fixed: SUCCESS (0.536s)
[734.217482] Subtest memset-crc: SUCCESS (0.633s)
[734.558868] [110/134] (303s left) kms_vblank (wait-forked-busy-hang)
[734.748743] Starting subtest: wait-forked-busy-hang
[734.749612] Starting dynamic subtest: pipe-A-DP-3
[760.896078] Dynamic subtest pipe-A-DP-3: SUCCESS (26.147s)
[760.913875] Starting dynamic subtest: pipe-D-DP-3
[785.837206] Dynamic subtest pipe-D-DP-3: SUCCESS (24.936s)
[785.838174] Subtest wait-forked-busy-hang: SUCCESS (51.090s)
[786.156682] [111/134] (251s left) syncobj_eventfd (binary-wait-signaled)
[786.232637] Starting subtest: binary-wait-signaled
[786.233575] Subtest binary-wait-signaled: SUCCESS (0.000s)
[786.476393] [112/134] (251s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[786.556516] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[786.646443] [113/134] (251s left) kms_psr2_sf (pr-cursor-plane-update-sf)
[786.843916] Subtest pr-cursor-plane-update-sf: SKIP (0.000s)
[786.897924] [114/134] (251s left) kms_psr (pr-sprite-plane-move)
[787.086546] Subtest pr-sprite-plane-move: SKIP (0.000s)
[787.154087] [115/134] (250s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[787.353169] Starting subtest: x-tiled-16bpp-rotate-180
[789.100434] Subtest x-tiled-16bpp-rotate-180: SUCCESS (1.746s)
[789.338195] [116/134] (248s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[789.520909] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[789.523199] Starting dynamic subtest: pipe-A-DP-3
[789.544299] Dynamic subtest pipe-A-DP-3: SKIP (0.002s)
[789.558505] Starting dynamic subtest: pipe-B-DP-3
[789.580060] Dynamic subtest pipe-B-DP-3: SKIP (0.002s)
[789.594145] Starting dynamic subtest: pipe-C-DP-3
[789.618874] Dynamic subtest pipe-C-DP-3: SKIP (0.002s)
[789.633699] Starting dynamic subtest: pipe-D-DP-3
[789.659834] Dynamic subtest pipe-D-DP-3: SKIP (0.002s)
[789.661814] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SKIP (0.014s)
[790.012835] [117/134] (248s left) gem_exec_params (no-vebox)
[790.092842] Starting subtest: no-vebox
[790.095066] Subtest no-vebox: SUCCESS (0.001s)
[790.312722] [118/134] (248s left) kms_force_connector_basic (prune-stale-modes)
[790.419897] Starting subtest: prune-stale-modes
[790.443084] Subtest prune-stale-modes: SUCCESS (0.023s)
[790.813746] [119/134] (247s left) i915_pm_rpm (system-suspend-execbuf)
[792.340429] Starting subtest: system-suspend-execbuf
[852.113056] Subtest system-suspend-execbuf: SUCCESS (45.023s)
[852.534893] [120/134] (185s left) syncobj_timeline (invalid-single-wait-unsubmitted)
[852.624668] Starting subtest: invalid-single-wait-unsubmitted
[852.625629] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[852.806723] [121/134] (185s left) kms_addfb_basic (small-bo)
[852.993207] Starting subtest: small-bo
[852.994108] Subtest small-bo: SUCCESS (0.000s)
[853.207158] [122/134] (185s left) gem_mmap_wc (write-gtt-read-wc)
[853.283486] Subtest write-gtt-read-wc: SKIP (0.000s)
[853.384605] [123/134] (185s left) kms_force_connector_basic (force-load-detect)
[853.500938] Starting subtest: force-load-detect
[853.502720] Subtest force-load-detect: SKIP (0.000s)
[853.780441] [124/134] (185s left) kms_dither (fb-8bpc-vs-panel-8bpc)
[853.968570] Starting subtest: fb-8bpc-vs-panel-8bpc
[853.969474] Starting dynamic subtest: pipe-A-DP-3
[854.379347] Dynamic subtest pipe-A-DP-3: SUCCESS (0.406s)
[854.380937] Subtest fb-8bpc-vs-panel-8bpc: SUCCESS (0.410s)
[854.648068] [125/134] (184s left) kms_big_fb (4-tiled-addfb)
[854.841566] Starting subtest: 4-tiled-addfb
[854.842471] Subtest 4-tiled-addfb: SUCCESS (0.000s)
[855.034306] [126/134] (183s left) gen7_exec_parse (basic-allocation)
[855.117355] Subtest basic-allocation: SKIP (0.000s)
[855.176439] [127/134] (183s left) gem_userptr_blits (unsync-overlap)
[855.268184] Subtest unsync-overlap: SKIP (0.000s)
[855.485179] [128/134] (183s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[855.675539] Starting subtest: basic-flip-before-cursor-varying-size
[856.721467] Subtest basic-flip-before-cursor-varying-size: SUCCESS (1.046s)
[857.072068] [129/134] (182s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[857.261714] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[859.297173] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (2.036s)
[859.534607] [130/134] (179s left) gem_ctx_bad_destroy (double-destroy)
[859.610058] Starting subtest: double-destroy
[859.610911] Subtest double-destroy: SUCCESS (0.000s)
[859.785367] [131/134] (179s left) core_setmaster (master-drop-set-root)
[859.913314] Starting subtest: master-drop-set-root
[859.945413] Subtest master-drop-set-root: SUCCESS (0.032s)
[860.029753] [132/134] (179s left) kms_busy (extended-modeset-hang-newfb-with-reset)
[860.242992] Starting subtest: extended-modeset-hang-newfb-with-reset
[860.245270] Starting dynamic subtest: pipe-A
[881.455555] Dynamic subtest pipe-A: SUCCESS (21.210s)
[881.482708] Starting dynamic subtest: pipe-D
[902.424749] Dynamic subtest pipe-D: SUCCESS (20.962s)
[902.427641] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (42.181s)
[902.787874] [133/134] (136s left) kms_frontbuffer_tracking (fbc-abgr161616f-draw-render)
[902.980439] Starting subtest: fbc-abgr161616f-draw-render
[902.982143] Subtest fbc-abgr161616f-draw-render: SKIP (0.000s)
[903.157938] [134/134] (136s left) kms_lease (possible-crtcs-filtering)
[903.346697] Starting subtest: possible-crtcs-filtering
[903.354485] Subtest possible-crtcs-filtering: SUCCESS (0.009s)
[903.535047] Closing watchdogs
results: parsing output: 0/ for test: gem_ccs
results: parsing output: 1/ for test: kms_vrr
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gem_mmap_offset
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_plane_scaling
results: parsing output: 6/ for test: gem_exec_whisper
results: parsing output: 7/ for test: kms_plane
results: parsing output: 8/ for test: gem_ctx_isolation
results: parsing output: 9/ for test: kms_big_fb
results: parsing output: 10/ for test: sw_sync
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_cursor_crc
results: parsing output: 13/ for test: kms_chamelium_frames
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: gem_mmap_wc
results: parsing output: 16/ for test: gem_flink_race
results: parsing output: 17/ for test: gem_exec_params
results: parsing output: 18/ for test: gem_exec_params
results: parsing output: 19/ for test: kms_ccs
results: parsing output: 20/ for test: gem_exec_schedule
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: api_intel_bb
results: parsing output: 23/ for test: syncobj_timeline
results: parsing output: 24/ for test: kms_sequence
results: parsing output: 25/ for test: kms_flip
results: parsing output: 26/ for test: intel_hwmon
results: parsing output: 27/ for test: kms_psr2_sf
results: parsing output: 28/ for test: kms_atomic_interruptible
results: parsing output: 29/ for test: gem_exec_endless
results: parsing output: 30/ for test: kms_addfb_basic
results: parsing output: 31/ for test: gem_ctx_param
results: parsing output: 32/ for test: vgem_basic
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: gem_render_copy
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: gem_exec_reloc
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: gem_exec_reloc
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_psr
results: parsing output: 43/ for test: gem_mmap
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: gem_ctx_engines
results: parsing output: 46/ for test: kms_flip
results: parsing output: 47/ for test: kms_big_fb
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_content_protection
results: parsing output: 50/ for test: i915_pm_freq_api
results: parsing output: 51/ for test: gem_exec_params
results: parsing output: 52/ for test: gem_render_copy
results: parsing output: 53/ for test: gen7_exec_parse
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: kms_pm_backlight
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_psr
results: parsing output: 58/ for test: sysfs_timeslice_duration
results: parsing output: 59/ for test: kms_cdclk
results: parsing output: 60/ for test: gem_pxp
results: parsing output: 61/ for test: gem_ctx_shared
results: parsing output: 62/ for test: prime_vgem
results: parsing output: 63/ for test: kms_cursor_legacy
results: parsing output: 64/ for test: kms_pipe_crc_basic
results: parsing output: 65/ for test: syncobj_timeline
results: parsing output: 66/ for test: kms_flip_scaled_crc
results: parsing output: 67/ for test: syncobj_timeline
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: kms_psr
results: parsing output: 70/ for test: gem_exec_schedule
results: parsing output: 71/ for test: gem_pipe_control_store_loop
results: parsing output: 72/ for test: kms_plane
results: parsing output: 73/ for test: gem_eio
results: parsing output: 74/ for test: kms_psr
results: parsing output: 75/ for test: kms_cursor_crc
results: parsing output: 76/ for test: kms_cursor_crc
results: parsing output: 77/ for test: gem_softpin
results: parsing output: 78/ for test: syncobj_timeline
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: gem_render_copy
results: parsing output: 81/ for test: kms_ccs
results: parsing output: 82/ for test: kms_rotation_crc
results: parsing output: 83/ for test: gem_pread
results: parsing output: 84/ for test: gem_exec_fence
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: gem_exec_balancer
results: parsing output: 87/ for test: gem_exec_reloc
results: parsing output: 88/ for test: kms_plane
results: parsing output: 89/ for test: kms_big_fb
results: parsing output: 90/ for test: gem_eio
results: parsing output: 91/ for test: gem_spin_batch
results: parsing output: 92/ for test: api_intel_bb
results: parsing output: 93/ for test: gem_exec_schedule
results: parsing output: 94/ for test: syncobj_wait
results: parsing output: 95/ for test: gem_ctx_persistence
results: parsing output: 96/ for test: kms_joiner
results: parsing output: 97/ for test: kms_getfb
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: perf_pmu
results: parsing output: 100/ for test: gen9_exec_parse
results: parsing output: 101/ for test: kms_prime
results: parsing output: 102/ for test: kms_flip
results: parsing output: 103/ for test: i915_pm_rps
results: parsing output: 104/ for test: kms_color
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_chamelium_hpd
results: parsing output: 107/ for test: kms_ccs
results: parsing output: 108/ for test: kms_fb_coherency
results: parsing output: 109/ for test: kms_vblank
results: parsing output: 110/ for test: syncobj_eventfd
results: parsing output: 111/ for test: kms_pipe_b_c_ivb
results: parsing output: 112/ for test: kms_psr2_sf
results: parsing output: 113/ for test: kms_psr
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: kms_ccs
results: parsing output: 116/ for test: gem_exec_params
results: parsing output: 117/ for test: kms_force_connector_basic
results: parsing output: 118/ for test: i915_pm_rpm
results: parsing output: 119/ for test: syncobj_timeline
results: parsing output: 120/ for test: kms_addfb_basic
results: parsing output: 121/ for test: gem_mmap_wc
results: parsing output: 122/ for test: kms_force_connector_basic
results: parsing output: 123/ for test: kms_dither
results: parsing output: 124/ for test: kms_big_fb
results: parsing output: 125/ for test: gen7_exec_parse
results: parsing output: 126/ for test: gem_userptr_blits
results: parsing output: 127/ for test: kms_cursor_legacy
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: gem_ctx_bad_destroy
results: parsing output: 130/ for test: core_setmaster
results: parsing output: 131/ for test: kms_busy
results: parsing output: 132/ for test: kms_frontbuffer_tracking
results: parsing output: 133/ for test: kms_lease
Done.