Skip to content
New issue

Have a question about this project? Sign up for a free GitHub account to open an issue and contact its maintainers and the community.

Sign up for GitHub

By clicking “Sign up for GitHub”, you agree to our terms of service and privacy statement. We’ll occasionally send you account related emails.

Already on GitHub? Sign in to your account

Jump to bottom

Screen Recorder process is not starting #1363

Closed
n00bstr opened this issue Dec 24, 2021 · 2 comments
Closed

Screen Recorder process is not starting #1363

n00bstr opened this issue Dec 24, 2021 · 2 comments

Comments

@n00bstr
Copy link

n00bstr commented Dec 24, 2021

The screen recording does generate the mp4 in the temp folders. It is also complaining that the WebDriverAgent cannot take a screenshot with 20000 ms.

Installed
Appium 1.22.2
XCUITEST Driver - 3.59.0
FFMPEG - 4.4.1
OS - Mac OS Monterey
XCode - 13.2.1

Logs:
2021-12-24 16:29:44:795 - [HTTP] --> POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/appium/start_recording_screen
2021-12-24 16:29:44:795 - [HTTP] {}
2021-12-24 16:29:44:796 - [debug] [W3C (0b11dcf3)] Calling AppiumDriver.startRecordingScreen() with args: [null,"0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8"]
2021-12-24 16:29:44:796 - [debug] [XCUITest] Executing command 'startRecordingScreen'
2021-12-24 16:29:44:796 - [XCUITest] Checking if there is/was a previous screen recording. Set 'forceRestart' option to 'true' if you'd like to skip this step.
2021-12-24 16:29:44:797 - [XCUITest] Screen recording is not running. There is nothing to stop.
2021-12-24 16:29:44:808 - [DevCon Factory] Releasing connections for 01B145DA-9B98-48BA-81CA-738D0478B658 device on 9100 port number
2021-12-24 16:29:44:808 - [DevCon Factory] No cached connections have been found
2021-12-24 16:29:44:812 - [debug] [WD Proxy] Matched '/appium/settings' to command name 'getSettings'
2021-12-24 16:29:44:812 - [debug] [WD Proxy] Proxying [GET /appium/settings] to [GET http://127.0.0.1:8190/session/A4250843-A600-4C2A-BA7A-A5386622FDB1/appium/settings] with no body
2021-12-24 16:29:44:814 - [debug] [WD Proxy] Got response with status 200: {"value":{"boundElementsByIndex":false,"mjpegServerFramerate":10,"screenshotOrientation":"auto","reduceMotion":false,"elementResponseAttributes":"type,label","screenshotQuality":1,"mjpegScalingFactor":100,"keyboardPrediction":0,"defaultActiveApplication":"auto","mjpegServerScreenshotQuality":25,"defaultAlertAction":"","keyboardAutocorrection":0,"useFirstMatch":false,"shouldUseCompactResponses":true,"customSnapshotTimeout":15,"dismissAlertButtonSelector":"","activeAppDetectionPoint":"64.00,64.00","snapshotMaxDepth":50,"waitForIdleTimeout":10,"includeNonModalElements":false,"acceptAlertButtonSelector":"","animationCoolOffTimeout":2},"sessionId":"A4250843-A600-4C2A-BA7A-A5386622FDB1"}
2021-12-24 16:29:44:825 - [DevCon Factory] Requesting connection for device 01B145DA-9B98-48BA-81CA-738D0478B658 on local port 9100, device port 9100
2021-12-24 16:29:44:825 - [debug] [DevCon Factory] Cached connections count: 1
2021-12-24 16:29:44:825 - [DevCon Factory] Successfully requested the connection for 01B145DA-9B98-48BA-81CA-738D0478B658:9100
2021-12-24 16:29:49:853 - [XCUITest] Screen capture process did not start within 5000ms. Continuing anyway
2021-12-24 16:29:49:854 - [XCUITest] Starting screen capture on the device '01B145DA-9B98-48BA-81CA-738D0478B658' with command: 'ffmpeg -f mjpeg -i http://127.0.0.1:9100 -vcodec mjpeg -y /var/folders/7r/cp9601gd0h3604ghk65vvyp00000gn/T/20211124-97705-1s0bxa7.hupm/appium_3c8447.mp4'. Will timeout in 180000ms
2021-12-24 16:29:49:856 - [debug] [W3C (0b11dcf3)] Responding to client with driver.startRecordingScreen() result: ""
2021-12-24 16:29:49:863 - [HTTP] <-- POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/appium/start_recording_screen 200 5063 ms - 12
2021-12-24 16:29:49:863 - [HTTP]
Using sim/device/emulator with udid: 01B145DA-9B98-48BA-81CA-738D0478B658
2021-12-24 16:29:49:903 - [HTTP] --> GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/context
2021-12-24 16:29:49:903 - [HTTP] {}
2021-12-24 16:29:49:903 - [debug] [W3C (0b11dcf3)] Calling AppiumDriver.getCurrentContext() with args: ["0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8"]
2021-12-24 16:29:49:904 - [debug] [XCUITest] Executing command 'getCurrentContext'
2021-12-24 16:29:49:904 - [debug] [W3C (0b11dcf3)] Responding to client with driver.getCurrentContext() result: "NATIVE_APP"
2021-12-24 16:29:49:905 - [HTTP] <-- GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/context 200 2 ms - 22
2021-12-24 16:29:49:905 - [HTTP]
2021-12-24 16:29:49:910 - [HTTP] --> POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element
2021-12-24 16:29:49:911 - [HTTP] {"using":"xpath","value":"/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up for free']"}
2021-12-24 16:29:49:911 - [debug] [W3C (0b11dcf3)] Calling AppiumDriver.findElement() with args: ["xpath","/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up for free']","0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8"]
2021-12-24 16:29:49:911 - [debug] [XCUITest] Executing command 'findElement'
2021-12-24 16:29:49:911 - [debug] [BaseDriver] Valid locator strategies for this request: xpath, id, name, class name, -ios predicate string, -ios class chain, accessibility id, css selector
2021-12-24 16:29:49:912 - [debug] [BaseDriver] Waiting up to 5000 ms for condition
2021-12-24 16:29:49:912 - [debug] [WD Proxy] Matched '/element' to command name 'findElement'
2021-12-24 16:29:49:913 - [debug] [WD Proxy] Proxying [POST /element] to [POST http://127.0.0.1:8190/session/A4250843-A600-4C2A-BA7A-A5386622FDB1/element] with body: {"using":"xpath","value":"/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up for free']"}
2021-12-24 16:29:49:926 - [Xcode] 2021-12-24 16:29:49.924377+1100 WebDriverAgentRunner-Runner[97991:4962725] Getting the most recent active application (out of 1 total items)
2021-12-24 16:29:49:927 - [Xcode]
2021-12-24 16:29:49:933 - [Xcode] 2021-12-24 16:29:49.927724+1100 WebDriverAgentRunner-Runner[97991:4962725] The following attributes were requested to be included into the XML: {(
2021-12-24 16:29:49:933 - [Xcode] FBLabelAttribute
2021-12-24 16:29:49:933 - [Xcode] )}
2021-12-24 16:29:49:933 - [Xcode]
2021-12-24 16:29:49:933 - [Xcode] t = 19.49s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:49:933 - [Xcode]
2021-12-24 16:29:49:995 - [Xcode] t = 19.56s Get all elements bound by accessibility element for: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:49:995 - [Xcode]
2021-12-24 16:29:49:995 - [Xcode] t = 19.56s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:49:996 - [Xcode]
2021-12-24 16:29:50:001 - [Xcode] t = 19.56s Find: Descendants matching type Button
2021-12-24 16:29:50:001 - [Xcode]
2021-12-24 16:29:50:001 - [Xcode] t = 19.56s Find: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:50:001 - [Xcode]
2021-12-24 16:29:50:006 - [Xcode] t = 19.57s Checking existence of "Sign up with MyPost" Button
2021-12-24 16:29:50:006 - [Xcode]
2021-12-24 16:29:50:006 - [Xcode] t = 19.57s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:50:006 - [Xcode]
2021-12-24 16:29:50:012 - [Xcode] t = 19.57s Find: Descendants matching type Button
2021-12-24 16:29:50:012 - [Xcode]
2021-12-24 16:29:50:012 - [Xcode] t = 19.57s Find: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:50:012 - [Xcode]
2021-12-24 16:29:50:012 - [Xcode] t = 19.58s Find: Identity Binding
2021-12-24 16:29:50:012 - [Xcode]
2021-12-24 16:29:50:014 - [debug] [WD Proxy] Got response with status 200: {"value":{"ELEMENT":"0E000000-0000-0000-DA7E-010000000000","element-6066-11e4-a52e-4f735466cecf":"0E000000-0000-0000-DA7E-010000000000"},"sessionId":"A4250843-A600-4C2A-BA7A-A5386622FDB1"}
2021-12-24 16:29:50:014 - [debug] [W3C (0b11dcf3)] Responding to client with driver.findElement() result: {"element-6066-11e4-a52e-4f735466cecf":"0E000000-0000-0000-DA7E-010000000000","ELEMENT":"0E000000-0000-0000-DA7E-010000000000"}
2021-12-24 16:29:50:015 - [HTTP] <-- POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element 200 104 ms - 137
2021-12-24 16:29:50:015 - [HTTP]
2021-12-24 16:29:50:016 - [HTTP] --> GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element/0E000000-0000-0000-DA7E-010000000000/displayed
2021-12-24 16:29:50:016 - [HTTP] {}
2021-12-24 16:29:50:017 - [W3C (0b11dcf3)] Driver proxy active, passing request on via HTTP proxy
2021-12-24 16:29:50:017 - [debug] [XCUITest] Executing command 'proxyReqRes'
2021-12-24 16:29:50:017 - [debug] [WD Proxy] Matched '/wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element/0E000000-0000-0000-DA7E-010000000000/displayed' to command name 'elementDisplayed'
2021-12-24 16:29:50:017 - [debug] [WD Proxy] Proxying [GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element/0E000000-0000-0000-DA7E-010000000000/displayed] to [GET http://127.0.0.1:8190/session/A4250843-A600-4C2A-BA7A-A5386622FDB1/element/0E000000-0000-0000-DA7E-010000000000/displayed] with no body
2021-12-24 16:29:50:019 - [Xcode] t = 19.58s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:50:019 - [Xcode]
2021-12-24 16:29:50:024 - [Xcode] t = 19.59s Find: Descendants matching type Button
2021-12-24 16:29:50:024 - [Xcode]
2021-12-24 16:29:50:024 - [Xcode] t = 19.59s Find: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:50:024 - [Xcode]
2021-12-24 16:29:50:024 - [Xcode] t = 19.59s Find: Identity Binding
2021-12-24 16:29:50:024 - [Xcode]
2021-12-24 16:29:50:130 - [debug] [WD Proxy] Got response with status 200: {"value":true,"sessionId":"A4250843-A600-4C2A-BA7A-A5386622FDB1"}
2021-12-24 16:29:50:130 - [WD Proxy] Replacing sessionId A4250843-A600-4C2A-BA7A-A5386622FDB1 with 0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8
2021-12-24 16:29:50:130 - [HTTP] <-- GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element/0E000000-0000-0000-DA7E-010000000000/displayed 200 114 ms - 65
2021-12-24 16:29:50:130 - [HTTP]
2021-12-24 16:29:50:131 - [HTTP] --> GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/context
2021-12-24 16:29:50:131 - [HTTP] {}
2021-12-24 16:29:50:131 - [debug] [W3C (0b11dcf3)] Calling AppiumDriver.getCurrentContext() with args: ["0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8"]
2021-12-24 16:29:50:131 - [debug] [XCUITest] Executing command 'getCurrentContext'
2021-12-24 16:29:50:132 - [debug] [W3C (0b11dcf3)] Responding to client with driver.getCurrentContext() result: "NATIVE_APP"
2021-12-24 16:29:50:132 - [HTTP] <-- GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/context 200 0 ms - 22
2021-12-24 16:29:50:132 - [HTTP]
2021-12-24 16:29:50:135 - [HTTP] --> POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element
2021-12-24 16:29:50:135 - [HTTP] {"using":"xpath","value":"/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up for free']"}
2021-12-24 16:29:50:135 - [debug] [W3C (0b11dcf3)] Calling AppiumDriver.findElement() with args: ["xpath","/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up for free']","0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8"]
2021-12-24 16:29:50:135 - [debug] [XCUITest] Executing command 'findElement'
2021-12-24 16:29:50:135 - [debug] [BaseDriver] Valid locator strategies for this request: xpath, id, name, class name, -ios predicate string, -ios class chain, accessibility id, css selector
2021-12-24 16:29:50:135 - [debug] [BaseDriver] Waiting up to 5000 ms for condition
2021-12-24 16:29:50:135 - [debug] [WD Proxy] Matched '/element' to command name 'findElement'
2021-12-24 16:29:50:135 - [debug] [WD Proxy] Proxying [POST /element] to [POST http://127.0.0.1:8190/session/A4250843-A600-4C2A-BA7A-A5386622FDB1/element] with body: {"using":"xpath","value":"/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up with MyPost']|//XCUIElementTypeButton[@Label='Sign up for free']"}
2021-12-24 16:29:50:137 - [Xcode] 2021-12-24 16:29:50.137680+1100 WebDriverAgentRunner-Runner[97991:4962725] Getting the most recent active application (out of 1 total items)
2021-12-24 16:29:50:137 - [Xcode]
2021-12-24 16:29:50:140 - [Xcode] 2021-12-24 16:29:50.140486+1100 WebDriverAgentRunner-Runner[97991:4962725] The following attributes were requested to be included into the XML: {(
2021-12-24 16:29:50:140 - [Xcode] FBLabelAttribute
2021-12-24 16:29:50:140 - [Xcode] )}
2021-12-24 16:29:50:140 - [Xcode]
2021-12-24 16:29:50:141 - [Xcode] t = 19.70s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:50:141 - [Xcode]
2021-12-24 16:29:50:179 - [Xcode] t = 19.74s Get all elements bound by accessibility element for: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:50:179 - [Xcode]
2021-12-24 16:29:50:180 - [Xcode] t = 19.74s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:50:181 - [Xcode]
2021-12-24 16:29:50:186 - [Xcode] t = 19.75s Find: Descendants matching type Button
2021-12-24 16:29:50:186 - [Xcode]
2021-12-24 16:29:50:186 - [Xcode] t = 19.75s Find: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:50:186 - [Xcode]
2021-12-24 16:29:50:190 - [Xcode] t = 19.75s Checking existence of "Sign up with MyPost" Button
2021-12-24 16:29:50:190 - [Xcode]
2021-12-24 16:29:50:190 - [Xcode] t = 19.75s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:50:190 - [Xcode]
2021-12-24 16:29:50:199 - [Xcode] t = 19.76s Find: Descendants matching type Button
2021-12-24 16:29:50:199 - [Xcode] t = 19.76s Find: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:50:199 - [Xcode] t = 19.76s Find: Identity Binding
2021-12-24 16:29:50:199 - [Xcode]
2021-12-24 16:29:50:200 - [debug] [WD Proxy] Got response with status 200: {"value":{"ELEMENT":"0E000000-0000-0000-DA7E-010000000000","element-6066-11e4-a52e-4f735466cecf":"0E000000-0000-0000-DA7E-010000000000"},"sessionId":"A4250843-A600-4C2A-BA7A-A5386622FDB1"}
2021-12-24 16:29:50:201 - [debug] [W3C (0b11dcf3)] Responding to client with driver.findElement() result: {"element-6066-11e4-a52e-4f735466cecf":"0E000000-0000-0000-DA7E-010000000000","ELEMENT":"0E000000-0000-0000-DA7E-010000000000"}
2021-12-24 16:29:50:201 - [HTTP] <-- POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element 200 66 ms - 137
2021-12-24 16:29:50:201 - [HTTP]
2021-12-24 16:29:50:204 - [HTTP] --> POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element/0E000000-0000-0000-DA7E-010000000000/click
2021-12-24 16:29:50:204 - [HTTP] {"id":"0E000000-0000-0000-DA7E-010000000000"}
2021-12-24 16:29:50:204 - [W3C (0b11dcf3)] Driver proxy active, passing request on via HTTP proxy
2021-12-24 16:29:50:204 - [debug] [XCUITest] Executing command 'proxyReqRes'
2021-12-24 16:29:50:204 - [debug] [WD Proxy] Matched '/wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element/0E000000-0000-0000-DA7E-010000000000/click' to command name 'click'
2021-12-24 16:29:50:204 - [debug] [WD Proxy] Proxying [POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element/0E000000-0000-0000-DA7E-010000000000/click] to [POST http://127.0.0.1:8190/session/A4250843-A600-4C2A-BA7A-A5386622FDB1/element/0E000000-0000-0000-DA7E-010000000000/click] with body: {"id":"0E000000-0000-0000-DA7E-010000000000"}
2021-12-24 16:29:50:206 - [Xcode] t = 19.77s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:50:206 - [Xcode]
2021-12-24 16:29:50:212 - [Xcode] t = 19.77s Find: Descendants matching type Button
2021-12-24 16:29:50:212 - [Xcode]
2021-12-24 16:29:50:213 - [Xcode] t = 19.78s Find: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:50:213 - [Xcode]
2021-12-24 16:29:50:213 - [Xcode] t = 19.78s Find: Identity Binding
2021-12-24 16:29:50:213 - [Xcode]
2021-12-24 16:29:50:222 - [Xcode] t = 19.78s Tap "Sign up with MyPost" Button
2021-12-24 16:29:50:222 - [Xcode] 2021-12-24 16:29:50.219764+1100 WebDriverAgentRunner-Runner[97991:4962725] Waiting up to 10s until com.auspost.mobile.develop is in idle state (including animations)
2021-12-24 16:29:50:222 - [Xcode] t = 19.78s Wait for com.auspost.mobile.develop to idle
2021-12-24 16:29:50:222 - [Xcode]
2021-12-24 16:29:50:223 - [Xcode] t = 19.78s Find the "Sign up with MyPost" Button
2021-12-24 16:29:50:223 - [Xcode] t = 19.79s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:50:224 - [Xcode]
2021-12-24 16:29:50:234 - [Xcode] t = 19.79s Find: Descendants matching type Button
2021-12-24 16:29:50:234 - [Xcode] t = 19.79s Find: Elements matching predicate 'wdUID IN {"0E000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:50:234 - [Xcode]
2021-12-24 16:29:50:234 - [Xcode] t = 19.79s Find: Identity Binding
2021-12-24 16:29:50:234 - [Xcode]
2021-12-24 16:29:50:235 - [Xcode] t = 19.79s Application is configured to skip UI interruption handling
2021-12-24 16:29:50:235 - [Xcode] t = 19.80s Synthesize event
2021-12-24 16:29:50:235 - [Xcode]
2021-12-24 16:29:50:312 - [Xcode] 2021-12-24 16:29:50.311872+1100 WebDriverAgentRunner-Runner[97991:4962725] Waiting up to 10s until com.auspost.mobile.develop is in idle state (including animations)
2021-12-24 16:29:50:312 - [Xcode]
2021-12-24 16:29:50:312 - [Xcode] t = 19.87s Wait for com.auspost.mobile.develop to idle
2021-12-24 16:29:50:312 - [Xcode]
2021-12-24 16:29:50:534 - [ffmpeg] ffmpeg version 4.4.1 Copyright (c) 2000-2021 the FFmpeg developers
2021-12-24 16:29:50:534 - [ffmpeg] built with Apple clang version 13.0.0 (clang-1300.0.29.3)
2021-12-24 16:29:50:534 - [ffmpeg] configuration: --prefix=/opt/homebrew/Cellar/ffmpeg/4.4.1_3 --enable-shared --enable-pthreads --enable-version3 --cc=clang --host-cflags= --host-ldflags= --enable-ffplay --enable-gnutls --enable-gpl --enable-libaom --enable-libbluray --enable-libdav1d --enable-libmp3lame --enable-libopus --enable-librav1e --enable-librist --enable-librubberband --enable-libsnappy --enable-libsrt --enable-libtesseract --enable-libtheora --enable-libvidstab --enable-libvmaf --enable-libvorbis --enable-libvpx --enable-libwebp --enable-libx264 --enable-libx265 --enable-libxml2 --enable-libxvid --enable-lzma --enable-libfontconfig --enable-libfreetype --enable-frei0r --enable-libass --enable-libopencore-amrnb --enable-libopencore-amrwb --enable-libopenjpeg --enable-libspeex --enable-libsoxr --enable-libzmq --enable-libzimg --disable-libjack --disable-indev=jack --enable-avresample --enable-videotoolbox
2021-12-24 16:29:50:534 - [ffmpeg]
2021-12-24 16:29:50:535 - [ffmpeg] libavutil 56. 70.100 / 56. 70.100
2021-12-24 16:29:50:535 - [ffmpeg] libavcodec 58.134.100 / 58.134.100
2021-12-24 16:29:50:535 - [ffmpeg] libavformat 58. 76.100 / 58. 76.100
2021-12-24 16:29:50:535 - [ffmpeg] libavdevice 58. 13.100 / 58. 13.100
2021-12-24 16:29:50:535 - [ffmpeg] libavfilter 7.110.100 / 7.110.100
2021-12-24 16:29:50:535 - [ffmpeg] libavresample 4. 0. 0 / 4. 0. 0
2021-12-24 16:29:50:535 - [ffmpeg] libswscale 5. 9.100 / 5. 9.100
2021-12-24 16:29:50:535 - [ffmpeg] libswresample 3. 9.100 / 3. 9.100
2021-12-24 16:29:50:535 - [ffmpeg] libpostproc 55. 9.100 / 55. 9.100
2021-12-24 16:29:50:535 - [ffmpeg]
2021-12-24 16:29:50:559 - [Xcode] 2021-12-24 16:29:50.559587+1100 WebDriverAgentRunner-Runner[97991:4963568] Got screenshots broadcast client connection at 127.0.0.1:60156
2021-12-24 16:29:50:559 - [Xcode]
2021-12-24 16:29:50:559 - [Xcode] 2021-12-24 16:29:50.559660+1100 WebDriverAgentRunner-Runner[97991:4962746] Starting screenshots broadcast for the client at 127.0.0.1:60156
2021-12-24 16:29:50:560 - [Xcode]
2021-12-24 16:29:51:362 - [debug] [WD Proxy] Got response with status 200: {"value":null,"sessionId":"A4250843-A600-4C2A-BA7A-A5386622FDB1"}
2021-12-24 16:29:51:364 - [WD Proxy] Replacing sessionId A4250843-A600-4C2A-BA7A-A5386622FDB1 with 0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8
2021-12-24 16:29:51:366 - [HTTP] <-- POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element/0E000000-0000-0000-DA7E-010000000000/click 200 1161 ms - 65
2021-12-24 16:29:51:366 - [HTTP]
2021-12-24 16:29:51:373 - [HTTP] --> GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/context
2021-12-24 16:29:51:373 - [HTTP] {}
2021-12-24 16:29:51:374 - [debug] [W3C (0b11dcf3)] Calling AppiumDriver.getCurrentContext() with args: ["0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8"]
2021-12-24 16:29:51:378 - [debug] [XCUITest] Executing command 'getCurrentContext'
2021-12-24 16:29:51:379 - [debug] [W3C (0b11dcf3)] Responding to client with driver.getCurrentContext() result: "NATIVE_APP"
2021-12-24 16:29:51:381 - [HTTP] <-- GET /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/context 200 8 ms - 22
2021-12-24 16:29:51:381 - [HTTP]
2021-12-24 16:29:51:389 - [HTTP] --> POST /wd/hub/session/0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8/element
2021-12-24 16:29:51:389 - [HTTP] {"using":"xpath","value":"/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeStaticText[@name='Title For Email Step']"}
2021-12-24 16:29:51:391 - [debug] [W3C (0b11dcf3)] Calling AppiumDriver.findElement() with args: ["xpath","/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeStaticText[@name='Title For Email Step']","0b11dcf3-d40d-4ec7-90e7-618c6d0ea0d8"]
2021-12-24 16:29:51:392 - [debug] [XCUITest] Executing command 'findElement'
2021-12-24 16:29:51:392 - [debug] [BaseDriver] Valid locator strategies for this request: xpath, id, name, class name, -ios predicate string, -ios class chain, accessibility id, css selector
2021-12-24 16:29:51:392 - [debug] [BaseDriver] Waiting up to 5000 ms for condition
2021-12-24 16:29:51:393 - [debug] [WD Proxy] Matched '/element' to command name 'findElement'
2021-12-24 16:29:51:393 - [debug] [WD Proxy] Proxying [POST /element] to [POST http://127.0.0.1:8190/session/A4250843-A600-4C2A-BA7A-A5386622FDB1/element] with body: {"using":"xpath","value":"/hierarchy//android.widget.Button[@text='Sign up with MyPost']|//XCUIElementTypeStaticText[@name='Title For Email Step']"}
2021-12-24 16:29:51:604 - [Xcode] 2021-12-24 16:29:51.603484+1100 WebDriverAgentRunner-Runner[97991:4962746] Error Domain=com.facebook.WebDriverAgent Code=1 "Cannot take a screenshot within 20000 ms timeout" UserInfo={NSLocalizedDescription=Cannot take a screenshot within 20000 ms timeout}
2021-12-24 16:29:51:604 - [Xcode]
2021-12-24 16:29:52:263 - [Xcode] 2021-12-24 16:29:52.259113+1100 WebDriverAgentRunner-Runner[97991:4962725] Getting the most recent active application (out of 1 total items)
2021-12-24 16:29:52:264 - [Xcode]
2021-12-24 16:29:52:268 - [Xcode] 2021-12-24 16:29:52.267615+1100 WebDriverAgentRunner-Runner[97991:4962725] The following attributes were requested to be included into the XML: {(
2021-12-24 16:29:52:268 - [Xcode] FBNameAttribute
2021-12-24 16:29:52:268 - [Xcode] )}
2021-12-24 16:29:52:268 - [Xcode]
2021-12-24 16:29:52:268 - [Xcode] t = 21.83s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:52:268 - [Xcode]
2021-12-24 16:29:52:611 - [Xcode] t = 22.17s Get all elements bound by accessibility element for: Elements matching predicate 'wdUID IN {"57000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:52:611 - [Xcode]
2021-12-24 16:29:52:612 - [Xcode] t = 22.17s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:52:612 - [Xcode]
2021-12-24 16:29:52:633 - [Xcode] t = 22.20s Find: Descendants matching type StaticText
2021-12-24 16:29:52:634 - [Xcode]
2021-12-24 16:29:52:635 - [Xcode] t = 22.20s Find: Elements matching predicate 'wdUID IN {"57000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:52:636 - [Xcode]
2021-12-24 16:29:52:646 - [Xcode] t = 22.21s Checking existence of "Title For Email Step" StaticText
2021-12-24 16:29:52:646 - [Xcode]
2021-12-24 16:29:52:647 - [Xcode] t = 22.21s Requesting snapshot of accessibility hierarchy for app with pid 98010
2021-12-24 16:29:52:647 - [Xcode]
2021-12-24 16:29:52:671 - [Xcode] t = 22.23s Find: Descendants matching type StaticText
2021-12-24 16:29:52:672 - [Xcode]
2021-12-24 16:29:52:672 - [Xcode] t = 22.23s Find: Elements matching predicate 'wdUID IN {"57000000-0000-0000-DA7E-010000000000"}'
2021-12-24 16:29:52:672 - [Xcode]
2021-12-24 16:29:52:673 - [Xcode] t = 22.23s Find: Identity Binding
2021-12-24 16:29:52:674 - [Xcode]
2021-12-24 16:29:52:677 - [Xcode] 2021-12-24 16:29:52.676093+1100 WebDriverAgentRunner-Runner[97991:4962746] Error Domain=com.facebook.WebDriverAgent Code=1 "Cannot take a screenshot within 20000 ms timeout" UserInfo={NSLocalizedDescription=Cannot take a screenshot within 20000 ms timeout}
@mykola-mokhnach
Copy link
Contributor

Only Apple can fix that. The screenshots retrieval is controlled by XCTest.

@n00bstr
Copy link
Author

n00bstr commented Feb 8, 2022

Just an update to this issue, I was using a simulator with iOS 14.0 under XCode 13. After switching to iOS 15.0, this issue is no longer appearing. Putting it here to help some people.

Closing this off.

@n00bstr n00bstr closed this as completed Feb 8, 2022
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment
Assignees
No one assigned
Labels
None yet
Projects
None yet
Milestone
No milestone
Development

No branches or pull requests
2 participants
@mykola-mokhnach @n00bstr