appium_logs

[Appium] Welcome to Appium v1.6.3
[Appium] Non-default server args:
[Appium]   address: 'localhost'
[Appium]   port: 4801
[Appium]   bootstrapPort: 8000
[Appium]   sessionOverride: true
[Appium]   nodeconfig: './androidConfig.json'
[Appium]   chromeDriverPort: 12345
[Appium]   defaultCommandTimeout: 7200
[Appium]   platformName: 'Android'
[Appium]   platformVersion: '6.0'
[Appium]   udid: '0715f7c4c56a0b36'
[Appium] Deprecated server args:
[Appium]   --platform-name => --default-capabilities '{"platformName":"Android"}'
[Appium]   --platform-version => --default-capabilities '{"platformVersion":"6.0"}'
[Appium]   -U,--udid => --default-capabilities '{"udid":"0715f7c4c56a0b36"}'
[Appium] Default capabilities, which will be added to each request unless overridden by desired capabilities:
[Appium]   platformName: 'Android'
[Appium]   platformVersion: '6.0'
[Appium]   udid: '0715f7c4c56a0b36'
[debug] [Appium] Starting auto register thread for grid. Will try to register every 5000 ms.
[Appium] Appium REST http interface listener started on localhost:4801
[debug] [Appium] Appium successfully registered with the grid on localhost:4444
[HTTP] --> GET /wd/hub/status {}
[debug] [MJSONWP] Calling AppiumDriver.getStatus() with args: []
[debug] [MJSONWP] Responding to client with driver.getStatus() result: {"build":{"version":"1.6.3","revision":null}}
[HTTP] <-- GET /wd/hub/status 200 37 ms - 83 
[HTTP] --> POST /wd/hub/session {"desiredCapabilities":{"rotatable":false,"nativeEvents":false,"newCommandTimeout":"300","platformVersion":"6.0","browserName":"chrome","takesScreenshot":true,"javascriptEnabled":true,"platformName":"android","version":"","deviceName":"0715f7c4c56a0b36","platform":"ANY","cssSelectorsEnabled":true}}
[debug] [MJSONWP] Calling AppiumDriver.createSession() with args: [{"rotatable":false,"nativeEvents":false,"newCommandTimeout":"300","platformVersion":"6.0","browserName":"chrome","takesScreenshot":true,"javascriptEnabled":true,"platformName":"android","version":"","deviceName":"0715f7c4c56a0b36","platform":"ANY","cssSelectorsEnabled":true},null,null,null,null]
[Appium] Creating new AndroidDriver session
[Appium] Capabilities:
[Appium]   rotatable: false
[Appium]   nativeEvents: false
[Appium]   newCommandTimeout: '300'
[Appium]   platformVersion: '6.0'
[Appium]   browserName: 'chrome'
[Appium]   takesScreenshot: true
[Appium]   javascriptEnabled: true
[Appium]   platformName: 'android'
[Appium]   version: ''
[Appium]   deviceName: '0715f7c4c56a0b36'
[Appium]   platform: 'ANY'
[Appium]   cssSelectorsEnabled: true
[Appium]   udid: '0715f7c4c56a0b36'
[debug] [AndroidDriver] AndroidDriver version: 1.10.38
[BaseDriver] Capability 'newCommandTimeout' changed from string ('300') to integer (300). This may cause unexpected behavior
[BaseDriver] The following capabilities were provided, but are not recognized by appium: rotatable, nativeEvents, takesScreenshot, javascriptEnabled, version, platform, cssSelectorsEnabled.
[BaseDriver] Session created with session id: 9c446ca2-3d59-4e26-ab23-285fb48b3353
[debug] [AndroidDriver] Getting Java version
[AndroidDriver] Java version is: 1.8.0_60
[AndroidDriver] We're going to run a Chrome-based session
[AndroidDriver] Chrome-type package and activity are com.android.chrome and com.google.android.apps.chrome.Main
[ADB] Checking whether adb is present
[ADB] Using adb from /Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb
[AndroidDriver] Retrieving device list
[debug] [ADB] Trying to find a connected android device
[debug] [ADB] Getting connected devices...
[HTTP] --> GET /wd/hub/status {}
[debug] [MJSONWP] Calling AppiumDriver.getStatus() with args: []
[debug] [ADB] 1 device(s) connected
[AndroidDriver] Using device: 0715f7c4c56a0b36
[ADB] Checking whether adb is present
[ADB] Using adb from /Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb
[debug] [ADB] Setting device id to 0715f7c4c56a0b36
[AndroidDriver] App file was not listed, instead we're going to run com.android.chrome directly on the device
[debug] [AndroidDriver] Checking whether package is present on the device
[debug] [ADB] Getting connected devices...
[debug] [ADB] 1 device(s) connected
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","shell","pm","list","packages","com.android.chrome"]
[AndroidDriver] Starting Android session
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","wait-for-device"]
[debug] [ADB] Getting connected devices...
[debug] [ADB] 1 device(s) connected
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","shell","echo","ping"]
[debug] [Logcat] Starting logcat capture
[debug] [AndroidDriver] Pushing settings apk to device...
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","install","/usr/local/lib/node_modules/appium/node_modules/io.appium.settings/bin/settings_apk-debug.apk"]
[debug] [AndroidDriver] Pushing unlock helper app to device...
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","install","/usr/local/lib/node_modules/appium/node_modules/appium-unlock/bin/unlock_apk-debug.apk"]
[ADB] Getting device platform version
[debug] [ADB] Getting connected devices...
[debug] [ADB] 1 device(s) connected
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","shell","getprop","ro.build.version.release"]
[debug] [ADB] Getting connected devices...
[debug] [ADB] 1 device(s) connected
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","shell","dumpsys","window"]
[AndroidDriver] Screen already unlocked, doing nothing
[AndroidDriver] No app sent in, not parsing package/activity
[debug] [AndroidDriver] No app capability. Assuming it is already on the device
[debug] [AndroidDriver] Running fast reset (stop and clear)
[debug] [ADB] Getting connected devices...
[debug] [ADB] 1 device(s) connected
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","shell","am","force-stop","com.android.chrome"]
[debug] [ADB] Getting connected devices...
[debug] [ADB] 1 device(s) connected
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","shell","pm","clear","com.android.chrome"]
[debug] [AndroidBootstrap] Watching for bootstrap disconnect
[debug] [ADB] Forwarding system: 8000 to device: 4724
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","forward","tcp:8000","tcp:4724"]
[debug] [UiAutomator] Starting UiAutomator
[debug] [UiAutomator] Moving to state 'starting'
[debug] [UiAutomator] Parsing uiautomator jar
[debug] [UiAutomator] Found jar name: 'AppiumBootstrap.jar'
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","push","/usr/local/lib/node_modules/appium/node_modules/appium-android-bootstrap/bootstrap/bin/AppiumBootstrap.jar","/data/local/tmp/"]
[debug] [ADB] Attempting to kill all uiautomator processes
[debug] [ADB] Getting all processes with uiautomator
[debug] [ADB] Getting connected devices...
[debug] [ADB] 1 device(s) connected
[debug] [ADB] Running '/Users/ericmurphy/Tools/android-sdk-macosx/platform-tools/adb' with args: ["-P",5037,"-s","0715f7c4c56a0b36","shell","ps"]
[ADB] No uiautomator process found to kill, continuing...
[debug] [UiAutomator] Starting UIAutomator
[debug] [ADB] Creating ADB subprocess with args: ["-P",5037,"-s","0715f7c4c56a0b36","shell","uiautomator","runtest","AppiumBootstrap.jar","-c","io.appium.android.bootstrap.Bootstrap","-e","pkg","com.android.chrome","-e","disableAndroidWatchers",false,"-e","acceptSslCerts",false]
[debug] [UiAutomator] Moving to state 'online'
[AndroidBootstrap] Android bootstrap socket is now connected
[AndroidDriver] Starting a chrome-based browser session
[debug] [Chromedriver] Changed state to 'starting'
[AndroidBootstrap] [BOOTSTRAP LOG] [debug] json loading complete.
[AndroidBootstrap] [BOOTSTRAP LOG] [debug] Registered crash watchers.
[AndroidBootstrap] [BOOTSTRAP LOG] [debug] Client connected
[Chromedriver] Set chromedriver binary as: /usr/local/lib/node_modules/appium/node_modules/appium-chromedriver/chromedriver/mac/chromedriver
[Chromedriver] Killing any old chromedrivers, running: pkill -15 -f "/usr/local/lib/node_modules/appium/node_modules/appium-chromedriver/chromedriver/mac/chromedriver.*--port=12345"
[Chromedriver] No old chromedrivers seemed to exist
[Chromedriver] Spawning chromedriver with: /usr/local/lib/node_modules/appium/node_modules/appium-chromedriver/chromedriver/mac/chromedriver --url-base=wd/hub --port=12345 --adb-port=5037
[Chromedriver] [STDOUT] Starting ChromeDriver 2.25.426935 (820a95b0b81d33e42712f9198c215f703412e1a1) on port 12345
Only local connections are allowed.
[debug] [JSONWP Proxy] Proxying [GET /status] to [GET http://127.0.0.1:12345/wd/hub/status] with no body
[debug] [JSONWP Proxy] Got response with status 200: "{\"sessionId\":\"\",\"status\":0,\"value\":{\"build\":{\"version\":\"alpha\"},\"os\":{\"arch\":\"x86_64\",\"name\":\"Mac OS X\",\"version\":\"10.12.1\"}}}"
[debug] [JSONWP Proxy] Proxying [POST /session] to [POST http://127.0.0.1:12345/wd/hub/session] with body: {"desiredCapabilities":{"chromeOptions":{"androidPackage":"com.android.chrome","androidDeviceSerial":"0715f7c4c56a0b36"}}}
[debug] [JSONWP Proxy] Got response with status 200: {"sessionId":"aadc3fc4ef968c830251d5e9cb1e21bc","status":0,"value":{"acceptSslCerts":true,"applicationCacheEnabled":false,"browserConnectionEnabled":false,"browserName":"chrome","chrome":{"chromedriverVersion":"2.25.426935 (820a95b0b81d33e42712f9198c215f703412e1a1)"},"cssSelectorsEnabled":true,"databaseEnabled":false,"handlesAlerts":true,"hasTouchScreen":true,"javascriptEnabled":true,"locationContextEnabled":true,"mobileEmulationEnabled":false,"nativeEvents":true,"pageLoadStrategy":"normal","platform":"ANDROID","rotatable":false,"takesHeapSnapshot":true,"takesScreenshot":true,"version":"54.0.2840.85","webStorageEnabled":true}}
[debug] [Chromedriver] Changed state to 'online'
[Appium] New AndroidDriver session created successfully, session 9c446ca2-3d59-4e26-ab23-285fb48b3353 added to master session list
[debug] [MJSONWP] Responding to client with driver.createSession() result: {"platform":"ANY","webStorageEnabled":false,"takesScreenshot":true,"javascriptEnabled":true,"databaseEnabled":false,"networkConnectionEnabled":true,"locationContextEnabled":false,"warnings":{},"desired":{"rotatable":false,"nativeEvents":false,"newCommandTimeout":300,"platformVersion":"6.0","browserName":"chrome","takesScreenshot":true,"javascriptEnabled":true,"platformName":"android","version":"","deviceName":"0715f7c4c56a0b36","platform":"ANY","cssSelectorsEnabled":true,"udid":"0715f7c4c56a0b36"},"rotatable":false,"nativeEvents":false,"newCommandTimeout":300,"platformVersion":"6.0.1","browserName":"chrome","platformName":"android","version":"","deviceName":"0715f7c4c56a0b36","cssSelectorsEnabled":true,"udid":"0715f7c4c56a0b36","deviceUDID":"0715f7c4c56a0b36"}
[HTTP] <-- POST /wd/hub/session 200 14779 ms - 842 
[debug] [MJSONWP] Responding to client with driver.getStatus() result: {"build":{"version":"1.6.3","revision":null}}
[HTTP] <-- GET /wd/hub/status 200 12727 ms - 83 
[HTTP] --> GET /wd/hub/status {}
[debug] [MJSONWP] Calling AppiumDriver.getStatus() with args: []
[debug] [MJSONWP] Responding to client with driver.getStatus() result: {"build":{"version":"1.6.3","revision":null}}
[HTTP] <-- GET /wd/hub/status 200 12 ms - 83