[63.870297] Initializing watchdogs
[63.870360]   /dev/watchdog0
[63.889784] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[63.900407] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[63.904070] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[63.906383] [001/131] (960s left) gem_ctx_shared (q-smoketest)
[63.998399] Starting subtest: Q-smoketest
[63.999457] Starting dynamic subtest: rcs0
[69.448029] Dynamic subtest rcs0: SUCCESS (5.446s)
[69.456260] Starting dynamic subtest: bcs0
[74.870845] Dynamic subtest bcs0: SUCCESS (5.424s)
[74.879060] Starting dynamic subtest: vcs0
[80.296231] Dynamic subtest vcs0: SUCCESS (5.424s)
[80.304267] Starting dynamic subtest: vcs1
[85.713925] Dynamic subtest vcs1: SUCCESS (5.418s)
[85.722057] Starting dynamic subtest: vecs0
[91.128562] Dynamic subtest vecs0: SUCCESS (5.416s)
[91.137341] Starting dynamic subtest: vecs1
[96.547628] Dynamic subtest vecs1: SUCCESS (5.418s)
[96.555768] Starting dynamic subtest: ccs0
[101.965488] Dynamic subtest ccs0: SUCCESS (5.417s)
[101.966644] Subtest Q-smoketest: SUCCESS (37.966s)
[102.308992] [002/131] (922s left) kms_frontbuffer_tracking (psr-1p-rte)
[102.489597] Starting subtest: psr-1p-rte
[102.491229] Subtest psr-1p-rte: SKIP (0.000s)
[102.675085] [003/131] (921s left) kms_properties (crtc-properties-atomic)
[102.847421] Starting subtest: crtc-properties-atomic
[102.848342] Starting dynamic subtest: pipe-A-DP-3
[103.211981] Dynamic subtest pipe-A-DP-3: SUCCESS (0.362s)
[103.223656] Starting dynamic subtest: pipe-B-DP-3
[103.566175] Dynamic subtest pipe-B-DP-3: SUCCESS (0.354s)
[103.574461] Starting dynamic subtest: pipe-C-DP-3
[103.916224] Dynamic subtest pipe-C-DP-3: SUCCESS (0.349s)
[103.924345] Starting dynamic subtest: pipe-D-DP-3
[104.270537] Dynamic subtest pipe-D-DP-3: SUCCESS (0.353s)
[104.271679] Subtest crtc-properties-atomic: SUCCESS (1.423s)
[104.594830] [004/131] (920s left) gem_exec_balancer (smoke)
[104.675861] Starting subtest: smoke
[128.373580] Subtest smoke: SUCCESS (23.698s)
[129.508407] [005/131] (895s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move)
[129.687357] Starting subtest: fbc-2p-primscrn-cur-indfb-move
[129.688974] Subtest fbc-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[129.893524] [006/131] (894s left) gem_exec_balancer (individual)
[129.972964] Starting subtest: individual
[131.970199] Subtest individual: SUCCESS (1.997s)
[132.423906] [007/131] (892s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[132.610517] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[132.612244] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[132.788318] [008/131] (892s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[132.967422] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt
[132.969117] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[133.163383] [009/131] (891s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render)
[133.341399] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render
[133.343065] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[133.545413] [010/131] (891s left) sriov_basic (bind-unbind-vf)
[133.611047] Subtest bind-unbind-vf: SKIP (0.000s)
[133.670802] [011/131] (891s left) gem_exec_schedule (semaphore-codependency)
[133.751976] Starting subtest: semaphore-codependency
[133.791413] Subtest semaphore-codependency: SUCCESS (0.039s)
[134.255641] [012/131] (890s left) gem_userptr_blits (sync-unmap-cycles)
[134.338575] Starting subtest: sync-unmap-cycles
[139.712955] Subtest sync-unmap-cycles: SUCCESS (5.373s)
[139.911922] [013/131] (885s left) i915_query (test-query-geometry-subslices)
[139.979903] Starting subtest: test-query-geometry-subslices
[139.980802] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[140.180874] [014/131] (885s left) gem_mmap_gtt (basic-write)
[140.248007] Subtest basic-write: SKIP (0.000s)
[140.321259] [015/131] (885s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[140.509883] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip
[141.784409] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip: SUCCESS (1.274s)
[142.010917] [016/131] (883s left) gen9_exec_parse (bb-start-far)
[142.085171] Subtest bb-start-far: SKIP (0.000s)
[142.154718] [017/131] (883s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[142.327938] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[142.328919] Starting dynamic subtest: pipe-A-DP-3
[142.350148] Dynamic subtest pipe-A-DP-3: SKIP (0.002s)
[142.359432] Starting dynamic subtest: pipe-B-DP-3
[142.380719] Dynamic subtest pipe-B-DP-3: SKIP (0.002s)
[142.390070] Starting dynamic subtest: pipe-C-DP-3
[142.414720] Dynamic subtest pipe-C-DP-3: SKIP (0.002s)
[142.423714] Starting dynamic subtest: pipe-D-DP-3
[142.445780] Dynamic subtest pipe-D-DP-3: SKIP (0.002s)
[142.447776] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SKIP (0.011s)
[142.804372] [018/131] (882s left) syncobj_timeline (single-wait-signaled)
[142.876875] Starting subtest: single-wait-signaled
[142.877759] Subtest single-wait-signaled: SUCCESS (0.000s)
[143.071182] [019/131] (882s left) gem_pxp (reject-modify-context-protection-on)
[145.661293] Starting subtest: reject-modify-context-protection-on
[145.663985] Subtest reject-modify-context-protection-on: SKIP (0.000s)
[145.837369] [020/131] (879s left) kms_color (ctm-max)
[146.013942] Starting subtest: ctm-max
[146.014885] Starting dynamic subtest: pipe-A-DP-3
[146.702671] Dynamic subtest pipe-A-DP-3: SUCCESS (0.688s)
[146.716801] Starting dynamic subtest: pipe-B-DP-3
[147.273610] Dynamic subtest pipe-B-DP-3: SUCCESS (0.570s)
[147.284737] Starting dynamic subtest: pipe-C-DP-3
[147.857098] Dynamic subtest pipe-C-DP-3: SUCCESS (0.583s)
[147.868804] Starting dynamic subtest: pipe-D-DP-3
[148.462981] Dynamic subtest pipe-D-DP-3: SUCCESS (0.606s)
[148.464710] Subtest ctm-max: SUCCESS (2.449s)
[148.787818] [021/131] (877s left) api_intel_allocator (simple-allocator)
[148.855982] Starting subtest: simple-allocator
[148.856895] Starting dynamic subtest: basic
[148.884965] Dynamic subtest basic: SUCCESS (0.029s)
[148.894458] Starting dynamic subtest: parallel-one
[149.063290] Dynamic subtest parallel-one: SUCCESS (0.178s)
[149.072953] Starting dynamic subtest: print
[149.073922] Dynamic subtest print: SUCCESS (0.000s)
[149.083992] Starting dynamic subtest: reuse
[149.084965] Dynamic subtest reuse: SUCCESS (0.000s)
[149.094621] Starting dynamic subtest: reserve
[149.095582] Dynamic subtest reserve: SUCCESS (0.000s)
[149.105262] Starting dynamic subtest: fork-reopen-allocator
[149.106377] Dynamic subtest fork-reopen-allocator: SUCCESS (0.014s)
[149.107634] Subtest simple-allocator: SUCCESS (0.222s)
[149.302515] [022/131] (876s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[149.487941] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[149.488866] Starting dynamic subtest: pipe-A-DP-3
[149.497235] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[149.506571] Starting dynamic subtest: pipe-B-DP-3
[149.514853] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[149.523945] Starting dynamic subtest: pipe-C-DP-3
[149.531993] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[149.540882] Starting dynamic subtest: pipe-D-DP-3
[149.550508] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[149.552377] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[149.947585] [023/131] (876s left) kms_hdr (bpc-switch-dpms)
[150.121887] Starting subtest: bpc-switch-dpms
[153.416859] Starting dynamic subtest: pipe-A-DP-3
[154.683172] Dynamic subtest pipe-A-DP-3: SUCCESS (1.267s)
[154.684241] Subtest bpc-switch-dpms: SUCCESS (4.561s)
[155.046889] [024/131] (870s left) kms_big_fb (x-tiled-8bpp-rotate-180)
[155.239435] Starting subtest: x-tiled-8bpp-rotate-180
[156.793107] Subtest x-tiled-8bpp-rotate-180: SUCCESS (1.553s)
[157.003659] [025/131] (869s left) syncobj_wait (wait-all-for-submit-snapshot)
[157.071080] Starting subtest: wait-all-for-submit-snapshot
[157.154655] Subtest wait-all-for-submit-snapshot: SUCCESS (0.083s)
[157.338250] [026/131] (868s left) syncobj_timeline (multi-wait-all-signaled)
[157.405265] Starting subtest: multi-wait-all-signaled
[157.406342] Subtest multi-wait-all-signaled: SUCCESS (0.000s)
[157.551428] [027/131] (868s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[157.731517] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[157.733214] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[157.921478] [028/131] (868s left) kms_tv_load_detect (load-detect)
[157.988162] Subtest load-detect: SKIP (0.000s)
[158.050465] [029/131] (868s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-yf-tiled)
[158.125921] Starting subtest: y-tiled-mc-ccs-to-vebox-yf-tiled
[158.128173] Subtest y-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[158.386078] [030/131] (868s left) kms_big_fb (y-tiled-64bpp-rotate-90)
[158.577929] Starting subtest: y-tiled-64bpp-rotate-90
[158.579561] Subtest y-tiled-64bpp-rotate-90: SKIP (0.000s)
[158.771862] [031/131] (867s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[158.844102] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[158.942790] [032/131] (867s left) drm_read (short-buffer-nonblock)
[159.192983] Starting subtest: short-buffer-nonblock
[159.193900] Subtest short-buffer-nonblock: SUCCESS (0.000s)
[159.437733] [033/131] (867s left) api_intel_bb (intel-bb-blit-y)
[159.510123] Starting subtest: intel-bb-blit-y
[160.622477] Subtest intel-bb-blit-y: SUCCESS (1.112s)
[160.771629] [034/131] (865s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render)
[160.955280] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render
[160.956967] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[161.155152] [035/131] (865s left) kms_addfb_basic (bad-pitch-63)
[161.222176] Starting subtest: bad-pitch-63
[161.223132] Subtest bad-pitch-63: SUCCESS (0.000s)
[161.520799] [036/131] (865s left) gem_exec_schedule (u-submit-late-slice)
[161.606047] Starting subtest: u-submit-late-slice
[161.606983] Starting dynamic subtest: rcs0
[161.683306] Dynamic subtest rcs0: SUCCESS (0.077s)
[161.693299] Starting dynamic subtest: bcs0
[161.737485] Dynamic subtest bcs0: SUCCESS (0.054s)
[161.747155] Starting dynamic subtest: vcs0
[161.786158] Dynamic subtest vcs0: SUCCESS (0.048s)
[161.795600] Starting dynamic subtest: vcs1
[161.838571] Dynamic subtest vcs1: SUCCESS (0.052s)
[161.848274] Starting dynamic subtest: vecs0
[161.886987] Dynamic subtest vecs0: SUCCESS (0.048s)
[161.896815] Starting dynamic subtest: vecs1
[161.939776] Dynamic subtest vecs1: SUCCESS (0.052s)
[161.950571] Starting dynamic subtest: ccs0
[161.987858] Dynamic subtest ccs0: SUCCESS (0.048s)
[161.988949] Subtest u-submit-late-slice: SUCCESS (0.382s)
[162.521083] [037/131] (864s left) kms_cursor_crc (cursor-tearing-position-change)
[162.741066] Starting subtest: cursor-tearing-position-change
[162.742989] Starting dynamic subtest: pipe-A-DP-3
[163.238369] Dynamic subtest pipe-A-DP-3: SUCCESS (0.495s)
[163.252673] Starting dynamic subtest: pipe-D-DP-3
[163.660500] Dynamic subtest pipe-D-DP-3: SUCCESS (0.420s)
[163.661396] Subtest cursor-tearing-position-change: SUCCESS (0.920s)
[164.250407] [038/131] (862s left) gem_ctx_persistence (userptr)
[164.327939] Starting subtest: userptr
[164.575436] Subtest userptr: SUCCESS (0.246s)
[164.728780] [039/131] (862s left) kms_chamelium_audio (hdmi-audio)
[164.977713] Subtest hdmi-audio: SKIP (0.000s)
[165.122908] [040/131] (861s left) kms_psr (fbc-psr2-sprite-mmap-cpu)
[165.299887] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.000s)
[165.357741] [041/131] (861s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[165.541128] Starting subtest: basic-flip-before-cursor-atomic
[166.561541] Subtest basic-flip-before-cursor-atomic: SUCCESS (1.020s)
[166.898389] [042/131] (860s left) kms_pm_dc (dc5-retention-flops)
[168.080011] Starting subtest: dc5-retention-flops
[168.081574] Subtest dc5-retention-flops: SKIP (0.000s)
[168.246766] [043/131] (859s left) kms_properties (colorop-properties-legacy)
[168.430031] Starting subtest: colorop-properties-legacy
[168.430943] Starting dynamic subtest: pipe-A-DP-3
[168.591904] Dynamic subtest pipe-A-DP-3: SUCCESS (0.161s)
[168.609359] Starting dynamic subtest: pipe-B-DP-3
[168.790631] Dynamic subtest pipe-B-DP-3: SUCCESS (0.197s)
[168.800239] Starting dynamic subtest: pipe-C-DP-3
[168.973857] Dynamic subtest pipe-C-DP-3: SUCCESS (0.182s)
[168.983579] Starting dynamic subtest: pipe-D-DP-3
[169.158690] Dynamic subtest pipe-D-DP-3: SUCCESS (0.183s)
[169.159544] Subtest colorop-properties-legacy: SUCCESS (0.728s)
[169.466531] [044/131] (857s left) kms_chamelium_edid (hdmi-edid-read)
[169.728947] Subtest hdmi-edid-read: SKIP (0.000s)
[169.874262] [045/131] (857s left) core_hotunplug (unbind-rebind)
[169.975137] Starting subtest: unbind-rebind
[173.714846] Subtest unbind-rebind: SUCCESS (3.740s)
[173.758058] [046/131] (853s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[173.933071] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[173.933974] Starting dynamic subtest: pipe-A-DP-3
[173.942251] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[173.952467] Starting dynamic subtest: pipe-B-DP-3
[173.960919] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[173.970877] Starting dynamic subtest: pipe-C-DP-3
[173.978965] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[173.989137] Starting dynamic subtest: pipe-D-DP-3
[174.000122] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[174.001969] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SKIP (0.007s)
[174.421099] [047/131] (853s left) gem_flink_race (flink_name)
[174.463427] Starting subtest: flink_name
[179.862767] Subtest flink_name: SUCCESS (5.399s)
[180.081176] [048/131] (847s left) kms_flip (flip-vs-wf_vblank-interruptible)
[180.284162] Starting subtest: flip-vs-wf_vblank-interruptible
[180.288706] Starting dynamic subtest: A-DP3
[181.394074] Dynamic subtest A-DP3: SUCCESS (1.105s)
[181.407188] Starting dynamic subtest: B-DP3
[182.567576] Dynamic subtest B-DP3: SUCCESS (1.171s)
[182.581463] Starting dynamic subtest: C-DP3
[183.594460] Dynamic subtest C-DP3: SUCCESS (1.024s)
[183.605784] Starting dynamic subtest: D-DP3
[184.599373] Dynamic subtest D-DP3: SUCCESS (1.004s)
[184.601456] Subtest flip-vs-wf_vblank-interruptible: SUCCESS (4.317s)
[184.943226] [049/131] (842s left) gem_fence_thrash (bo-write-verify-none)
[184.990927] Starting subtest: bo-write-verify-none
[185.016190] Subtest bo-write-verify-none: SKIP (0.024s)
[185.088658] [050/131] (842s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[185.154240] Starting subtest: multi-wait-all-for-submit-submitted
[185.264120] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.107s)
[185.438636] [051/131] (842s left) kms_flip (2x-absolute-wf_vblank)
[185.627084] Starting subtest: 2x-absolute-wf_vblank
[185.642425] Subtest 2x-absolute-wf_vblank: SKIP (0.015s)
[185.814324] [052/131] (842s left) kms_psr (pr-cursor-plane-move)
[185.988525] Subtest pr-cursor-plane-move: SKIP (0.000s)
[186.050668] [053/131] (841s left) gen3_render_linear_blits
[186.184380] [054/131] (841s left) gem_mmap_wc (write-wc-read-gtt)
[186.252056] Subtest write-wc-read-gtt: SKIP (0.000s)
[186.317145] [055/131] (841s left) kms_joiner (invalid-modeset-ultra-joiner)
[186.501768] Starting subtest: invalid-modeset-ultra-joiner
[186.503383] Subtest invalid-modeset-ultra-joiner: SKIP (0.000s)
[186.657808] [056/131] (841s left) sysfs_heartbeat_interval (idempotent)
[186.732113] Starting subtest: idempotent
[186.733064] Starting dynamic subtest: vecs0
[186.735195] Dynamic subtest vecs0: SUCCESS (0.001s)
[186.745894] Starting dynamic subtest: ccs0
[186.746753] Dynamic subtest ccs0: SUCCESS (0.001s)
[186.757227] Starting dynamic subtest: vcs0
[186.758400] Dynamic subtest vcs0: SUCCESS (0.001s)
[186.768617] Starting dynamic subtest: bcs0
[186.769771] Dynamic subtest bcs0: SUCCESS (0.001s)
[186.780171] Starting dynamic subtest: vecs1
[186.781374] Dynamic subtest vecs1: SUCCESS (0.001s)
[186.791605] Starting dynamic subtest: rcs0
[186.792507] Dynamic subtest rcs0: SUCCESS (0.001s)
[186.802704] Starting dynamic subtest: vcs1
[186.803704] Dynamic subtest vcs1: SUCCESS (0.001s)
[186.804855] Subtest idempotent: SUCCESS (0.012s)
[186.899561] [057/131] (841s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-render)
[187.079478] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-render
[187.081220] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s)
[187.289779] [058/131] (841s left) kms_legacy_colorkey (invalid-plane)
[187.463761] Starting subtest: invalid-plane
[187.464592] Starting dynamic subtest: zero-id
[187.465445] Dynamic subtest zero-id: SUCCESS (0.000s)
[187.475895] Starting dynamic subtest: outrange-id
[187.476770] Dynamic subtest outrange-id: SUCCESS (0.000s)
[187.477773] Subtest invalid-plane: SUCCESS (0.001s)
[187.625824] [059/131] (840s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[187.914379] Starting subtest: cursor-rapid-movement-32x10
[187.960708] Subtest cursor-rapid-movement-32x10: SKIP (0.044s)
[188.391753] [060/131] (840s left) template (b)
[188.468126] Starting subtest: B
[188.469037] Subtest B: SUCCESS (0.000s)
[188.704480] [061/131] (839s left) kms_psr (fbc-psr-sprite-blt)
[188.881122] Subtest fbc-psr-sprite-blt: SKIP (0.000s)
[188.934594] [062/131] (839s left) perf (gen12-group-exclusive-stream-ctx-handle)
[189.331795] Starting subtest: gen12-group-exclusive-stream-ctx-handle
[189.358586] Subtest gen12-group-exclusive-stream-ctx-handle: SUCCESS (0.027s)
[189.437259] [063/131] (839s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[189.656587] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[189.658342] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[189.857497] [064/131] (838s left) syncobj_wait (invalid-multi-wait-unsubmitted)
[189.926209] Starting subtest: invalid-multi-wait-unsubmitted
[189.927207] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[190.088611] [065/131] (838s left) perf (oa-exponents)
[190.333655] Starting subtest: oa-exponents
[190.334554] Starting dynamic subtest: 0-rcs0
[192.621354] Dynamic subtest 0-rcs0: SUCCESS (2.287s)
[192.622284] Subtest oa-exponents: SUCCESS (2.288s)
[192.671754] [066/131] (836s left) i915_hangman (engine-engine-hang)
[192.762055] Starting subtest: engine-engine-hang
[192.762954] Starting dynamic subtest: rcs0
[193.580586] Dynamic subtest rcs0: SUCCESS (0.818s)
[193.593177] Starting dynamic subtest: bcs0
[194.361686] Dynamic subtest bcs0: SUCCESS (0.780s)
[194.376929] Starting dynamic subtest: vcs0
[195.193685] Dynamic subtest vcs0: SUCCESS (0.831s)
[195.206505] Starting dynamic subtest: vcs1
[196.027495] Dynamic subtest vcs1: SUCCESS (0.833s)
[196.043825] Starting dynamic subtest: vecs0
[196.827389] Dynamic subtest vecs0: SUCCESS (0.799s)
[196.838155] Starting dynamic subtest: vecs1
[197.576298] Dynamic subtest vecs1: SUCCESS (0.748s)
[197.587090] Starting dynamic subtest: ccs0
[198.369055] Dynamic subtest ccs0: SUCCESS (0.792s)
[198.370057] Subtest engine-engine-hang: SUCCESS (5.607s)
[198.571054] [067/131] (830s left) kms_dsc (dsc-basic)
[198.748158] Starting subtest: dsc-basic
[198.753166] Subtest dsc-basic: SKIP (0.000s)
[198.917292] [068/131] (830s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[199.096905] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[199.098434] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[199.293643] [069/131] (829s left) gem_render_copy (y-tiled-ccs-to-x-tiled)
[199.368411] Starting subtest: y-tiled-ccs-to-x-tiled
[199.370411] Subtest y-tiled-ccs-to-x-tiled: SKIP (0.000s)
[199.656887] [070/131] (829s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[199.843259] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[199.845065] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[200.053518] [071/131] (829s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[200.235445] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu
[202.895612] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (2.660s)
[203.125645] [072/131] (826s left) perf_pmu (gt-awake)
[203.185934] Starting subtest: gt-awake
[207.588437] Subtest gt-awake: SUCCESS (4.402s)
[207.758020] [073/131] (821s left) kms_flip (2x-flip-vs-suspend-interruptible)
[207.938158] Starting subtest: 2x-flip-vs-suspend-interruptible
[207.953873] Subtest 2x-flip-vs-suspend-interruptible: SKIP (0.015s)
[208.108941] [074/131] (821s left) gem_ctx_isolation (preservation-reset)
[208.292889] Starting subtest: preservation-reset
[208.293757] Starting dynamic subtest: rcs0
[208.864881] Dynamic subtest rcs0: SUCCESS (0.571s)
[208.876750] Starting dynamic subtest: bcs0
[209.495974] Dynamic subtest bcs0: SUCCESS (0.630s)
[209.507070] Starting dynamic subtest: vcs0
[210.128893] Dynamic subtest vcs0: SUCCESS (0.632s)
[210.140009] Starting dynamic subtest: vcs1
[210.774845] Dynamic subtest vcs1: SUCCESS (0.645s)
[210.785982] Starting dynamic subtest: vecs0
[211.362507] Dynamic subtest vecs0: SUCCESS (0.587s)
[211.373614] Starting dynamic subtest: vecs1
[211.980562] Dynamic subtest vecs1: SUCCESS (0.617s)
[211.991643] Starting dynamic subtest: ccs0
[212.562458] Dynamic subtest ccs0: SUCCESS (0.581s)
[212.563359] Subtest preservation-reset: SUCCESS (4.271s)
[212.819943] [075/131] (816s left) gem_wait (busy)
[212.904218] Starting subtest: busy
[212.905130] Starting dynamic subtest: all-engines
[213.489233] Dynamic subtest all-engines: SUCCESS (0.586s)
[213.500850] Starting dynamic subtest: rcs0
[214.030151] Dynamic subtest rcs0: SUCCESS (0.540s)
[214.041073] Starting dynamic subtest: bcs0
[214.569914] Dynamic subtest bcs0: SUCCESS (0.539s)
[214.580546] Starting dynamic subtest: vcs0
[215.108153] Dynamic subtest vcs0: SUCCESS (0.537s)
[215.119404] Starting dynamic subtest: vcs1
[215.646186] Dynamic subtest vcs1: SUCCESS (0.537s)
[215.657204] Starting dynamic subtest: vecs0
[216.185015] Dynamic subtest vecs0: SUCCESS (0.538s)
[216.196103] Starting dynamic subtest: vecs1
[216.724060] Dynamic subtest vecs1: SUCCESS (0.538s)
[216.735188] Starting dynamic subtest: ccs0
[217.262342] Dynamic subtest ccs0: SUCCESS (0.537s)
[217.263296] Subtest busy: SUCCESS (4.360s)
[217.582309] [076/131] (812s left) syncobj_wait (wait-any-interrupted)
[217.650211] Starting subtest: wait-any-interrupted
[217.752340] Subtest wait-any-interrupted: SUCCESS (0.101s)
[217.924555] [077/131] (811s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-upscaling)
[218.098636] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-upscaling
[218.100778] Starting dynamic subtest: pipe-A-valid-mode
[219.900950] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.801s)
[219.901916] Subtest flip-64bpp-4tile-to-32bpp-4tile-upscaling: SUCCESS (1.803s)
[220.188984] [078/131] (809s left) kms_big_fb (4-tiled-32bpp-rotate-180)
[220.379285] Starting subtest: 4-tiled-32bpp-rotate-180
[222.148195] Subtest 4-tiled-32bpp-rotate-180: SUCCESS (1.769s)
[222.426703] [079/131] (807s left) kms_vblank (wait-forked-hang)
[222.600771] Starting subtest: wait-forked-hang
[222.602976] Starting dynamic subtest: pipe-A-DP-3
[249.540758] Dynamic subtest pipe-A-DP-3: SUCCESS (26.938s)
[249.554807] Starting dynamic subtest: pipe-D-DP-3
[274.546026] Dynamic subtest pipe-D-DP-3: SUCCESS (25.001s)
[274.546970] Subtest wait-forked-hang: SUCCESS (51.945s)
[274.841286] [080/131] (755s left) kms_plane_multiple (2x-tiling-x)
[275.016510] Starting subtest: 2x-tiling-x
[275.018267] Subtest 2x-tiling-x: SKIP (0.000s)
[275.174338] [081/131] (754s left) kms_frontbuffer_tracking (fbcpsr-slowdraw)
[275.354076] Starting subtest: fbcpsr-slowdraw
[275.355791] Subtest fbcpsr-slowdraw: SKIP (0.000s)
[275.557803] [082/131] (754s left) gem_exec_schedule (implicit-read-write)
[275.635803] Starting subtest: implicit-read-write
[275.636685] Starting dynamic subtest: rcs0
[275.935730] Dynamic subtest rcs0: SUCCESS (0.299s)
[275.946999] Starting dynamic subtest: bcs0
[276.144989] Dynamic subtest bcs0: SUCCESS (0.208s)
[276.157226] Starting dynamic subtest: vcs0
[276.369379] Dynamic subtest vcs0: SUCCESS (0.223s)
[276.380518] Starting dynamic subtest: vcs1
[276.584030] Dynamic subtest vcs1: SUCCESS (0.214s)
[276.595279] Starting dynamic subtest: vecs0
[276.801012] Dynamic subtest vecs0: SUCCESS (0.216s)
[276.812226] Starting dynamic subtest: vecs1
[277.023104] Dynamic subtest vecs1: SUCCESS (0.221s)
[277.034053] Starting dynamic subtest: ccs0
[277.236558] Dynamic subtest ccs0: SUCCESS (0.212s)
[277.237636] Subtest implicit-read-write: SUCCESS (1.601s)
[277.704054] [083/131] (752s left) prime_mmap (test_correct)
[277.773241] Starting subtest: test_correct
[277.774162] Starting dynamic subtest: test_correct-smem
[277.821391] Dynamic subtest test_correct-smem: SUCCESS (0.048s)
[277.832297] Starting dynamic subtest: test_correct-lmem0
[278.012830] Dynamic subtest test_correct-lmem0: SUCCESS (0.190s)
[278.013817] Subtest test_correct: SUCCESS (0.240s)
[278.204778] [084/131] (752s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[278.393370] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[279.490565] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (1.097s)
[279.705465] [085/131] (750s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[279.777338] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[279.778310] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.000s)
[279.972473] [086/131] (750s left) kms_display_modes (extended-mode-basic)
[280.149363] Starting subtest: extended-mode-basic
[280.153007] Subtest extended-mode-basic: SKIP (0.000s)
[280.216272] [087/131] (750s left) syncobj_basic (bad-fd-to-handle)
[280.283412] Starting subtest: bad-fd-to-handle
[280.284266] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[280.490088] [088/131] (750s left) kms_addfb_basic (legacy-format)
[280.557470] Starting subtest: legacy-format
[280.595152] Subtest legacy-format: SUCCESS (0.036s)
[280.837947] [089/131] (749s left) i915_pm_rps (basic-api)
[280.917445] Starting subtest: basic-api
[280.919263] Subtest basic-api: SKIP (0.000s)
[281.071292] [090/131] (749s left) kms_chamelium_hpd (hdmi-hpd)
[281.316761] Subtest hdmi-hpd: SKIP (0.000s)
[281.446450] [091/131] (749s left) gem_workarounds (basic-read)
[281.534303] Starting subtest: basic-read
[281.570159] Subtest basic-read: SUCCESS (0.037s)
[281.749505] [092/131] (748s left) gem_softpin (reverse)
[281.825945] Starting subtest: reverse
[281.835509] Subtest reverse: SUCCESS (0.010s)
[281.998457] [093/131] (748s left) gem_exec_reloc (basic-active)
[282.074927] Subtest basic-active: SKIP (0.000s)
[282.161952] [094/131] (748s left) syncobj_timeline (etime-single-wait-all-available-unsubmitted)
[282.227213] Starting subtest: etime-single-wait-all-available-unsubmitted
[282.341700] Subtest etime-single-wait-all-available-unsubmitted: SUCCESS (0.106s)
[282.448675] [095/131] (748s left) kms_flip (bo-too-big-interruptible)
[282.627921] Starting subtest: bo-too-big-interruptible
[282.632714] Starting dynamic subtest: A-DP3
[282.927531] Dynamic subtest A-DP3: SUCCESS (0.294s)
[282.961020] Starting dynamic subtest: B-DP3
[283.148462] Dynamic subtest B-DP3: SUCCESS (0.218s)
[283.182266] Starting dynamic subtest: C-DP3
[283.391630] Dynamic subtest C-DP3: SUCCESS (0.240s)
[283.425332] Starting dynamic subtest: D-DP3
[283.633730] Dynamic subtest D-DP3: SUCCESS (0.239s)
[283.637702] Subtest bo-too-big-interruptible: SUCCESS (1.009s)
[284.041429] [096/131] (746s left) kms_ccs (crc-primary-suspend-y-tiled-ccs)
[284.218515] Starting subtest: crc-primary-suspend-y-tiled-ccs
[284.220612] Starting dynamic subtest: pipe-A-DP-3
[284.223989] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[284.235242] Starting dynamic subtest: pipe-B-DP-3
[284.238790] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[284.249906] Starting dynamic subtest: pipe-C-DP-3
[284.253272] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[284.264210] Starting dynamic subtest: pipe-D-DP-3
[284.267682] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[284.269268] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.007s)
[284.687313] [097/131] (746s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[284.869128] Starting subtest: fbcpsr-indfb-scaledprimary
[284.870885] Subtest fbcpsr-indfb-scaledprimary: SKIP (0.000s)
[285.062688] [098/131] (746s left) kms_flip (bo-too-big)
[285.240062] Starting subtest: bo-too-big
[285.244589] Starting dynamic subtest: A-DP3
[285.558815] Dynamic subtest A-DP3: SUCCESS (0.314s)
[285.602282] Starting dynamic subtest: B-DP3
[285.820501] Dynamic subtest B-DP3: SUCCESS (0.258s)
[285.851127] Starting dynamic subtest: C-DP3
[286.067411] Dynamic subtest C-DP3: SUCCESS (0.244s)
[286.096476] Starting dynamic subtest: D-DP3
[286.312659] Dynamic subtest D-DP3: SUCCESS (0.242s)
[286.317337] Subtest bo-too-big: SUCCESS (1.077s)
[286.725795] [099/131] (744s left) gem_media_fill (media-fill)
[286.796453] Subtest media-fill: SKIP (0.000s)
[286.956813] [100/131] (744s left) gem_mmap_gtt (basic-read)
[287.024139] Subtest basic-read: SKIP (0.000s)
[287.100029] [101/131] (744s left) vgem_basic (dmabuf-fence-before)
[287.226401] Starting subtest: dmabuf-fence-before
[287.227319] Subtest dmabuf-fence-before: SUCCESS (0.001s)
[287.384392] [FACT vgem_basic (dmabuf-fence-before)] new: kernel.kmod_is_loaded.vgem: true
[287.386653] [102/131] (743s left) kms_atomic (crtc-invalid-params-fence)
[287.569565] Starting subtest: crtc-invalid-params-fence
[287.571769] Starting dynamic subtest: pipe-A-DP-3
[288.201483] Dynamic subtest pipe-A-DP-3: SUCCESS (0.630s)
[288.202431] Subtest crtc-invalid-params-fence: SUCCESS (0.632s)
[288.547308] [103/131] (742s left) kms_addfb_basic (bad-pitch-32)
[288.634533] Starting subtest: bad-pitch-32
[288.635393] Subtest bad-pitch-32: SUCCESS (0.000s)
[288.946697] [104/131] (742s left) gem_exec_fence (syncobj-timeline-invalid-wait)
[289.570997] Starting subtest: syncobj-timeline-invalid-wait
[289.576353] Subtest syncobj-timeline-invalid-wait: SUCCESS (0.008s)
[289.933865] [105/131] (741s left) kms_sequence (get-busy)
[290.124422] Starting subtest: get-busy
[290.125300] Starting dynamic subtest: pipe-A-DP-3
[292.702539] Dynamic subtest pipe-A-DP-3: SUCCESS (2.577s)
[292.715376] Starting dynamic subtest: pipe-B-DP-3
[295.184827] Dynamic subtest pipe-B-DP-3: SUCCESS (2.480s)
[295.196418] Starting dynamic subtest: pipe-C-DP-3
[297.650969] Dynamic subtest pipe-C-DP-3: SUCCESS (2.465s)
[297.664728] Starting dynamic subtest: pipe-D-DP-3
[300.125361] Dynamic subtest pipe-D-DP-3: SUCCESS (2.473s)
[300.126288] Subtest get-busy: SUCCESS (10.002s)
[300.436437] [106/131] (731s left) i915_drm_fdinfo (busy)
[300.504378] Starting subtest: busy
[300.505241] Starting dynamic subtest: rcs0
[300.530173] Dynamic subtest rcs0: SKIP (0.024s)
[300.542848] Starting dynamic subtest: bcs0
[300.545192] Dynamic subtest bcs0: SKIP (0.000s)
[300.557451] Starting dynamic subtest: vcs0
[300.559721] Dynamic subtest vcs0: SKIP (0.000s)
[300.571777] Starting dynamic subtest: vcs1
[300.573816] Dynamic subtest vcs1: SKIP (0.000s)
[300.585179] Starting dynamic subtest: vecs0
[300.587613] Dynamic subtest vecs0: SKIP (0.000s)
[300.598424] Starting dynamic subtest: vecs1
[300.600598] Dynamic subtest vecs1: SKIP (0.000s)
[300.611805] Starting dynamic subtest: ccs0
[300.614139] Dynamic subtest ccs0: SKIP (0.000s)
[300.616540] Subtest busy: SKIP (0.034s)
[300.672483] [107/131] (731s left) kms_ccs (bad-rotation-90-4-tiled-dg2-mc-ccs)
[300.856366] Starting subtest: bad-rotation-90-4-tiled-dg2-mc-ccs
[300.857252] Starting dynamic subtest: pipe-A-DP-3
[300.865511] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[300.876775] Starting dynamic subtest: pipe-B-DP-3
[300.885055] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[300.896181] Starting dynamic subtest: pipe-C-DP-3
[300.904295] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[300.915555] Starting dynamic subtest: pipe-D-DP-3
[300.925213] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[300.927170] Subtest bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.007s)
[301.320688] [108/131] (730s left) fbdev (eof)
[301.383481] Starting subtest: eof
[301.384462] Subtest eof: SUCCESS (0.000s)
[301.567808] [109/131] (730s left) kms_flip_tiling (flip-change-tiling)
[301.749871] Starting subtest: flip-change-tiling
[301.752337] Starting dynamic subtest: pipe-A-DP-3-4-to-4
[302.016546] Dynamic subtest pipe-A-DP-3-4-to-4: SUCCESS (0.264s)
[302.060057] Starting dynamic subtest: pipe-A-DP-3-4-to-x
[302.233189] Dynamic subtest pipe-A-DP-3-4-to-x: SUCCESS (0.212s)
[302.278432] Starting dynamic subtest: pipe-A-DP-3-4-to-linear
[302.448957] Dynamic subtest pipe-A-DP-3-4-to-linear: SUCCESS (0.212s)
[302.466315] Starting dynamic subtest: pipe-A-DP-3-x-to-4
[302.649104] Dynamic subtest pipe-A-DP-3-x-to-4: SUCCESS (0.199s)
[302.684040] Starting dynamic subtest: pipe-A-DP-3-x-to-x
[302.833082] Dynamic subtest pipe-A-DP-3-x-to-x: SUCCESS (0.181s)
[302.877540] Starting dynamic subtest: pipe-A-DP-3-x-to-linear
[303.050218] Dynamic subtest pipe-A-DP-3-x-to-linear: SUCCESS (0.212s)
[303.095472] Starting dynamic subtest: pipe-A-DP-3-linear-to-4
[303.266555] Dynamic subtest pipe-A-DP-3-linear-to-4: SUCCESS (0.212s)
[303.286375] Starting dynamic subtest: pipe-A-DP-3-linear-to-x
[303.466833] Dynamic subtest pipe-A-DP-3-linear-to-x: SUCCESS (0.195s)
[303.486796] Starting dynamic subtest: pipe-A-DP-3-linear-to-linear
[303.633192] Dynamic subtest pipe-A-DP-3-linear-to-linear: SUCCESS (0.162s)
[303.699031] Starting dynamic subtest: pipe-B-DP-3-4-to-4
[304.014132] Dynamic subtest pipe-B-DP-3-4-to-4: SUCCESS (0.329s)
[304.059091] Starting dynamic subtest: pipe-B-DP-3-4-to-x
[304.179781] Dynamic subtest pipe-B-DP-3-4-to-x: SUCCESS (0.162s)
[304.201995] Starting dynamic subtest: pipe-B-DP-3-4-to-linear
[304.329990] Dynamic subtest pipe-B-DP-3-4-to-linear: SUCCESS (0.148s)
[304.359967] Starting dynamic subtest: pipe-B-DP-3-x-to-4
[304.479947] Dynamic subtest pipe-B-DP-3-x-to-4: SUCCESS (0.148s)
[304.505423] Starting dynamic subtest: pipe-B-DP-3-x-to-x
[304.629877] Dynamic subtest pipe-B-DP-3-x-to-x: SUCCESS (0.148s)
[304.659705] Starting dynamic subtest: pipe-B-DP-3-x-to-linear
[304.796976] Dynamic subtest pipe-B-DP-3-x-to-linear: SUCCESS (0.165s)
[304.836988] Starting dynamic subtest: pipe-B-DP-3-linear-to-4
[304.963098] Dynamic subtest pipe-B-DP-3-linear-to-4: SUCCESS (0.163s)
[304.982755] Starting dynamic subtest: pipe-B-DP-3-linear-to-x
[305.113438] Dynamic subtest pipe-B-DP-3-linear-to-x: SUCCESS (0.148s)
[305.154500] Starting dynamic subtest: pipe-B-DP-3-linear-to-linear
[305.280068] Dynamic subtest pipe-B-DP-3-linear-to-linear: SUCCESS (0.164s)
[305.327196] Starting dynamic subtest: pipe-C-DP-3-4-to-4
[305.644260] Dynamic subtest pipe-C-DP-3-4-to-4: SUCCESS (0.329s)
[305.686567] Starting dynamic subtest: pipe-C-DP-3-4-to-x
[305.809857] Dynamic subtest pipe-C-DP-3-4-to-x: SUCCESS (0.161s)
[305.832566] Starting dynamic subtest: pipe-C-DP-3-4-to-linear
[305.960132] Dynamic subtest pipe-C-DP-3-4-to-linear: SUCCESS (0.148s)
[305.990215] Starting dynamic subtest: pipe-C-DP-3-x-to-4
[306.126722] Dynamic subtest pipe-C-DP-3-x-to-4: SUCCESS (0.164s)
[306.161588] Starting dynamic subtest: pipe-C-DP-3-x-to-x
[306.293428] Dynamic subtest pipe-C-DP-3-x-to-x: SUCCESS (0.164s)
[306.310941] Starting dynamic subtest: pipe-C-DP-3-x-to-linear
[306.443452] Dynamic subtest pipe-C-DP-3-x-to-linear: SUCCESS (0.147s)
[306.483618] Starting dynamic subtest: pipe-C-DP-3-linear-to-4
[306.610022] Dynamic subtest pipe-C-DP-3-linear-to-4: SUCCESS (0.164s)
[306.627145] Starting dynamic subtest: pipe-C-DP-3-linear-to-x
[306.760562] Dynamic subtest pipe-C-DP-3-linear-to-x: SUCCESS (0.148s)
[306.803115] Starting dynamic subtest: pipe-C-DP-3-linear-to-linear
[306.926679] Dynamic subtest pipe-C-DP-3-linear-to-linear: SUCCESS (0.162s)
[306.973650] Starting dynamic subtest: pipe-D-DP-3-4-to-4
[307.290225] Dynamic subtest pipe-D-DP-3-4-to-4: SUCCESS (0.328s)
[307.333279] Starting dynamic subtest: pipe-D-DP-3-4-to-x
[307.455882] Dynamic subtest pipe-D-DP-3-4-to-x: SUCCESS (0.161s)
[307.471834] Starting dynamic subtest: pipe-D-DP-3-4-to-linear
[307.589266] Dynamic subtest pipe-D-DP-3-4-to-linear: SUCCESS (0.132s)
[307.619031] Starting dynamic subtest: pipe-D-DP-3-x-to-4
[307.756159] Dynamic subtest pipe-D-DP-3-x-to-4: SUCCESS (0.165s)
[307.790518] Starting dynamic subtest: pipe-D-DP-3-x-to-x
[307.922762] Dynamic subtest pipe-D-DP-3-x-to-x: SUCCESS (0.164s)
[307.957315] Starting dynamic subtest: pipe-D-DP-3-x-to-linear
[308.089486] Dynamic subtest pipe-D-DP-3-x-to-linear: SUCCESS (0.164s)
[308.124117] Starting dynamic subtest: pipe-D-DP-3-linear-to-4
[308.256192] Dynamic subtest pipe-D-DP-3-linear-to-4: SUCCESS (0.164s)
[308.290744] Starting dynamic subtest: pipe-D-DP-3-linear-to-x
[308.422740] Dynamic subtest pipe-D-DP-3-linear-to-x: SUCCESS (0.164s)
[308.457220] Starting dynamic subtest: pipe-D-DP-3-linear-to-linear
[308.589394] Dynamic subtest pipe-D-DP-3-linear-to-linear: SUCCESS (0.164s)
[308.622333] Subtest flip-change-tiling: SUCCESS (6.872s)
[309.006984] [110/131] (723s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted)
[309.084435] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted
[309.191063] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.105s)
[309.386290] [111/131] (722s left) kms_plane_scaling (plane-upscale-factor-0-25-with-rotation)
[309.570518] Starting subtest: plane-upscale-factor-0-25-with-rotation
[309.571361] Starting dynamic subtest: pipe-A
[309.951745] Dynamic subtest pipe-A: SUCCESS (0.380s)
[309.980323] Starting dynamic subtest: pipe-B
[310.430614] Dynamic subtest pipe-B: SUCCESS (0.476s)
[310.457882] Starting dynamic subtest: pipe-C
[310.908382] Dynamic subtest pipe-C: SUCCESS (0.476s)
[310.925982] Starting dynamic subtest: pipe-D
[311.370620] Dynamic subtest pipe-D: SUCCESS (0.461s)
[311.371625] Subtest plane-upscale-factor-0-25-with-rotation: SUCCESS (1.801s)
[311.716665] [112/131] (720s left) kms_flip (flip-vs-panning)
[311.904017] Starting subtest: flip-vs-panning
[311.908715] Starting dynamic subtest: A-DP3
[319.752763] Dynamic subtest A-DP3: SUCCESS (7.843s)
[319.768242] Starting dynamic subtest: B-DP3
[327.535339] Dynamic subtest B-DP3: SUCCESS (7.778s)
[327.551432] Starting dynamic subtest: C-DP3
[335.315623] Dynamic subtest C-DP3: SUCCESS (7.778s)
[335.355355] Starting dynamic subtest: D-DP3
[343.130735] Dynamic subtest D-DP3: SUCCESS (7.809s)
[343.139514] Subtest flip-vs-panning: SUCCESS (31.234s)
[343.510353] [113/131] (688s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-render)
[343.700117] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-render
[343.701782] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[343.904311] [114/131] (688s left) gem_close_race (basic-process)
[344.021257] Starting subtest: basic-process
[344.104661] Subtest basic-process: SUCCESS (0.083s)
[344.376362] [115/131] (688s left) kms_cursor_crc (cursor-dpms)
[344.633313] Starting subtest: cursor-dpms
[344.635504] Starting dynamic subtest: pipe-A-DP-3
[345.911950] Dynamic subtest pipe-A-DP-3: SUCCESS (1.275s)
[345.940626] Starting dynamic subtest: pipe-D-DP-3
[347.071446] Dynamic subtest pipe-D-DP-3: SUCCESS (1.152s)
[347.072370] Subtest cursor-dpms: SUCCESS (2.438s)
[347.628950] [116/131] (684s left) gem_pread (display)
[347.703162] Subtest display: SKIP (0.000s)
[347.796683] [117/131] (684s left) gem_linear_blits (normal)
[348.254492] Starting subtest: normal
[355.417982] Subtest normal: SUCCESS (7.163s)
[355.893769] [118/131] (676s left) kms_selftest (drm_dp_mst_helper)
[355.994039] Starting subtest: drm_dp_mst_helper
[356.028323] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[356.126092] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.097s)
[356.138575] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[356.236317] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.106s)
[356.276117] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[356.326614] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.089s)
[356.329382] Subtest drm_dp_mst_helper: SUCCESS (0.334s)
[356.569914] [119/131] (676s left) kms_invalid_mode (bad-hsync-start)
[356.759169] Starting subtest: bad-hsync-start
[356.760085] Starting dynamic subtest: pipe-A-DP-3
[356.832253] Dynamic subtest pipe-A-DP-3: SUCCESS (0.071s)
[356.845207] Starting dynamic subtest: pipe-B-DP-3
[356.846456] Dynamic subtest pipe-B-DP-3: SUCCESS (0.001s)
[356.859168] Starting dynamic subtest: pipe-C-DP-3
[356.860451] Dynamic subtest pipe-C-DP-3: SUCCESS (0.001s)
[356.872360] Starting dynamic subtest: pipe-D-DP-3
[356.873251] Dynamic subtest pipe-D-DP-3: SUCCESS (0.001s)
[356.874157] Subtest bad-hsync-start: SUCCESS (0.080s)
[357.126989] [120/131] (675s left) kms_prime (basic-modeset-hybrid)
[357.316125] Subtest basic-modeset-hybrid: SKIP (0.000s)
[357.531332] [121/131] (675s left) gem_ctx_engines (none)
[357.623460] Starting subtest: none
[357.625772] Subtest none: SUCCESS (0.002s)
[357.881532] [122/131] (675s left) vgem_basic (second-client)
[357.934278] Starting subtest: second-client
[357.967541] Subtest second-client: SUCCESS (0.033s)
[358.132439] [123/131] (674s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[358.338159] Starting subtest: fbc-rgb565-draw-mmap-gtt
[358.339883] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[358.540626] [124/131] (674s left) gem_lmem_swapping (heavy-verify-multi)
[361.201060] Starting subtest: heavy-verify-multi
[361.203044] Starting dynamic subtest: lmem0
[375.265805] Dynamic subtest lmem0: SUCCESS (14.064s)
[375.266727] Subtest heavy-verify-multi: SUCCESS (14.065s)
[376.434531] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[376.435472] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: kernel.kmod_is_loaded.i915: true
[376.437360] [125/131] (656s left) kms_flip (dpms-vs-vblank-race-interruptible)
[378.103573] Starting subtest: dpms-vs-vblank-race-interruptible
[378.108449] Starting dynamic subtest: A-DP3
[381.357306] Dynamic subtest A-DP3: SUCCESS (3.246s)
[381.376130] Starting dynamic subtest: B-DP3
[384.331564] Dynamic subtest B-DP3: SUCCESS (2.974s)
[384.343113] Starting dynamic subtest: C-DP3
[387.318660] Dynamic subtest C-DP3: SUCCESS (2.985s)
[387.331818] Starting dynamic subtest: D-DP3
[390.291563] Dynamic subtest D-DP3: SUCCESS (2.970s)
[390.292439] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (12.188s)
[390.593774] [FACT kms_flip (dpms-vs-vblank-race-interruptible)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[390.596535] [FACT kms_flip (dpms-vs-vblank-race-interruptible)] new: kernel.kmod_is_loaded.i915: true
[390.599455] [126/131] (642s left) kms_psr (fbc-pr-sprite-blt)
[390.790035] Subtest fbc-pr-sprite-blt: SKIP (0.000s)
[390.848766] [127/131] (642s left) kms_plane_scaling (plane-downscale-factor-0-75-with-modifiers)
[391.034641] Starting subtest: plane-downscale-factor-0-75-with-modifiers
[391.035501] Starting dynamic subtest: pipe-A
[391.604819] Dynamic subtest pipe-A: SUCCESS (0.569s)
[391.625670] Starting dynamic subtest: pipe-B
[392.250206] Dynamic subtest pipe-B: SUCCESS (0.644s)
[392.268803] Starting dynamic subtest: pipe-C
[392.879362] Dynamic subtest pipe-C: SUCCESS (0.627s)
[392.904659] Starting dynamic subtest: pipe-D
[393.525762] Dynamic subtest pipe-D: SUCCESS (0.644s)
[393.530109] Subtest plane-downscale-factor-0-75-with-modifiers: SUCCESS (2.492s)
[393.888319] [128/131] (639s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[394.078138] Subtest psr2-overlay-plane-update-continuous-sf: SKIP (0.000s)
[394.132927] [129/131] (639s left) kms_psr (psr-cursor-mmap-gtt)
[394.316172] Subtest psr-cursor-mmap-gtt: SKIP (0.000s)
[394.381806] [130/131] (639s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-pwrite)
[394.578116] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-pwrite
[394.579832] Subtest fbc-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[394.773636] [131/131] (638s left) gem_mmap_gtt (flink-race)
[394.851164] Subtest flink-race: SKIP (0.000s)
[394.913682] Closing watchdogs
results: parsing output: 0/ for test: gem_ctx_shared
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_properties
results: parsing output: 3/ for test: gem_exec_balancer
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: gem_exec_balancer
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: sriov_basic
results: parsing output: 10/ for test: gem_exec_schedule
results: parsing output: 11/ for test: gem_userptr_blits
results: parsing output: 12/ for test: i915_query
results: parsing output: 13/ for test: gem_mmap_gtt
results: parsing output: 14/ for test: kms_big_fb
results: parsing output: 15/ for test: gen9_exec_parse
results: parsing output: 16/ for test: kms_ccs
results: parsing output: 17/ for test: syncobj_timeline
results: parsing output: 18/ for test: gem_pxp
results: parsing output: 19/ for test: kms_color
results: parsing output: 20/ for test: api_intel_allocator
results: parsing output: 21/ for test: kms_ccs
results: parsing output: 22/ for test: kms_hdr
results: parsing output: 23/ for test: kms_big_fb
results: parsing output: 24/ for test: syncobj_wait
results: parsing output: 25/ for test: syncobj_timeline
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: kms_tv_load_detect
results: parsing output: 28/ for test: gem_render_copy
results: parsing output: 29/ for test: kms_big_fb
results: parsing output: 30/ for test: gem_fenced_exec_thrash
results: parsing output: 31/ for test: drm_read
results: parsing output: 32/ for test: api_intel_bb
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_addfb_basic
results: parsing output: 35/ for test: gem_exec_schedule
results: parsing output: 36/ for test: kms_cursor_crc
results: parsing output: 37/ for test: gem_ctx_persistence
results: parsing output: 38/ for test: kms_chamelium_audio
results: parsing output: 39/ for test: kms_psr
results: parsing output: 40/ for test: kms_cursor_legacy
results: parsing output: 41/ for test: kms_pm_dc
results: parsing output: 42/ for test: kms_properties
results: parsing output: 43/ for test: kms_chamelium_edid
results: parsing output: 44/ for test: core_hotunplug
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: gem_flink_race
results: parsing output: 47/ for test: kms_flip
results: parsing output: 48/ for test: gem_fence_thrash
results: parsing output: 49/ for test: syncobj_wait
results: parsing output: 50/ for test: kms_flip
results: parsing output: 51/ for test: kms_psr
results: parsing output: 52/ for test: gen3_render_linear_blits
results: parsing output: 53/ for test: gem_mmap_wc
results: parsing output: 54/ for test: kms_joiner
results: parsing output: 55/ for test: sysfs_heartbeat_interval
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_legacy_colorkey
results: parsing output: 58/ for test: kms_cursor_crc
results: parsing output: 59/ for test: template
results: parsing output: 60/ for test: kms_psr
results: parsing output: 61/ for test: perf
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: syncobj_wait
results: parsing output: 64/ for test: perf
results: parsing output: 65/ for test: i915_hangman
results: parsing output: 66/ for test: kms_dsc
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: gem_render_copy
results: parsing output: 69/ for test: kms_big_fb
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: perf_pmu
results: parsing output: 72/ for test: kms_flip
results: parsing output: 73/ for test: gem_ctx_isolation
results: parsing output: 74/ for test: gem_wait
results: parsing output: 75/ for test: syncobj_wait
results: parsing output: 76/ for test: kms_flip_scaled_crc
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: kms_vblank
results: parsing output: 79/ for test: kms_plane_multiple
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: gem_exec_schedule
results: parsing output: 82/ for test: prime_mmap
results: parsing output: 83/ for test: kms_big_fb
results: parsing output: 84/ for test: syncobj_timeline
results: parsing output: 85/ for test: kms_display_modes
results: parsing output: 86/ for test: syncobj_basic
results: parsing output: 87/ for test: kms_addfb_basic
results: parsing output: 88/ for test: i915_pm_rps
results: parsing output: 89/ for test: kms_chamelium_hpd
results: parsing output: 90/ for test: gem_workarounds
results: parsing output: 91/ for test: gem_softpin
results: parsing output: 92/ for test: gem_exec_reloc
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: kms_flip
results: parsing output: 95/ for test: kms_ccs
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_flip
results: parsing output: 98/ for test: gem_media_fill
results: parsing output: 99/ for test: gem_mmap_gtt
results: parsing output: 100/ for test: vgem_basic
results: parsing output: 101/ for test: kms_atomic
results: parsing output: 102/ for test: kms_addfb_basic
results: parsing output: 103/ for test: gem_exec_fence
results: parsing output: 104/ for test: kms_sequence
results: parsing output: 105/ for test: i915_drm_fdinfo
results: parsing output: 106/ for test: kms_ccs
results: parsing output: 107/ for test: fbdev
results: parsing output: 108/ for test: kms_flip_tiling
results: parsing output: 109/ for test: syncobj_timeline
results: parsing output: 110/ for test: kms_plane_scaling
results: parsing output: 111/ for test: kms_flip
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: gem_close_race
results: parsing output: 114/ for test: kms_cursor_crc
results: parsing output: 115/ for test: gem_pread
results: parsing output: 116/ for test: gem_linear_blits
results: parsing output: 117/ for test: kms_selftest
results: parsing output: 118/ for test: kms_invalid_mode
results: parsing output: 119/ for test: kms_prime
results: parsing output: 120/ for test: gem_ctx_engines
results: parsing output: 121/ for test: vgem_basic
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_lmem_swapping
results: parsing output: 124/ for test: kms_flip
results: parsing output: 125/ for test: kms_psr
results: parsing output: 126/ for test: kms_plane_scaling
results: parsing output: 127/ for test: kms_psr2_sf
results: parsing output: 128/ for test: kms_psr
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: gem_mmap_gtt
Done.