builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-059 starttime: 1506007186.73 results: success (0) revision: 62ccc71503a7ae4776aaa15c7b1d843562afd817 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:46.733027) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:46.734037) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:46.734316) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:46.789439) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:46.789720) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-21 08:19:46-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.3M=0s 2017-09-21 08:19:46 (46.3 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.081185 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:46.899661) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:46.899945) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020269 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:46.950696) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-09-21 08:19:46.951073) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 62ccc71503a7ae4776aaa15c7b1d843562afd817 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 62ccc71503a7ae4776aaa15c7b1d843562afd817 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-21 08:19:47,002 truncating revision to first 12 chars 2017-09-21 08:19:47,002 Setting DEBUG logging. 2017-09-21 08:19:47,002 attempt 1/10 2017-09-21 08:19:47,002 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/62ccc71503a7?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-21 08:19:48,314 unpacking tar archive at: mozilla-beta-62ccc71503a7/testing/mozharness/ program finished with exit code 0 elapsedTime=1.575334 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-09-21 08:19:48.541865) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:48.542166) ========= script_repo_revision: 62ccc71503a7ae4776aaa15c7b1d843562afd817 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:48.542540) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:48.542804) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-21 08:19:48.555572) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2017-09-21 08:19:48.555936) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Beta-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:19:48 INFO - MultiFileLogger online at 20170921 08:19:48 in /builds/slave/test 08:19:48 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta-Non-PGO 08:19:48 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:19:48 INFO - {'append_to_log': False, 08:19:48 INFO - 'base_work_dir': '/builds/slave/test', 08:19:48 INFO - 'blob_upload_branch': 'Mozilla-Beta-Non-PGO', 08:19:48 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:19:48 INFO - 'branch': 'Mozilla-Beta-Non-PGO', 08:19:48 INFO - 'buildbot_json_path': 'buildprops.json', 08:19:48 INFO - 'code_coverage': False, 08:19:48 INFO - 'config_files': ('talos/linux_config.py',), 08:19:48 INFO - 'default_actions': ('clobber', 08:19:48 INFO - 'read-buildbot-config', 08:19:48 INFO - 'download-and-extract', 08:19:48 INFO - 'populate-webroot', 08:19:48 INFO - 'create-virtualenv', 08:19:48 INFO - 'install', 08:19:48 INFO - 'setup-mitmproxy', 08:19:48 INFO - 'run-tests'), 08:19:48 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:19:48 INFO - 'disable_ccov_upload': False, 08:19:48 INFO - 'disable_stylo': False, 08:19:48 INFO - 'download_minidump_stackwalk': True, 08:19:48 INFO - 'download_symbols': 'ondemand', 08:19:48 INFO - 'enable_stylo': False, 08:19:48 INFO - 'enable_webrender': False, 08:19:48 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 08:19:48 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:19:48 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:19:48 INFO - 'gecko_profile': False, 08:19:48 INFO - 'gecko_profile_interval': 0, 08:19:48 INFO - 'installer_path': 'installer.exe', 08:19:48 INFO - 'log_level': 'info', 08:19:48 INFO - 'log_name': 'talos', 08:19:48 INFO - 'log_to_console': True, 08:19:48 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:19:48 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:19:48 INFO - 'opt_config_files': (), 08:19:48 INFO - 'pip_index': False, 08:19:48 INFO - 'suite': 'dromaeojs-e10s', 08:19:48 INFO - 'system_bits': '32', 08:19:48 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:19:48 INFO - 'title': 'talos-linux64-ix-059', 08:19:48 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:19:48 INFO - 'use_talos_json': True, 08:19:48 INFO - 'verify': 'False', 08:19:48 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:19:48 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:19:48 INFO - 'work_dir': 'build'} 08:19:48 INFO - [mozharness: 2017-09-21 15:19:48.749133Z] Running clobber step. 08:19:48 INFO - Running pre-action listener: _resource_record_pre_action 08:19:48 INFO - Running main action method: clobber 08:19:48 INFO - rmtree: /builds/slave/test/build 08:19:48 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:19:50 INFO - Running post-action listener: _resource_record_post_action 08:19:50 INFO - [mozharness: 2017-09-21 15:19:50.246296Z] Finished clobber step (success) 08:19:50 INFO - [mozharness: 2017-09-21 15:19:50.246393Z] Running read-buildbot-config step. 08:19:50 INFO - Running pre-action listener: _resource_record_pre_action 08:19:50 INFO - Running main action method: read_buildbot_config 08:19:50 INFO - Using buildbot properties: 08:19:50 INFO - { 08:19:50 INFO - "project": "", 08:19:50 INFO - "product": "firefox", 08:19:50 INFO - "who": "ffxbld@noreply.mozilla.org", 08:19:50 INFO - "installer_path": "public/build/target.tar.bz2", 08:19:50 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 08:19:50 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-beta", 08:19:50 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta talos dromaeojs-e10s", 08:19:50 INFO - "stage_platform": "linux64", 08:19:50 INFO - "basedir": "/builds/slave/test", 08:19:50 INFO - "buildnumber": 112, 08:19:50 INFO - "platform": "ubuntu64_hw", 08:19:50 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 08:19:50 INFO - "slavebuilddir": "test", 08:19:50 INFO - "taskId": "dv9ni4t7TJC7PinHexlu6g", 08:19:50 INFO - "branch": "mozilla-beta", 08:19:50 INFO - "script_repo_revision": "production", 08:19:50 INFO - "revision": "62ccc71503a7ae4776aaa15c7b1d843562afd817", 08:19:50 INFO - "slavename": "talos-linux64-ix-059", 08:19:50 INFO - "repo_path": "releases/mozilla-beta" 08:19:50 INFO - } 08:19:50 INFO - Finding installer, test and symbols from parent task. 08:19:50 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dv9ni4t7TJC7PinHexlu6g'}, attempt #1 08:19:50 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dv9ni4t7TJC7PinHexlu6g'}, attempt #1 08:19:51 INFO - Task dependencies: VSDIaYmzSnSLTWTcYt50dQ 08:19:51 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ'}, attempt #1 08:19:51 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.tar.bz2 08:19:51 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.test_packages.json 08:19:51 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.crashreporter-symbols.zip 08:19:51 INFO - Running post-action listener: _resource_record_post_action 08:19:51 INFO - [mozharness: 2017-09-21 15:19:51.599532Z] Finished read-buildbot-config step (success) 08:19:51 INFO - [mozharness: 2017-09-21 15:19:51.599750Z] Running download-and-extract step. 08:19:51 INFO - Running pre-action listener: _resource_record_pre_action 08:19:51 INFO - Running main action method: download_and_extract 08:19:51 INFO - mkdir: /builds/slave/test/build/tests 08:19:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:19:51 INFO - trying https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.test_packages.json 08:19:51 INFO - Downloading https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 08:19:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 08:19:52 INFO - Downloaded 989 bytes. 08:19:52 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 08:19:52 INFO - Using the following test package requirements: 08:19:52 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 08:19:52 INFO - u'common': [u'target.common.tests.zip'], 08:19:52 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 08:19:52 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 08:19:52 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 08:19:52 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 08:19:52 INFO - u'mozbase': [u'target.common.tests.zip'], 08:19:52 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 08:19:52 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 08:19:52 INFO - u'web-platform': [u'target.common.tests.zip', 08:19:52 INFO - u'target.web-platform.tests.tar.gz'], 08:19:52 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 08:19:52 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 08:19:52 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.common.tests.zip 08:19:52 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:19:52 INFO - Fetch https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.common.tests.zip into memory 08:19:53 INFO - Content-Length response header: 55177754 08:19:53 INFO - Bytes received: 55177754 08:20:04 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.talos.tests.zip 08:20:04 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 08:20:04 INFO - Fetch https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.talos.tests.zip into memory 08:20:05 INFO - Content-Length response header: 14509184 08:20:05 INFO - Bytes received: 14509184 08:20:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:05 INFO - trying https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.tar.bz2 08:20:05 INFO - Downloading https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 08:20:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 08:20:06 INFO - Downloaded 53500208 bytes. 08:20:06 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.tar.bz2 08:20:06 INFO - mkdir: /builds/slave/test/properties 08:20:06 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:20:06 INFO - Writing to file /builds/slave/test/properties/build_url 08:20:06 INFO - Contents: 08:20:06 INFO - build_url:https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.tar.bz2 08:20:06 INFO - Running post-action listener: _resource_record_post_action 08:20:06 INFO - Running post-action listener: find_tests_for_verification 08:20:06 INFO - Running post-action listener: set_extra_try_arguments 08:20:06 INFO - [mozharness: 2017-09-21 15:20:06.390804Z] Finished download-and-extract step (success) 08:20:06 INFO - [mozharness: 2017-09-21 15:20:06.390901Z] Running populate-webroot step. 08:20:06 INFO - Running pre-action listener: _resource_record_pre_action 08:20:06 INFO - Running main action method: populate_webroot 08:20:06 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:20:06 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['tresize', 08:20:06 INFO - 'tcanvasmark']}, 08:20:06 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:20:06 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['dromaeo_css', 08:20:06 INFO - 'kraken']}, 08:20:06 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:20:06 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:20:06 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'tests': ['damp', 'tps']}, 08:20:06 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['damp', 'tps']}, 08:20:06 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:20:06 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['dromaeo_dom']}, 08:20:06 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 08:20:06 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['basic_compositor_video', 08:20:06 INFO - 'glvideo']}, 08:20:06 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 08:20:06 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['ts_paint_webext', 08:20:06 INFO - 'tp5o_webext']}, 08:20:06 INFO - 'other-e10s': {'tests': ['a11yr', 08:20:06 INFO - 'ts_paint', 08:20:06 INFO - 'tpaint', 08:20:06 INFO - 'sessionrestore', 08:20:06 INFO - 'sessionrestore_many_windows', 08:20:06 INFO - 'sessionrestore_no_auto_restore', 08:20:06 INFO - 'tabpaint']}, 08:20:06 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['a11yr', 08:20:06 INFO - 'ts_paint', 08:20:06 INFO - 'tpaint', 08:20:06 INFO - 'sessionrestore', 08:20:06 INFO - 'sessionrestore_many_windows', 08:20:06 INFO - 'sessionrestore_no_auto_restore', 08:20:06 INFO - 'tabpaint']}, 08:20:06 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 08:20:06 INFO - 'perf-reftest-singletons-e10s': {'tests': ['perf_reftest_singletons']}, 08:20:06 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['perf_reftest_singletons']}, 08:20:06 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['bloom_basic']}, 08:20:06 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:20:06 INFO - 'tsvgr_opacity', 08:20:06 INFO - 'tart', 08:20:06 INFO - 'tscrollx', 08:20:06 INFO - 'tsvg_static']}, 08:20:06 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['tsvgx', 08:20:06 INFO - 'tsvgr_opacity', 08:20:06 INFO - 'tart', 08:20:06 INFO - 'tscrollx', 08:20:06 INFO - 'tsvg_static']}, 08:20:06 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:20:06 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'talos_options': ['--disable-stylo'], 08:20:06 INFO - 'tests': ['tp5o']}, 08:20:06 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 08:20:06 INFO - 'talos_options': ['--mitmproxy', 08:20:06 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 08:20:06 INFO - '--firstNonBlankPaint'], 08:20:06 INFO - 'tests': ['tp6_google', 08:20:06 INFO - 'tp6_youtube', 08:20:06 INFO - 'tp6_amazon', 08:20:06 INFO - 'tp6_facebook']}, 08:20:06 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 08:20:06 INFO - 'talos_options': ['--disable-stylo', 08:20:06 INFO - '--mitmproxy', 08:20:06 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 08:20:06 INFO - '--firstNonBlankPaint'], 08:20:06 INFO - 'tests': ['tp6_google', 08:20:06 INFO - 'tp6_youtube', 08:20:06 INFO - 'tp6_amazon', 08:20:06 INFO - 'tp6_facebook']}, 08:20:06 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 08:20:06 INFO - 'talos_options': ['--stylo-threads=1', 08:20:06 INFO - '--mitmproxy', 08:20:06 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 08:20:06 INFO - '--firstNonBlankPaint'], 08:20:06 INFO - 'tests': ['tp6_google', 08:20:06 INFO - 'tp6_youtube', 08:20:06 INFO - 'tp6_amazon', 08:20:06 INFO - 'tp6_facebook']}, 08:20:06 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'talos_options': ['--xperf_path', 08:20:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:20:06 INFO - 'tests': ['tp5n']}, 08:20:06 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 08:20:06 INFO - 'talos_options': ['--disable-stylo', 08:20:06 INFO - '--xperf_path', 08:20:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:20:06 INFO - 'tests': ['tp5n']}}} 08:20:06 INFO - Running post-action listener: _resource_record_post_action 08:20:06 INFO - [mozharness: 2017-09-21 15:20:06.405798Z] Finished populate-webroot step (success) 08:20:06 INFO - [mozharness: 2017-09-21 15:20:06.405887Z] Running create-virtualenv step. 08:20:06 INFO - Running pre-action listener: _resource_record_pre_action 08:20:06 INFO - Running main action method: create_virtualenv 08:20:06 INFO - Creating virtualenv /builds/slave/test/build/venv 08:20:06 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 08:20:06 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 08:20:06 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 08:20:06 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:20:06 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:20:07 INFO - Installing distribute.............................................................................................................................................................................................done. 08:20:08 INFO - Installing pip...............done. 08:20:08 INFO - Return code: 0 08:20:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:20:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:20:08 INFO - Reading from file tmpfile_stdout 08:20:08 INFO - Output received: 08:20:08 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 08:20:08 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:20:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 08:20:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 08:20:08 INFO - Using env: {'DISPLAY': ':0', 08:20:08 INFO - 'HOME': '/home/cltbld', 08:20:08 INFO - 'LANG': 'en_US.UTF-8', 08:20:08 INFO - 'LANGUAGE': 'en_US:en', 08:20:08 INFO - 'LOGNAME': 'cltbld', 08:20:08 INFO - 'MAIL': '/var/mail/cltbld', 08:20:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:08 INFO - 'MOZ_NO_REMOTE': '1', 08:20:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:08 INFO - 'NO_EM_RESTART': '1', 08:20:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:08 INFO - 'PWD': '/builds/slave/test', 08:20:08 INFO - 'SHELL': '/bin/bash', 08:20:08 INFO - 'SHLVL': '1', 08:20:08 INFO - 'TERM': 'linux', 08:20:08 INFO - 'TMOUT': '86400', 08:20:08 INFO - 'USER': 'cltbld', 08:20:08 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:08 INFO - '_': '/tools/buildbot/bin/python'} 08:20:09 INFO - Ignoring indexes: http://pypi.python.org/simple/ 08:20:09 INFO - Downloading/unpacking pip>=1.5 08:20:09 INFO - Running setup.py egg_info for package pip 08:20:09 INFO - warning: no files found matching 'pip/cacert.pem' 08:20:09 INFO - warning: no files found matching '*.html' under directory 'docs' 08:20:09 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 08:20:09 INFO - no previously-included directories found matching 'docs/_build/_sources' 08:20:09 INFO - Installing collected packages: pip 08:20:09 INFO - Found existing installation: pip 1.1 08:20:09 INFO - Uninstalling pip: 08:20:09 INFO - Successfully uninstalled pip 08:20:09 INFO - Running setup.py install for pip 08:20:09 INFO - warning: no files found matching 'pip/cacert.pem' 08:20:09 INFO - warning: no files found matching '*.html' under directory 'docs' 08:20:09 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 08:20:09 INFO - no previously-included directories found matching 'docs/_build/_sources' 08:20:09 INFO - Installing pip script to /builds/slave/test/build/venv/bin 08:20:09 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 08:20:09 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 08:20:09 INFO - Successfully installed pip 08:20:09 INFO - Cleaning up... 08:20:09 INFO - Return code: 0 08:20:09 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:20:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 08:20:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 08:20:09 INFO - Using env: {'DISPLAY': ':0', 08:20:09 INFO - 'HOME': '/home/cltbld', 08:20:09 INFO - 'LANG': 'en_US.UTF-8', 08:20:09 INFO - 'LANGUAGE': 'en_US:en', 08:20:09 INFO - 'LOGNAME': 'cltbld', 08:20:09 INFO - 'MAIL': '/var/mail/cltbld', 08:20:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:09 INFO - 'MOZ_NO_REMOTE': '1', 08:20:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:09 INFO - 'NO_EM_RESTART': '1', 08:20:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:09 INFO - 'PWD': '/builds/slave/test', 08:20:09 INFO - 'SHELL': '/bin/bash', 08:20:09 INFO - 'SHLVL': '1', 08:20:09 INFO - 'TERM': 'linux', 08:20:09 INFO - 'TMOUT': '86400', 08:20:09 INFO - 'USER': 'cltbld', 08:20:09 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:09 INFO - '_': '/tools/buildbot/bin/python'} 08:20:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:09 INFO - Downloading/unpacking psutil>=3.1.1 08:20:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:20:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:20:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:20:11 INFO - Installing collected packages: psutil 08:20:11 INFO - Running setup.py install for psutil 08:20:11 INFO - building 'psutil._psutil_linux' extension 08:20:11 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 08:20:11 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 08:20:11 INFO - building 'psutil._psutil_posix' extension 08:20:11 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 08:20:11 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 08:20:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:20:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:20:11 INFO - Successfully installed psutil 08:20:11 INFO - Cleaning up... 08:20:11 INFO - Return code: 0 08:20:11 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:20:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 08:20:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 08:20:11 INFO - Using env: {'DISPLAY': ':0', 08:20:11 INFO - 'HOME': '/home/cltbld', 08:20:11 INFO - 'LANG': 'en_US.UTF-8', 08:20:11 INFO - 'LANGUAGE': 'en_US:en', 08:20:11 INFO - 'LOGNAME': 'cltbld', 08:20:11 INFO - 'MAIL': '/var/mail/cltbld', 08:20:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:11 INFO - 'MOZ_NO_REMOTE': '1', 08:20:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:11 INFO - 'NO_EM_RESTART': '1', 08:20:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:11 INFO - 'PWD': '/builds/slave/test', 08:20:11 INFO - 'SHELL': '/bin/bash', 08:20:11 INFO - 'SHLVL': '1', 08:20:11 INFO - 'TERM': 'linux', 08:20:11 INFO - 'TMOUT': '86400', 08:20:11 INFO - 'USER': 'cltbld', 08:20:11 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:11 INFO - '_': '/tools/buildbot/bin/python'} 08:20:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:11 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:20:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:12 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:20:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:20:12 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:20:12 INFO - Installing collected packages: mozsystemmonitor 08:20:12 INFO - Running setup.py install for mozsystemmonitor 08:20:13 INFO - Successfully installed mozsystemmonitor 08:20:13 INFO - Cleaning up... 08:20:13 INFO - Return code: 0 08:20:13 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:20:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 08:20:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 08:20:13 INFO - Using env: {'DISPLAY': ':0', 08:20:13 INFO - 'HOME': '/home/cltbld', 08:20:13 INFO - 'LANG': 'en_US.UTF-8', 08:20:13 INFO - 'LANGUAGE': 'en_US:en', 08:20:13 INFO - 'LOGNAME': 'cltbld', 08:20:13 INFO - 'MAIL': '/var/mail/cltbld', 08:20:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:13 INFO - 'MOZ_NO_REMOTE': '1', 08:20:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:13 INFO - 'NO_EM_RESTART': '1', 08:20:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:13 INFO - 'PWD': '/builds/slave/test', 08:20:13 INFO - 'SHELL': '/bin/bash', 08:20:13 INFO - 'SHLVL': '1', 08:20:13 INFO - 'TERM': 'linux', 08:20:13 INFO - 'TMOUT': '86400', 08:20:13 INFO - 'USER': 'cltbld', 08:20:13 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:13 INFO - '_': '/tools/buildbot/bin/python'} 08:20:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:13 INFO - Downloading/unpacking jsonschema==2.5.1 08:20:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:15 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:20:15 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:20:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:15 INFO - Downloading functools32-3.2.3-2.tar.gz 08:20:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:20:15 INFO - warning: no files found matching '*.txt' 08:20:15 INFO - no previously-included directories found matching 'build' 08:20:15 INFO - no previously-included directories found matching 'dist' 08:20:15 INFO - no previously-included directories found matching '.git*' 08:20:15 INFO - Installing collected packages: jsonschema, functools32 08:20:15 INFO - Running setup.py install for functools32 08:20:15 INFO - warning: no files found matching '*.txt' 08:20:15 INFO - no previously-included directories found matching 'build' 08:20:15 INFO - no previously-included directories found matching 'dist' 08:20:15 INFO - no previously-included directories found matching '.git*' 08:20:15 INFO - Successfully installed jsonschema functools32 08:20:15 INFO - Cleaning up... 08:20:15 INFO - Return code: 0 08:20:15 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:20:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 08:20:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 08:20:15 INFO - Using env: {'DISPLAY': ':0', 08:20:15 INFO - 'HOME': '/home/cltbld', 08:20:15 INFO - 'LANG': 'en_US.UTF-8', 08:20:15 INFO - 'LANGUAGE': 'en_US:en', 08:20:15 INFO - 'LOGNAME': 'cltbld', 08:20:15 INFO - 'MAIL': '/var/mail/cltbld', 08:20:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:15 INFO - 'MOZ_NO_REMOTE': '1', 08:20:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:15 INFO - 'NO_EM_RESTART': '1', 08:20:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:15 INFO - 'PWD': '/builds/slave/test', 08:20:15 INFO - 'SHELL': '/bin/bash', 08:20:15 INFO - 'SHLVL': '1', 08:20:15 INFO - 'TERM': 'linux', 08:20:15 INFO - 'TMOUT': '86400', 08:20:15 INFO - 'USER': 'cltbld', 08:20:15 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:15 INFO - '_': '/tools/buildbot/bin/python'} 08:20:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:15 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:20:15 INFO - Cleaning up... 08:20:15 INFO - Return code: 0 08:20:15 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:20:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:20:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:20:15 INFO - Using env: {'DISPLAY': ':0', 08:20:15 INFO - 'HOME': '/home/cltbld', 08:20:15 INFO - 'LANG': 'en_US.UTF-8', 08:20:15 INFO - 'LANGUAGE': 'en_US:en', 08:20:15 INFO - 'LOGNAME': 'cltbld', 08:20:15 INFO - 'MAIL': '/var/mail/cltbld', 08:20:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:15 INFO - 'MOZ_NO_REMOTE': '1', 08:20:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:15 INFO - 'NO_EM_RESTART': '1', 08:20:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:15 INFO - 'PWD': '/builds/slave/test', 08:20:15 INFO - 'SHELL': '/bin/bash', 08:20:15 INFO - 'SHLVL': '1', 08:20:15 INFO - 'TERM': 'linux', 08:20:15 INFO - 'TMOUT': '86400', 08:20:15 INFO - 'USER': 'cltbld', 08:20:15 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:15 INFO - '_': '/tools/buildbot/bin/python'} 08:20:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:16 INFO - Downloading/unpacking blobuploader==1.2.4 08:20:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:17 INFO - Downloading blobuploader-1.2.4.tar.gz 08:20:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:20:17 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:20:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:20:17 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:20:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:17 INFO - Downloading docopt-0.6.1.tar.gz 08:20:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:20:17 INFO - Installing collected packages: blobuploader, requests, docopt 08:20:17 INFO - Running setup.py install for blobuploader 08:20:17 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:20:17 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:20:17 INFO - Running setup.py install for requests 08:20:18 INFO - Running setup.py install for docopt 08:20:18 INFO - Successfully installed blobuploader requests docopt 08:20:18 INFO - Cleaning up... 08:20:18 INFO - Return code: 0 08:20:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:20:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:20:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:20:18 INFO - Using env: {'DISPLAY': ':0', 08:20:18 INFO - 'HOME': '/home/cltbld', 08:20:18 INFO - 'LANG': 'en_US.UTF-8', 08:20:18 INFO - 'LANGUAGE': 'en_US:en', 08:20:18 INFO - 'LOGNAME': 'cltbld', 08:20:18 INFO - 'MAIL': '/var/mail/cltbld', 08:20:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:18 INFO - 'MOZ_NO_REMOTE': '1', 08:20:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:18 INFO - 'NO_EM_RESTART': '1', 08:20:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:18 INFO - 'PWD': '/builds/slave/test', 08:20:18 INFO - 'SHELL': '/bin/bash', 08:20:18 INFO - 'SHLVL': '1', 08:20:18 INFO - 'TERM': 'linux', 08:20:18 INFO - 'TMOUT': '86400', 08:20:18 INFO - 'USER': 'cltbld', 08:20:18 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:18 INFO - '_': '/tools/buildbot/bin/python'} 08:20:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:20:18 INFO - Running setup.py (path:/tmp/pip-oyCyBc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:20:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:20:18 INFO - Running setup.py (path:/tmp/pip-QZNs_3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:20:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:20:18 INFO - Running setup.py (path:/tmp/pip-fHnSD_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:20:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:20:18 INFO - Running setup.py (path:/tmp/pip-__zQYB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:20:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:20:18 INFO - Running setup.py (path:/tmp/pip-IMbkUf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:20:19 INFO - Running setup.py (path:/tmp/pip-Z3SMq4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:20:19 INFO - Running setup.py (path:/tmp/pip-LwqnUS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:20:19 INFO - Running setup.py (path:/tmp/pip-Fdwvwt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:20:19 INFO - Running setup.py (path:/tmp/pip-uN6Vs0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:20:19 INFO - Running setup.py (path:/tmp/pip-Q2bDPh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:20:19 INFO - Running setup.py (path:/tmp/pip-FwzIlX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:20:19 INFO - Running setup.py (path:/tmp/pip-y3Wvo9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:20:19 INFO - Running setup.py (path:/tmp/pip-sTaWwd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:20:19 INFO - Running setup.py (path:/tmp/pip-wQKtAl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:20:19 INFO - Running setup.py (path:/tmp/pip-roDu24-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:20:19 INFO - Running setup.py (path:/tmp/pip-_WaTdr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:20:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:20:19 INFO - Running setup.py (path:/tmp/pip-MRB7kv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:20:19 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:20:19 INFO - Running setup.py install for manifestparser 08:20:19 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:20:19 INFO - Running setup.py install for mozcrash 08:20:20 INFO - Running setup.py install for mozdebug 08:20:20 INFO - Running setup.py install for mozdevice 08:20:20 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Running setup.py install for mozfile 08:20:20 INFO - Running setup.py install for mozhttpd 08:20:20 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Running setup.py install for mozinfo 08:20:20 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Running setup.py install for mozInstall 08:20:20 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Running setup.py install for mozleak 08:20:20 INFO - Running setup.py install for mozlog 08:20:20 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Running setup.py install for moznetwork 08:20:20 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:20:20 INFO - Running setup.py install for mozprocess 08:20:21 INFO - Running setup.py install for mozprofile 08:20:21 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:20:21 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:20:21 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:20:21 INFO - Running setup.py install for mozrunner 08:20:21 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:20:21 INFO - Running setup.py install for mozscreenshot 08:20:21 INFO - Running setup.py install for moztest 08:20:21 INFO - Running setup.py install for mozversion 08:20:21 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:20:21 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:20:21 INFO - Cleaning up... 08:20:21 INFO - Return code: 0 08:20:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:20:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:20:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:20:21 INFO - Using env: {'DISPLAY': ':0', 08:20:21 INFO - 'HOME': '/home/cltbld', 08:20:21 INFO - 'LANG': 'en_US.UTF-8', 08:20:21 INFO - 'LANGUAGE': 'en_US:en', 08:20:21 INFO - 'LOGNAME': 'cltbld', 08:20:21 INFO - 'MAIL': '/var/mail/cltbld', 08:20:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:21 INFO - 'MOZ_NO_REMOTE': '1', 08:20:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:21 INFO - 'NO_EM_RESTART': '1', 08:20:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:21 INFO - 'PWD': '/builds/slave/test', 08:20:21 INFO - 'SHELL': '/bin/bash', 08:20:21 INFO - 'SHLVL': '1', 08:20:21 INFO - 'TERM': 'linux', 08:20:21 INFO - 'TMOUT': '86400', 08:20:21 INFO - 'USER': 'cltbld', 08:20:21 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:21 INFO - '_': '/tools/buildbot/bin/python'} 08:20:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:20:21 INFO - Running setup.py (path:/tmp/pip-HRi3bn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:20:21 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:20:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:20:21 INFO - Running setup.py (path:/tmp/pip-sJz9RM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:20:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:20:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:20:21 INFO - Running setup.py (path:/tmp/pip-siiZok-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:20:22 INFO - Running setup.py (path:/tmp/pip-ZRwOEF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:20:22 INFO - Running setup.py (path:/tmp/pip-qdh0es-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:20:22 INFO - Running setup.py (path:/tmp/pip-9ZlmZF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:20:22 INFO - Running setup.py (path:/tmp/pip-H4S9uf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:20:22 INFO - Running setup.py (path:/tmp/pip-eV1KwA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:20:22 INFO - Running setup.py (path:/tmp/pip-LpdVY1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:20:22 INFO - Running setup.py (path:/tmp/pip-LYC2GY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:20:22 INFO - Running setup.py (path:/tmp/pip-7aVeh8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:20:22 INFO - Running setup.py (path:/tmp/pip-cOYdnG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:20:22 INFO - Running setup.py (path:/tmp/pip-RCo0vk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:20:22 INFO - Running setup.py (path:/tmp/pip-x_9FkN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:20:22 INFO - Running setup.py (path:/tmp/pip-SaIOrf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:20:22 INFO - Running setup.py (path:/tmp/pip-rBSMNA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:20:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:20:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:20:22 INFO - Running setup.py (path:/tmp/pip-lOlAGF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:20:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:20:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:20:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:20:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:20:23 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:20:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:20:23 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 08:20:23 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:20:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:24 INFO - Downloading blessings-1.6.tar.gz 08:20:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:20:24 INFO - Installing collected packages: blessings 08:20:24 INFO - Running setup.py install for blessings 08:20:24 INFO - Successfully installed blessings 08:20:24 INFO - Cleaning up... 08:20:24 INFO - Return code: 0 08:20:24 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:20:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:20:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:20:24 INFO - Reading from file tmpfile_stdout 08:20:24 INFO - Current package versions: 08:20:24 INFO - argparse == 1.2.1 08:20:24 INFO - blessings == 1.6 08:20:24 INFO - blobuploader == 1.2.4 08:20:24 INFO - docopt == 0.6.1 08:20:24 INFO - functools32 == 3.2.3-2 08:20:24 INFO - jsonschema == 2.5.1 08:20:24 INFO - manifestparser == 1.1 08:20:24 INFO - mozInstall == 1.13 08:20:24 INFO - mozcrash == 1.0 08:20:24 INFO - mozdebug == 0.1 08:20:24 INFO - mozdevice == 0.51 08:20:24 INFO - mozfile == 1.2 08:20:24 INFO - mozhttpd == 0.7 08:20:24 INFO - mozinfo == 0.10 08:20:24 INFO - mozleak == 0.1 08:20:24 INFO - mozlog == 3.5 08:20:24 INFO - moznetwork == 0.27 08:20:24 INFO - mozprocess == 0.25 08:20:24 INFO - mozprofile == 0.28 08:20:24 INFO - mozrunner == 6.13 08:20:24 INFO - mozscreenshot == 0.1 08:20:24 INFO - mozsystemmonitor == 0.3 08:20:24 INFO - moztest == 0.8 08:20:24 INFO - mozversion == 1.4 08:20:24 INFO - psutil == 3.1.1 08:20:24 INFO - requests == 1.2.3 08:20:24 INFO - wsgiref == 0.1.2 08:20:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:20:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:24 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 08:20:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:20:24 INFO - Using env: {'DISPLAY': ':0', 08:20:24 INFO - 'HOME': '/home/cltbld', 08:20:24 INFO - 'LANG': 'en_US.UTF-8', 08:20:24 INFO - 'LANGUAGE': 'en_US:en', 08:20:24 INFO - 'LOGNAME': 'cltbld', 08:20:24 INFO - 'MAIL': '/var/mail/cltbld', 08:20:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:24 INFO - 'MOZ_NO_REMOTE': '1', 08:20:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:24 INFO - 'NO_EM_RESTART': '1', 08:20:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:24 INFO - 'PWD': '/builds/slave/test', 08:20:24 INFO - 'SHELL': '/bin/bash', 08:20:24 INFO - 'SHLVL': '1', 08:20:24 INFO - 'TERM': 'linux', 08:20:24 INFO - 'TMOUT': '86400', 08:20:24 INFO - 'USER': 'cltbld', 08:20:24 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:24 INFO - '_': '/tools/buildbot/bin/python'} 08:20:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 08:20:24 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 08:20:24 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 08:20:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:20:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:20:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 08:20:26 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:20:26 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:20:26 INFO - Installing collected packages: simplejson 08:20:26 INFO - Running setup.py install for simplejson 08:20:26 INFO - building 'simplejson._speedups' extension 08:20:26 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 08:20:26 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 08:20:27 INFO - Successfully installed simplejson 08:20:27 INFO - Cleaning up... 08:20:27 INFO - Return code: 0 08:20:27 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:20:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:20:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:20:27 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f891f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2151a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22f4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:20:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 08:20:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 08:20:27 INFO - Using env: {'DISPLAY': ':0', 08:20:27 INFO - 'HOME': '/home/cltbld', 08:20:27 INFO - 'LANG': 'en_US.UTF-8', 08:20:27 INFO - 'LANGUAGE': 'en_US:en', 08:20:27 INFO - 'LOGNAME': 'cltbld', 08:20:27 INFO - 'MAIL': '/var/mail/cltbld', 08:20:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:27 INFO - 'MOZ_NO_REMOTE': '1', 08:20:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:27 INFO - 'NO_EM_RESTART': '1', 08:20:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:27 INFO - 'PWD': '/builds/slave/test', 08:20:27 INFO - 'SHELL': '/bin/bash', 08:20:27 INFO - 'SHLVL': '1', 08:20:27 INFO - 'TERM': 'linux', 08:20:27 INFO - 'TMOUT': '86400', 08:20:27 INFO - 'USER': 'cltbld', 08:20:27 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:27 INFO - '_': '/tools/buildbot/bin/python'} 08:20:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:20:27 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:20:27 INFO - Cleaning up... 08:20:27 INFO - Return code: 0 08:20:27 INFO - Running post-action listener: _resource_record_post_action 08:20:27 INFO - Running post-action listener: _start_resource_monitoring 08:20:27 INFO - Starting resource monitoring. 08:20:27 INFO - [mozharness: 2017-09-21 15:20:27.327407Z] Finished create-virtualenv step (success) 08:20:27 INFO - [mozharness: 2017-09-21 15:20:27.327876Z] Running install step. 08:20:27 INFO - Running pre-action listener: _resource_record_pre_action 08:20:27 INFO - Running main action method: install 08:20:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:20:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:20:27 INFO - Reading from file tmpfile_stdout 08:20:27 INFO - Detecting whether we're running mozinstall >=1.0... 08:20:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:20:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:20:27 INFO - Reading from file tmpfile_stdout 08:20:27 INFO - Output received: 08:20:27 INFO - Usage: mozinstall [options] installer 08:20:27 INFO - Options: 08:20:27 INFO - -h, --help show this help message and exit 08:20:27 INFO - -d DEST, --destination=DEST 08:20:27 INFO - Directory to install application into. [default: 08:20:27 INFO - "/builds/slave/test"] 08:20:27 INFO - --app=APP Application being installed. [default: firefox] 08:20:27 INFO - mkdir: /builds/slave/test/build/application 08:20:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:20:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 08:20:42 INFO - Reading from file tmpfile_stdout 08:20:42 INFO - Output received: 08:20:42 INFO - /builds/slave/test/build/application/firefox/firefox 08:20:42 INFO - Running post-action listener: _resource_record_post_action 08:20:42 INFO - [mozharness: 2017-09-21 15:20:42.277563Z] Finished install step (success) 08:20:42 INFO - [mozharness: 2017-09-21 15:20:42.277761Z] Running setup-mitmproxy step. 08:20:42 INFO - Running pre-action listener: _resource_record_pre_action 08:20:42 INFO - Running main action method: setup_mitmproxy 08:20:42 INFO - Skipping: mitmproxy is not required 08:20:42 INFO - Running post-action listener: _resource_record_post_action 08:20:42 INFO - [mozharness: 2017-09-21 15:20:42.278285Z] Finished setup-mitmproxy step (success) 08:20:42 INFO - [mozharness: 2017-09-21 15:20:42.278388Z] Running run-tests step. 08:20:42 INFO - Running pre-action listener: _resource_record_pre_action 08:20:42 INFO - Running pre-action listener: _set_gcov_prefix 08:20:42 INFO - Running main action method: run_tests 08:20:42 WARNING - Try message not found. 08:20:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:20:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:20:42 INFO - Python 2.7.3 08:20:42 INFO - Return code: 0 08:20:42 INFO - grabbing minidump binary from tooltool 08:20:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:20:42 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8090>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22f8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22f2f90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:20:42 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 08:20:42 INFO - Copy/paste: /tools/tooltool.py --url https://tooltool.mozilla-releng.net/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 08:20:42 INFO - Calling ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 08:20:42 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:20:42 INFO - Return code: 0 08:20:42 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:20:42 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:20:42 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:20:42 INFO - ENV: RUST_BACKTRACE is now full 08:20:42 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:20:42 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:20:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-059', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 08:20:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-059 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 08:20:42 INFO - Using env: {'DISPLAY': ':0', 08:20:42 INFO - 'HOME': '/home/cltbld', 08:20:42 INFO - 'LANG': 'en_US.UTF-8', 08:20:42 INFO - 'LANGUAGE': 'en_US:en', 08:20:42 INFO - 'LOGNAME': 'cltbld', 08:20:42 INFO - 'MAIL': '/var/mail/cltbld', 08:20:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:20:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:20:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:42 INFO - 'MOZ_NO_REMOTE': '1', 08:20:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:20:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:42 INFO - 'NO_EM_RESTART': '1', 08:20:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:42 INFO - 'PWD': '/builds/slave/test', 08:20:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:20:42 INFO - 'RUST_BACKTRACE': 'full', 08:20:42 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 08:20:42 INFO - 'SHELL': '/bin/bash', 08:20:42 INFO - 'SHLVL': '1', 08:20:42 INFO - 'TERM': 'linux', 08:20:42 INFO - 'TMOUT': '86400', 08:20:42 INFO - 'USER': 'cltbld', 08:20:42 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:42 INFO - '_': '/tools/buildbot/bin/python'} 08:20:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-059', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 08:20:42 INFO - mozversion application_buildid: 20170921140233 08:20:42 INFO - mozversion application_changeset: 62ccc71503a7ae4776aaa15c7b1d843562afd817 08:20:42 INFO - mozversion application_display_name: Firefox 08:20:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:20:42 INFO - mozversion application_name: Firefox 08:20:42 INFO - mozversion application_remotingname: firefox 08:20:42 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 08:20:42 INFO - mozversion application_vendor: Mozilla 08:20:42 INFO - mozversion application_version: 57.0 08:20:42 INFO - mozversion platform_buildid: 20170921140233 08:20:42 INFO - mozversion platform_changeset: 62ccc71503a7ae4776aaa15c7b1d843562afd817 08:20:42 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 08:20:42 INFO - mozversion platform_version: 57.0 08:20:42 INFO - using testdate: 1506007242 08:20:42 INFO - actual date: 1506007242 08:20:42 INFO - starting webserver on 'localhost:56423' 08:20:42 INFO - SUITE-START | Running 2 tests 08:20:42 INFO - TEST-START | dromaeo_css 08:20:42 INFO - Initialising browser for dromaeo_css test... 08:20:42 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:56423/getInfo.html -profile /tmp/tmpHnJr5b/profile 08:20:42 INFO - TEST-INFO | started process 8407 (/builds/slave/test/build/application/firefox/firefox http://localhost:56423/getInfo.html) 08:20:47 INFO - TEST-INFO | 8407: exit 0 08:20:47 INFO - Browser initialized. 08:20:47 INFO - Running cycle 1/1 for dromaeo_css test... 08:20:47 INFO - Using env: {'DISPLAY': ':0', 08:20:47 INFO - 'HOME': '/home/cltbld', 08:20:47 INFO - 'JSGC_DISABLE_POISONING': '1', 08:20:47 INFO - 'LANG': 'en_US.UTF-8', 08:20:47 INFO - 'LANGUAGE': 'en_US:en', 08:20:47 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 08:20:47 INFO - 'LOGNAME': 'cltbld', 08:20:47 INFO - 'MAIL': '/var/mail/cltbld', 08:20:47 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:20:47 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:20:47 INFO - 'MOZ_CRASHREPORTER': '1', 08:20:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:20:47 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 08:20:47 INFO - 'MOZ_NO_REMOTE': '1', 08:20:47 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:20:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:20:47 INFO - 'NO_EM_RESTART': '1', 08:20:47 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:20:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:20:47 INFO - 'PWD': '/builds/slave/test', 08:20:47 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:20:47 INFO - 'RUST_BACKTRACE': 'full', 08:20:47 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 08:20:47 INFO - 'SHELL': '/bin/bash', 08:20:47 INFO - 'SHLVL': '1', 08:20:47 INFO - 'TERM': 'linux', 08:20:47 INFO - 'TMOUT': '86400', 08:20:47 INFO - 'USER': 'cltbld', 08:20:47 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:20:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:20:47 INFO - '_': '/tools/buildbot/bin/python'} 08:20:47 INFO - TEST-INFO | started process 8593 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHnJr5b/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 08:20:58 INFO - PID 8593 | RSS: Main: 146845696 08:20:58 INFO - PID 8593 | 08:23:55 INFO - PID 8593 | Cycle 1(1): loaded http://localhost:56423/tests/dromaeo/cssquery-dojo.html (next: http://localhost:56423/tests/dromaeo/cssquery-ext.html) 08:23:56 INFO - PID 8593 | RSS: Main: 149151744 08:23:56 INFO - PID 8593 | 08:26:58 INFO - PID 8593 | Cycle 1(1): loaded http://localhost:56423/tests/dromaeo/cssquery-ext.html (next: http://localhost:56423/tests/dromaeo/cssquery-jquery.html) 08:26:58 INFO - PID 8593 | RSS: Main: 147894272 08:26:58 INFO - PID 8593 | 08:30:00 INFO - PID 8593 | Cycle 1(1): loaded http://localhost:56423/tests/dromaeo/cssquery-jquery.html (next: http://localhost:56423/tests/dromaeo/cssquery-mootools.html) 08:30:01 INFO - PID 8593 | RSS: Main: 148430848 08:30:01 INFO - PID 8593 | 08:33:02 INFO - PID 8593 | Cycle 1(1): loaded http://localhost:56423/tests/dromaeo/cssquery-mootools.html (next: http://localhost:56423/tests/dromaeo/cssquery-prototype.html) 08:33:03 INFO - PID 8593 | RSS: Main: 148254720 08:33:03 INFO - PID 8593 | 08:36:06 INFO - PID 8593 | Cycle 1(1): loaded http://localhost:56423/tests/dromaeo/cssquery-prototype.html (next: http://localhost:56423/tests/dromaeo/cssquery-yui.html) 08:36:06 INFO - PID 8593 | RSS: Main: 149618688 08:36:06 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | Cycle 1(1): loaded http://localhost:56423/tests/dromaeo/cssquery-yui.html (next: http://localhost:56423/tests/dromaeo/cssquery-dojo.html) 08:39:08 INFO - PID 8593 | RSS: Main: 153059328 08:39:08 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | __start_tp_report 08:39:08 INFO - PID 8593 | _x_x_mozilla_page_load 08:39:08 INFO - PID 8593 | _x_x_mozilla_page_load_details 08:39:08 INFO - PID 8593 | |i|pagename|runs| 08:39:08 INFO - PID 8593 | |0;dojo.html;3984.0637450199206;3986.282469155552;4000;4007.5591684914634;4039.2931237033513;6474.352564743529;6476.384743449365;6534.085228068068;6548.9672551637295;6595.076689263495;6475.158229430168;6483.1571895653615;6567.376099270574;6573.211214654249;6576.96711516443;5791.7972870949525;5859.384764599709;5905.822825315247;5922.851928701773;5947.970260148693;5828.591998560102;5844.123381492789;5887.8528036799;5891.88216235675;5909.911351329733;5882.5588080893895;5977.432143946318;5984.251968503937;5988.191594134802;5995.6102853314615;5851;5862.794802181925;5863.442972917566;5866.73599688015;5930.525557955375;5713.371529131792;5755.597108202427;5764.308283006024;5766.250387449647;5805.129230615399;6409.775657851953;6411.487081033506;6435.292117867031;6473.352664733536;6474.125992990933;6977.1278590176225;6992.825179370506;7061.187963384225;7074;7081.858362832766;7018.403435707971;7033.8944915826305;7042.859142817166;7087.8228044298785;7125;6435.227772667263;6485.740570377179;6490.318516555741;6510.479161667103;6583.012548117821;7168.784936451915;7203.819904502429;7233.240509746401;7247.855042899218;7311.93976873361;6944.826379340557;6960.095187625678;6960.164780226405;7004.754833580902;7051.471139664443;6970.268121847234;7035.33164349386;7076.0801095857205;7155.3202445767565;7185.53294035886;6945.131858517685;6989.89515157273;6995.335443132894;7015.824604384931;7027.227005029443;6991.440684745208;6994.720211191597;7015.89476157858;7051.717931282691;7084.539504932163;5218.269442278084;5225;5238.73806309683;5272.868178295496;5283.9471605284225;4770.332153498513;4807.302941073524;4813.253945638432;4818.68678535901;4867.440244371872;6452.516061295421;6459.644719540376;6529.836754081186;6539.509536784665;6540.345965403421;7001.614911179832;7003.089598352181;7042.718291268395;7084.2915708428745;7100.5029647925185;6380.851446739632;6479.514036447191;6496.512761542903;6508.349165083454;6528.151340325728;5884.764609415661;5943.702814859326;5999.520038396918;6015.54883383748;6030.698465076729;7185;7221.31397517235;7239.74660886877;7283.3809126223805;7372.262773722692;6959.6868140933775;7016.824579385556;7017.929820701932;7060;7071.858562828817;7296.854062918818;7311.701805057715;7317;7371.078615173104;7403;6885.139357580302;6932;6950.096487456598;7024.1571011478945;7024.5082844200415;7031.156261248683;7060;7068.257832927468;7068.434525238072;7093.042439270633;6752.358525940028;6792.626405547742;6827.283135270924;6831.214410342675;6835.350641689031;6759;6837.076994605664;6855.520113592001;6870.587764734132;6887.311268873273;6696.732130714717;6710.261871194067;6777.254502004677;6777.695003724745;6792.456603471612;6724.7646332378135;6833.863322733617;6904;6914.723411063501;6916.170059592881;6602.702878370389;6672.799816005528;6693.263740988585;6753.831154221184;6768.932310677027 08:39:08 INFO - PID 8593 | |1;ext.html;941.5904081724454;967.086103632068;994.8706668133143;1006.4967516241879;1009.4347165587271;43811.342829857575;45476.3178552322;45779.31331030037;45779.54220457794;45837;42467.78766106165;42486.57513424873;42560.14879702412;42738.786306068425;42835.14329713404;8099.757007289776;8176.1415051419635;8180.713675021376;8187.918120818775;8191;8042.235987581171;8098.838023239532;8134.633941472648;8136;8140.837183256332;8797.164269394398;8989.146031127066;8999.055099214587;9044.23124034458;9052.094790520929;8874.645014199425;8928.910710892938;8936.687215947442;8940.463572185658;8955.955220223857;8695.347848911357;8697.82604347916;8713.956430217808;8759.474431534065;8782.07788182238;40211.59788402108;40400.79799600983;40456.39315410242;40523.39214911779;40557.797211013756;3789.317922773927;3810.580836108026;3811.6188381161937;3815.923681526354;3831.272058308912;33964.15089622755;33969.32061358759;34035.14912127192;34143.31713365744;34152.31695366104;5615.775368985236;5649;5655.660660360391;5683.82422413064;5777.364489906107;217575;217789;217986;218112;218553;52464.737676312136;52756.47243527592;52798;56273;56552.86894262092;58798;58966;59025.70487147537;59027;59084.22747317587;18931.43205703831;19015.42953711391;19049;19064.618707626047;19122.52193695169;15562;15660.608484787743;15691.372345106069;15766.92116539433;15827.841721582867;15957.281922313292;16167.27247273852;16257.593560160854;16355.754663680054;16406.343746250015;6327.683615819191;6464.838379040561;6483.546151769425;6513.8697226056165;6529.183852018497;1113.1261959361861;1116.1740312168936;1120.7926533591312;1139.0204424195185;1139.4018140476317;26205.73794262071;26331.868340658173;26338;26408.867955660484;26533.204003879913;1233.962981110568;1237.2638280223252;1239.6405042537563;1239.8450193725785;1248.057716424094;13736.93131534356;13783.586492405244;13848.238346890816;14117.08238964464;14310.49913253052;301787;305448;306018;306301;308880;52563;53159.46840531545;60263;60332.39667603268;61385.38614613886;1569.1291333310123;1582.374961890047;1583.200483755696;1596.8163661179112;1600.9439669611509;31510;31735.365292693554;32011.839940800146;32259.838700807286;32457;42707.35938960856;42809.357859631506;42916.1416771669;42918.78540607402;43024.354634681134;252248;252790;253828;254361;255139;37411.43882841705;38517.422238667;38830;38868.416973744854;38893.41659875161;46354.76822615865;47449.76275118603;47842.282365763844;47962.28056579085;48035.75982120067;35565.82217088898;35705.46441803323;35910;36133.45799813057;36348.818255908554;35686.64313356937;35777.28445431025;36119.45820812637;36260.81869590635;36581.26837463289;41473.37789933214;41486.1702765949;41546.16907661769;41813.37279940742;41944.1611167781;33924.15189620279;34776;34878.82560587181;35005.299894002485;35066.824665876506;25691.486170276865;26009.21972340833;26091.869540652933;26517;26665.60001599939 08:39:08 INFO - PID 8593 | |2;jquery.html;642.5522134799044;643.401704965553;644.8862383432895;653.7473733364463;654.8390311970496;23758.40603984901;24451.877740611293;24480.632790508113;24503.75496245037;24505;27384.726152738465;27580;27622.861885690592;27696.446071078568;27727.584086238723;6839.794806155811;7044.859102817941;7104.076470058885;7144.0712707347975;7152.463565232602;7020.087388639496;7105.609191494465;7107.111611048619;7109.395701365364;7123.287671232887;6813.080234168398;7021.61381124038;7083.185433675142;7089.893651595205;7092.4326053915565;6986.056882320872;7021.052157958712;7034.824129396755;7038.577685338871;7039.54242974205;6573.474122070223;6578.967105164492;6592.967035164841;6626;6644.036614690843;29357.119286421443;30726.38547229065;31247.218819529695;31250.843745781352;31303.84348078245;2358.080348664005;2439.024390243899;2440.2679196241056;2453.0065323543995;2458.6557881896547;20664.483387915272;21254.893725531427;21266.36200913975;21272.78727212739;21289.574208515896;2637.222019504251;2656.734326567328;2679.490896729615;2697.932551686204;2702.662167229096;142215;149051;168610;173235.13382433134;173672;20409.591808163754;23535;23560.175393861133;24203.39491512726;25538.233852984442;48340.5165948336;48645.756771215914;48804;48892.7555362228;48995.51004489909;12757.298348590917;12816.295103769196;12996.350182491027;13112.147710398984;13173.275469849059;10645.254832161829;10728.517216725266;10767.56929722818;10824.783504330027;10903.34579925207;12642.936785316198;12648;12690.302033388252;12836.229826210458;12964.222146671042;4522.954770452319;4825.30033145192;4919.670689792959;4938.38270216223;4982.676126051795;1059.1262208677872;1060.067140915989;1065.7548763784218;1070.737669271018;1072.0940805019745;21455.892720536296;21793.782062179176;21814.672779908313;21860.89069554642;22267.109315627516;1154.59589143799;1155.8208477685805;1161.0552324855832;1163.3950345820126;1163.7730642524796;11855.940720296516;11973.46119424628;12060.75878482443;12133.393330333449;12163.209391389708;655842;680392;682230;688447;699564;134577.3271133638;134676;135357.3232133833;135782;138907;1134.1550544843979;1247.8502579690496;1261.7981123020272;1288.0597164070282;1303.1138825598493;21870.57841240314;22622.095116195826;22635.378339465606;22648.527845689976;22657.546849063256;63238.68380658067;64758.676206618664;64957.35042649513;66288.6685566569;66532;78787.21212787798;80068.19931800607;82405.58797206216;82908.58545707233;84098.57950710207;21435.67846482335;22257.888710556344;22326.33021009372;22346.441338966655;22369.77630223677;24210.878945605862;24293.271201863972;24503.142390016263;24597;24626.384340391633;19902.203911843364;20124.79875201229;20160.29438969629;20506.69239961372;20516.179352826315;16655.004198488776;17940.730889036415;18123.093845307947;18236.726449103007;18767.436976890716;19944.102515386552;20363.592728145057;20539.897300513403;20698.586028279653;20728;21320.147194112684;21399.67900481525;21433.57132857303;21656.35030949074;21680.34958951234;19801.00994950218;19864.404067877407;19874.701879472108;19884.90057549703;19888.60222795565 08:39:08 INFO - PID 8593 | |3;mootools.html;1395.4418232706917;1481.5333170051433;1489.0990950474963;1490.061261405316;1492.3359105198192;17197.22612482438;17806.64386712265;17818.554536136602;17846.28614855404;17856.375026874077;17382.21780019899;17567.209475573596;17612.383566575172;17621;17633.470995870113;3066.6013418255598;3066.8466576671244;3123.1567476781256;3124.390743804959;3126.656067832537;3051.4965030769895;3060.051384070934;3069.7390721788565;3079;3080.1683545442716;2963.836988965606;3089.876404943811;3090.752739780812;3091.690830916913;3091.8144911305394;3155.9368812623734;3173.1908363367424;3184.331290429013;3186.8884589039503;3189.1070500259966;3010.548417737357;3079.076277116856;3084.953725694116;3102.4105419970133;3123.453395655751;17093.487195384158;17279.568010799703;17365.826341736672;17392.565185870455;17405.47783566495;8885;9137.314701397356;9160.221381182608;9168.541572921395;9170.495622740747;5792.923846111791;5896.321922978869;5996.4902983246475;6014.3985601439945;6200.224971878515;2114.851960362775;2159.557290755407;2184.56308738253;2210.712607361049;2245.9887700561558;31859;32674.183145421317;32683;32693.6730632693;32737.345253094805;7293.598852063187;7452.627368631547;7456.813579660444;7596.240375962359;7684.154742978268;20562.69155962662;20568.588628227353;20617.381478555668;20636.17455301771;20672.173113075307;8560.957195213985;8763.298936085226;8765.386422950332;8765.561721913879;8776.034636190014;7740.4194685398825;7916.406269529808;7916.683332666744;7967.3626109911065;7987.400944929153;5781.624194427349;5993.910091348634;6012.7895523657335;6044.848878777978;6095.238095238095;1654.6525229701897;1707.3597400974634;1733.5232810977081;1771.1232939694933;1784.8309357370943;1015.3704703084135;1047.2773786087575;1048.4024106259512;1053.3100818963592;1056.3872953686844;9822.116009559173;10047.59809607622;10125.696229113139;10129;10231.641892533726;804.7545498622976;830.9086000539936;841.5750046226616;852.3309202276183;920.7329874336501;6293.622382657055;6376.043593461018;6394.584352017104;6428.971364581738;6429.58207716497;25977.480450391264;26602.866985665336;26742.19773406801;26865.865670671912;26956;25379.492410152063;27148.592771108448;27386.72613273842;27491.17526474209;27501.449971000467;12390.008799296034;13055.477780888848;13388.598342049754;13480.662983425296;13512.256825874474;9998.20014398861;10006.199504039805;10016.348937319051;10076.445795481319;10226.028527289896;20836.895815520824;21792.67310990368;21984.560308793414;22225.888870555544;23585.882070589538;22938.311850644506;23071;23235.186768463023;23457.178998734962;23458;12610;12672.429740661877;12773.105882588501;12805.743885122432;12836.486540538273;15800.288986995383;15801.68396632084;15902.284397202386;15909.602259943595;16042.679146416773;12606.810897836724;12653;12703.87296127064;13035.934820325838;13049.543265986025;11739.11956603241;11773.411329433666;11779.52881884715;12124.575639852563;12257.14200005991;11539.36533490666;11657.475413606238;11689.064874810165;11787.174897757417;11859.881401185878;8690.913090869264;8694.956525217334;8770.736877893672;8873.600687969187;8876.289896808368;8979.14698103679;9073.77315567116;9175.495347755937;9195.172434480928;9198.908010920073 08:39:08 INFO - PID 8593 | |4;prototype.html;562.9099344104944;569.8631230694765;577.6505214345318;599.0953659973441;613.6594190224426;6348.365163483655;6362;6368.3313252108555;6461.19235095613;6541.182352205974;6275.9372406275925;6299.842503937392;6356.379123323558;6405.878971180048;6425.8714825703455;5268.130758424855;5271.710055946922;5301.125314323132;5305.840824775263;5319.574434045287;5210.661307015051;5260.184671375943;5262.789488420478;5263.026415056627;5279.41926388097;5327.573794096463;5349.7592608332525;5359;5384.973075134639;5402.405735369106;5278.788848446076;5307.601929855237;5313.574914006909;5359.651622644516;5375.596830237729;4991.301217829507;5028.472010438888;5042.520960508782;5078.97460512695;5083.8983220335385;6349.428551430394;6361;6385.563248269149;6407.487401007908;6429.971204607287;6296.244450665904;6320.399562041599;6356.332585078592;6411.3588641135975;6425.775097871552;6883.27725588816;6922.965385173092;6930.44556435489;6966.79099627012;6969.616671083139;5440.238366628675;5648.858778530528;5682.801101961453;5726.083826587767;5742.109972954198;6974.267701891279;7068.611226382547;7077.646117694147;7108.857822843566;7150.642467876585;5771.94228057714;5772.9711351442975;5823.621464604787;5833.183354330397;5894.764209431661;5867.295924489089;5878.647281163144;5889.528837692974;5901.58688891782;5951.393123856535;6305.96847015762;6315.778947736807;6328.11406403104;6374.9681251594375;6404.7117879695525;6883.414909732629;6897.689603967833;6898.827529311808;6950.879981605659;6986.860262794716;2015.939521814348;2028.6348457277832;2040.9081591328427;2045.3148195354424;2057.845661575388;1476.933537990793;1534.37356402214;1562.9218539073001;1578.4159860851557;1583.224220132127;6207.472364848948;6214.378562143749;6216.378362163748;6248.625082495065;6266.811995640138;6805.877030290046;6849.931500685029;6875.656217189121;6889.379955804002;6905.482088843357;6248.750049997949;6330.177076980055;6333.769777413552;6346.333634968354;6396.5202609804455;3598.7480876338404;3682;3684.207895302523;3691;3691.870784522529;7165.426765858719;7209.711611535585;7224.30228896209;7236.276372362827;7276.381507571916;7102.325279098477;7146.92853071473;7154.928450715426;7182.209956904736;7208.711651533985;7209.495335326582;7211.855762884713;7212.3148300911325;7219.963900180465;7225.9522369256165;6888.104546408935;6907.792766217021;6966.686499107451;6982.301769822977;7028.613426261605;6918.8616227676175;6936.549124306904;6968.442524597918;6975.755848545479;7005.54463959841;7179.989602911193;7211.278872112747;7246.347828695442;7247.840345544688;7261.564306141649;5820.632151444492;5845.327787304344;5882.470577648032;5883.911741323969;5923.526117910471;6390.616563006049;6598.822388611842;6804.081449004519;6822.829429264308;6857.965710171417;6708.6981085850275;6771.729130834711;6810.693518791765;6812.965935170292;6846.486513511407;6735.6295403753265;6753.15585551806;6814.522983391115;6821;6830.779996501057;6714.899276510954;6718.764843230463;6721.899171512529;6727.663616819237;6751.797446076625;6677.165354330708;6813.625250611066;6828.5902845829405;6850.691718872762;6867.519273650796;6379.617222966637;6473.320301368477;6525.857974854476;6610.305917878746;6640.169978752656 08:39:08 INFO - PID 8593 | |5;yui.html;978.7846673731776;1021.9284650074493;1036.9118624916882;1041.8333066709329;1054.7626783973606;21650;22261.22085727;22303.888480557594;22340.776592234073;22378.32865014048;17392.739108913378;17887.195076221567;17998.82001179988;18160.54598635035;18165.636687266247;1006.2151521812998;1011.1152741351318;1011.9443430611313;1012.018342208057;1013.6604237580401;1051.6792378324608;1072.1476426241118;1079.8974097460768;1080.713610893114;1083.5557421457204;1155.8959693627571;1165.6095208105253;1169.4737368184308;1171.9648410547654;1174.0607513988818;1164.6389619218069;1172.050638982427;1175.0540814644207;1176.8881956214145;1179.5399794080315;863.6502216602286;867.3754896474528;868.8827008353918;871.6034204436966;872.4852337121129;19217.615647687107;19302.32441864528;19308.4207473776;19316.613667726568;20455.693164602544;24002.399940001465;24035.87982060096;24509.99999999982;24675.38311542208;24676.876615616988;16656;16678.249478773483;16710;16763.49709508717;16804.57988550296;4096.610821971908;4147.191297696951;4213.073123912734;4229.175310814392;4231.280682284019;153226;165834;166728.16635916865;167831;168707;16669.749953750703;17188.742168867477;17226.569335766457;17227.655446891244;17238.741418878726;34518;36165.09587260339;36430;36690.8165459171;36778;10310.690679279634;10319.793604127875;10397.168226541859;10445.268831181897;10505.789884202273;4946.703197808071;5045.192769156991;5047.394312682502;5058.418281897555;5064.4935506449065;6342.936570634327;6422;6430.453411459985;6441.935580644227;6448.451881590117;1208.8428504294561;1219.945102470391;1257.874212578753;1258.1758947888964;1264.064592201764;753.8718417868976;763.4655740981335;778.7118766056482;779.3453499060817;786.697121608185;12864.871351286554;13829.239391833344;14646.340914658866;15250.618734531725;15480.458183963507;753.9698412063566;757.246539692998;760.1144666463618;764.7973287078928;768.7040489411617;6363.840903977438;6409.391107844747;6454.709538070704;6469.385408386196;6511.739530418825;155740;156044.21977890038;157855;158302;159152;138536;138575;140335.29832350978;140524;143263;114963.42518287354;115727;117287.41356293164;120348;121704;13861.168329900238;14270.072445291024;14307.57077287683;14713.485028024395;14791;54563.45436545742;54802.725986371406;54819.45180548143;55115.44884551103;56308;72425;89775.55112224397;93717.5314123425;93729;95405.5229723847;20114.39656810298;20428.285010024578;20541.589168216255;20549.38351849447;20795.168193272704;18983.33558325452;19471.610567788848;19597;19608.8039119607;22518.774812251668;20689.689654655493;20888.791112088686;20990.265340713613;22270.554588907806;22349.217777377715;20768.48078798042;21107.472313192295;21770.12919483203;22109.226177083725;22209.222677206868;20637.484062898548;21805;22411.77588224097;22696.319110426713;22712.545749085257;12616.495340186657;13143.079984401;13274.402651880882;14219.075760075562;14882.404703812159;13792.655183620089;13805.930970345486;13845.446182153004;13872.930635346758;13895.374708137955 08:39:08 INFO - PID 8593 | __end_tp_report 08:39:08 INFO - PID 8593 | __start_cc_report 08:39:08 INFO - PID 8593 | _x_x_mozilla_cycle_collect,244 08:39:08 INFO - PID 8593 | __end_cc_report 08:39:08 INFO - PID 8593 | __startTimestamp1506008348440__endTimestamp 08:39:08 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | ------- Summary: start ------- 08:39:08 INFO - PID 8593 | Number of tests: 6 08:39:08 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | [#0] dojo.html Cycles:165 Average:6498.99 Median:6753.83 stddev:741.91 (11.0%) stddev-sans-first:717.47 08:39:08 INFO - PID 8593 | Values: 3984.1 3986.3 4000.0 4007.6 4039.3 6474.4 6476.4 6534.1 6549.0 6595.1 6475.2 6483.2 6567.4 6573.2 6577.0 5791.8 5859.4 5905.8 5922.9 5948.0 5828.6 5844.1 5887.9 5891.9 5909.9 5882.6 5977.4 5984.3 5988.2 5995.6 5851.0 5862.8 5863.4 5866.7 5930.5 5713.4 5755.6 5764.3 5766.3 5805.1 6409.8 6411.5 6435.3 6473.4 6474.1 6977.1 6992.8 7061.2 7074.0 7081.9 7018.4 7033.9 7042.9 7087.8 7125.0 6435.2 6485.7 6490.3 6510.5 6583.0 7168.8 7203.8 7233.2 7247.9 7311.9 6944.8 6960.1 6960.2 7004.8 7051.5 6970.3 7035.3 7076.1 7155.3 7185.5 6945.1 6989.9 6995.3 7015.8 7027.2 6991.4 6994.7 7015.9 7051.7 7084.5 5218.3 5225.0 5238.7 5272.9 5283.9 4770.3 4807.3 4813.3 4818.7 4867.4 6452.5 6459.6 6529.8 6539.5 6540.3 7001.6 7003.1 7042.7 7084.3 7100.5 6380.9 6479.5 6496.5 6508.3 6528.2 5884.8 5943.7 5999.5 6015.5 6030.7 7185.0 7221.3 7239.7 7283.4 7372.3 6959.7 7016.8 7017.9 7060.0 7071.9 7296.9 7311.7 7317.0 7371.1 7403.0 6885.1 6932.0 6950.1 7024.2 7024.5 7031.2 7060.0 7068.3 7068.4 7093.0 6752.4 6792.6 6827.3 6831.2 6835.4 6759.0 6837.1 6855.5 6870.6 6887.3 6696.7 6710.3 6777.3 6777.7 6792.5 6724.8 6833.9 6904.0 6914.7 6916.2 6602.7 6672.8 6693.3 6753.8 6768.9 08:39:08 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | [#1] ext.html Cycles:180 Average:44474.38 Median:3813.77 stddev:68008.26 (1783.2%) stddev-sans-first:68120.49 08:39:08 INFO - PID 8593 | Values: 941.6 967.1 994.9 1006.5 1009.4 43811.3 45476.3 45779.3 45779.5 45837.0 42467.8 42486.6 42560.1 42738.8 42835.1 8099.8 8176.1 8180.7 8187.9 8191.0 8042.2 8098.8 8134.6 8136.0 8140.8 8797.2 8989.1 8999.1 9044.2 9052.1 8874.6 8928.9 8936.7 8940.5 8956.0 8695.3 8697.8 8714.0 8759.5 8782.1 40211.6 40400.8 40456.4 40523.4 40557.8 3789.3 3810.6 3811.6 3815.9 3831.3 33964.2 33969.3 34035.1 34143.3 34152.3 5615.8 5649.0 5655.7 5683.8 5777.4 217575.0 217789.0 217986.0 218112.0 218553.0 52464.7 52756.5 52798.0 56273.0 56552.9 58798.0 58966.0 59025.7 59027.0 59084.2 18931.4 19015.4 19049.0 19064.6 19122.5 15562.0 15660.6 15691.4 15766.9 15827.8 15957.3 16167.3 16257.6 16355.8 16406.3 6327.7 6464.8 6483.5 6513.9 6529.2 1113.1 1116.2 1120.8 1139.0 1139.4 26205.7 26331.9 26338.0 26408.9 26533.2 1234.0 1237.3 1239.6 1239.8 1248.1 13736.9 13783.6 13848.2 14117.1 14310.5 301787.0 305448.0 306018.0 306301.0 308880.0 52563.0 53159.5 60263.0 60332.4 61385.4 1569.1 1582.4 1583.2 1596.8 1600.9 31510.0 31735.4 32011.8 32259.8 32457.0 42707.4 42809.4 42916.1 42918.8 43024.4 252248.0 252790.0 253828.0 254361.0 255139.0 37411.4 38517.4 38830.0 38868.4 38893.4 46354.8 47449.8 47842.3 47962.3 48035.8 35565.8 35705.5 35910.0 36133.5 36348.8 35686.6 35777.3 36119.5 36260.8 36581.3 41473.4 41486.2 41546.2 41813.4 41944.2 33924.2 34776.0 34878.8 35005.3 35066.8 25691.5 26009.2 26091.9 26517.0 26665.6 08:39:08 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | [#2] jquery.html Cycles:180 Average:44158.16 Median:23096.27 stddev:113402.17 (491.0%) stddev-sans-first:113673.22 08:39:08 INFO - PID 8593 | Values: 642.6 643.4 644.9 653.7 654.8 23758.4 24451.9 24480.6 24503.8 24505.0 27384.7 27580.0 27622.9 27696.4 27727.6 6839.8 7044.9 7104.1 7144.1 7152.5 7020.1 7105.6 7107.1 7109.4 7123.3 6813.1 7021.6 7083.2 7089.9 7092.4 6986.1 7021.1 7034.8 7038.6 7039.5 6573.5 6579.0 6593.0 6626.0 6644.0 29357.1 30726.4 31247.2 31250.8 31303.8 2358.1 2439.0 2440.3 2453.0 2458.7 20664.5 21254.9 21266.4 21272.8 21289.6 2637.2 2656.7 2679.5 2697.9 2702.7 142215.0 149051.0 168610.0 173235.1 173672.0 20409.6 23535.0 23560.2 24203.4 25538.2 48340.5 48645.8 48804.0 48892.8 48995.5 12757.3 12816.3 12996.4 13112.1 13173.3 10645.3 10728.5 10767.6 10824.8 10903.3 12642.9 12648.0 12690.3 12836.2 12964.2 4523.0 4825.3 4919.7 4938.4 4982.7 1059.1 1060.1 1065.8 1070.7 1072.1 21455.9 21793.8 21814.7 21860.9 22267.1 1154.6 1155.8 1161.1 1163.4 1163.8 11855.9 11973.5 12060.8 12133.4 12163.2 655842.0 680392.0 682230.0 688447.0 699564.0 134577.3 134676.0 135357.3 135782.0 138907.0 1134.2 1247.9 1261.8 1288.1 1303.1 21870.6 22622.1 22635.4 22648.5 22657.5 63238.7 64758.7 64957.4 66288.7 66532.0 78787.2 80068.2 82405.6 82908.6 84098.6 21435.7 22257.9 22326.3 22346.4 22369.8 24210.9 24293.3 24503.1 24597.0 24626.4 19902.2 20124.8 20160.3 20506.7 20516.2 16655.0 17940.7 18123.1 18236.7 18767.4 19944.1 20363.6 20539.9 20698.6 20728.0 21320.1 21399.7 21433.6 21656.4 21680.3 19801.0 19864.4 19874.7 19884.9 19888.6 08:39:08 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | [#3] mootools.html Cycles:180 Average:10980.19 Median:26672.53 stddev:8146.04 (30.5%) stddev-sans-first:8137.06 08:39:08 INFO - PID 8593 | Values: 1395.4 1481.5 1489.1 1490.1 1492.3 17197.2 17806.6 17818.6 17846.3 17856.4 17382.2 17567.2 17612.4 17621.0 17633.5 3066.6 3066.8 3123.2 3124.4 3126.7 3051.5 3060.1 3069.7 3079.0 3080.2 2963.8 3089.9 3090.8 3091.7 3091.8 3155.9 3173.2 3184.3 3186.9 3189.1 3010.5 3079.1 3085.0 3102.4 3123.5 17093.5 17279.6 17365.8 17392.6 17405.5 8885.0 9137.3 9160.2 9168.5 9170.5 5792.9 5896.3 5996.5 6014.4 6200.2 2114.9 2159.6 2184.6 2210.7 2246.0 31859.0 32674.2 32683.0 32693.7 32737.3 7293.6 7452.6 7456.8 7596.2 7684.2 20562.7 20568.6 20617.4 20636.2 20672.2 8561.0 8763.3 8765.4 8765.6 8776.0 7740.4 7916.4 7916.7 7967.4 7987.4 5781.6 5993.9 6012.8 6044.8 6095.2 1654.7 1707.4 1733.5 1771.1 1784.8 1015.4 1047.3 1048.4 1053.3 1056.4 9822.1 10047.6 10125.7 10129.0 10231.6 804.8 830.9 841.6 852.3 920.7 6293.6 6376.0 6394.6 6429.0 6429.6 25977.5 26602.9 26742.2 26865.9 26956.0 25379.5 27148.6 27386.7 27491.2 27501.4 12390.0 13055.5 13388.6 13480.7 13512.3 9998.2 10006.2 10016.3 10076.4 10226.0 20836.9 21792.7 21984.6 22225.9 23585.9 22938.3 23071.0 23235.2 23457.2 23458.0 12610.0 12672.4 12773.1 12805.7 12836.5 15800.3 15801.7 15902.3 15909.6 16042.7 12606.8 12653.0 12703.9 13035.9 13049.5 11739.1 11773.4 11779.5 12124.6 12257.1 11539.4 11657.5 11689.1 11787.2 11859.9 8690.9 8695.0 8770.7 8873.6 8876.3 8979.1 9073.8 9175.5 9195.2 9198.9 08:39:08 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | [#4] prototype.html Cycles:180 Average:5907.34 Median:6388.09 stddev:1571.66 (24.6%) stddev-sans-first:1524.02 08:39:08 INFO - PID 8593 | Values: 562.9 569.9 577.7 599.1 613.7 6348.4 6362.0 6368.3 6461.2 6541.2 6275.9 6299.8 6356.4 6405.9 6425.9 5268.1 5271.7 5301.1 5305.8 5319.6 5210.7 5260.2 5262.8 5263.0 5279.4 5327.6 5349.8 5359.0 5385.0 5402.4 5278.8 5307.6 5313.6 5359.7 5375.6 4991.3 5028.5 5042.5 5079.0 5083.9 6349.4 6361.0 6385.6 6407.5 6430.0 6296.2 6320.4 6356.3 6411.4 6425.8 6883.3 6923.0 6930.4 6966.8 6969.6 5440.2 5648.9 5682.8 5726.1 5742.1 6974.3 7068.6 7077.6 7108.9 7150.6 5771.9 5773.0 5823.6 5833.2 5894.8 5867.3 5878.6 5889.5 5901.6 5951.4 6306.0 6315.8 6328.1 6375.0 6404.7 6883.4 6897.7 6898.8 6950.9 6986.9 2015.9 2028.6 2040.9 2045.3 2057.8 1476.9 1534.4 1562.9 1578.4 1583.2 6207.5 6214.4 6216.4 6248.6 6266.8 6805.9 6849.9 6875.7 6889.4 6905.5 6248.8 6330.2 6333.8 6346.3 6396.5 3598.7 3682.0 3684.2 3691.0 3691.9 7165.4 7209.7 7224.3 7236.3 7276.4 7102.3 7146.9 7154.9 7182.2 7208.7 7209.5 7211.9 7212.3 7220.0 7226.0 6888.1 6907.8 6966.7 6982.3 7028.6 6918.9 6936.5 6968.4 6975.8 7005.5 7180.0 7211.3 7246.3 7247.8 7261.6 5820.6 5845.3 5882.5 5883.9 5923.5 6390.6 6598.8 6804.1 6822.8 6858.0 6708.7 6771.7 6810.7 6813.0 6846.5 6735.6 6753.2 6814.5 6821.0 6830.8 6714.9 6718.8 6721.9 6727.7 6751.8 6677.2 6813.6 6828.6 6850.7 6867.5 6379.6 6473.3 6525.9 6610.3 6640.2 08:39:08 INFO - PID 8593 | 08:39:08 INFO - PID 8593 | [#5] yui.html Cycles:180 Average:30046.40 Median:19259.97 stddev:44515.28 (231.1%) stddev-sans-first:44586.65 08:39:08 INFO - PID 8593 | Values: 978.8 1021.9 1036.9 1041.8 1054.8 21650.0 22261.2 22303.9 22340.8 22378.3 17392.7 17887.2 17998.8 18160.5 18165.6 1006.2 1011.1 1011.9 1012.0 1013.7 1051.7 1072.1 1079.9 1080.7 1083.6 1155.9 1165.6 1169.5 1172.0 1174.1 1164.6 1172.1 1175.1 1176.9 1179.5 863.7 867.4 868.9 871.6 872.5 19217.6 19302.3 19308.4 19316.6 20455.7 24002.4 24035.9 24510.0 24675.4 24676.9 16656.0 16678.2 16710.0 16763.5 16804.6 4096.6 4147.2 4213.1 4229.2 4231.3 153226.0 165834.0 166728.2 167831.0 168707.0 16669.7 17188.7 17226.6 17227.7 17238.7 34518.0 36165.1 36430.0 36690.8 36778.0 10310.7 10319.8 10397.2 10445.3 10505.8 4946.7 5045.2 5047.4 5058.4 5064.5 6342.9 6422.0 6430.5 6441.9 6448.5 1208.8 1219.9 1257.9 1258.2 1264.1 753.9 763.5 778.7 779.3 786.7 12864.9 13829.2 14646.3 15250.6 15480.5 754.0 757.2 760.1 764.8 768.7 6363.8 6409.4 6454.7 6469.4 6511.7 155740.0 156044.2 157855.0 158302.0 159152.0 138536.0 138575.0 140335.3 140524.0 143263.0 114963.4 115727.0 117287.4 120348.0 121704.0 13861.2 14270.1 14307.6 14713.5 14791.0 54563.5 54802.7 54819.5 55115.4 56308.0 72425.0 89775.6 93717.5 93729.0 95405.5 20114.4 20428.3 20541.6 20549.4 20795.2 18983.3 19471.6 19597.0 19608.8 22518.8 20689.7 20888.8 20990.3 22270.6 22349.2 20768.5 21107.5 21770.1 22109.2 22209.2 20637.5 21805.0 22411.8 22696.3 22712.5 12616.5 13143.1 13274.4 14219.1 14882.4 13792.7 13805.9 13845.4 13872.9 13895.4 08:39:08 INFO - PID 8593 | -------- Summary: end -------- 08:39:08 INFO - PID 8593 | 08:39:09 INFO - TEST-INFO | 8593: exit 0 08:39:09 INFO - TEST-OK | dromaeo_css | took 1106429ms 08:39:09 INFO - TEST-START | kraken 08:39:09 INFO - Initialising browser for kraken test... 08:39:09 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:56423/getInfo.html -profile /tmp/tmpSRuimL/profile 08:39:09 INFO - TEST-INFO | started process 8950 (/builds/slave/test/build/application/firefox/firefox http://localhost:56423/getInfo.html) 08:39:14 INFO - TEST-INFO | 8950: exit 0 08:39:14 INFO - Browser initialized. 08:39:14 INFO - Running cycle 1/1 for kraken test... 08:39:14 INFO - Using env: {'DISPLAY': ':0', 08:39:14 INFO - 'HOME': '/home/cltbld', 08:39:14 INFO - 'JSGC_DISABLE_POISONING': '1', 08:39:14 INFO - 'LANG': 'en_US.UTF-8', 08:39:14 INFO - 'LANGUAGE': 'en_US:en', 08:39:14 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 08:39:14 INFO - 'LOGNAME': 'cltbld', 08:39:14 INFO - 'MAIL': '/var/mail/cltbld', 08:39:14 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:39:14 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:39:14 INFO - 'MOZ_CRASHREPORTER': '1', 08:39:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:39:14 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 08:39:14 INFO - 'MOZ_NO_REMOTE': '1', 08:39:14 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:39:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:39:14 INFO - 'NO_EM_RESTART': '1', 08:39:14 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:39:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:39:14 INFO - 'PWD': '/builds/slave/test', 08:39:14 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:39:14 INFO - 'RUST_BACKTRACE': 'full', 08:39:14 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 08:39:14 INFO - 'SHELL': '/bin/bash', 08:39:14 INFO - 'SHLVL': '1', 08:39:14 INFO - 'TERM': 'linux', 08:39:14 INFO - 'TMOUT': '86400', 08:39:14 INFO - 'USER': 'cltbld', 08:39:14 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562', 08:39:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:39:14 INFO - '_': '/tools/buildbot/bin/python'} 08:39:14 INFO - TEST-INFO | started process 9143 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpSRuimL/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 08:39:25 INFO - PID 9143 | RSS: Main: 144302080 08:39:25 INFO - PID 9143 | 08:39:27 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:56423/tests/kraken/driver.html?testName=audio-beat-detection) 08:39:28 INFO - PID 9143 | RSS: Main: 150798336 08:39:28 INFO - PID 9143 | 08:39:31 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:56423/tests/kraken/driver.html?testName=audio-dft) 08:39:31 INFO - PID 9143 | RSS: Main: 151162880 08:39:31 INFO - PID 9143 | 08:39:34 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:56423/tests/kraken/driver.html?testName=audio-fft) 08:39:35 INFO - PID 9143 | RSS: Main: 152780800 08:39:35 INFO - PID 9143 | 08:39:37 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:56423/tests/kraken/driver.html?testName=audio-oscillator) 08:39:37 INFO - PID 9143 | RSS: Main: 152301568 08:39:37 INFO - PID 9143 | 08:39:40 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:56423/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:39:40 INFO - PID 9143 | RSS: Main: 152596480 08:39:40 INFO - PID 9143 | 08:39:43 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:56423/tests/kraken/driver.html?testName=imaging-darkroom) 08:39:44 INFO - PID 9143 | RSS: Main: 152154112 08:39:44 INFO - PID 9143 | 08:39:47 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:56423/tests/kraken/driver.html?testName=imaging-desaturate) 08:39:48 INFO - PID 9143 | RSS: Main: 154267648 08:39:48 INFO - PID 9143 | 08:39:51 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:56423/tests/kraken/driver.html?testName=json-parse-financial) 08:39:51 INFO - PID 9143 | RSS: Main: 155369472 08:39:51 INFO - PID 9143 | 08:39:53 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:56423/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:39:53 INFO - PID 9143 | RSS: Main: 154865664 08:39:53 INFO - PID 9143 | 08:39:55 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:56423/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:39:56 INFO - PID 9143 | RSS: Main: 154910720 08:39:56 INFO - PID 9143 | 08:39:57 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:56423/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:39:58 INFO - PID 9143 | RSS: Main: 152055808 08:39:58 INFO - PID 9143 | 08:40:01 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:56423/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:40:01 INFO - PID 9143 | RSS: Main: 152387584 08:40:01 INFO - PID 9143 | 08:40:04 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:56423/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:40:04 INFO - PID 9143 | RSS: Main: 152637440 08:40:04 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | Cycle 1(1): loaded http://localhost:56423/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:56423/tests/kraken/driver.html?testName=ai-astar) 08:40:06 INFO - PID 9143 | RSS: Main: 154546176 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | __start_tp_report 08:40:06 INFO - PID 9143 | _x_x_mozilla_page_load 08:40:06 INFO - PID 9143 | _x_x_mozilla_page_load_details 08:40:06 INFO - PID 9143 | |i|pagename|runs| 08:40:06 INFO - PID 9143 | |0;ai-astar;105;105;104;102;105;105;106;106;107;106 08:40:06 INFO - PID 9143 | |1;audio-beat-detection;109;110;113;109;112;111;115;112;111;115 08:40:06 INFO - PID 9143 | |2;audio-dft;163;162;164;161;162;162;163;162;162;163 08:40:06 INFO - PID 9143 | |3;audio-fft;76;73;74;74;73;72;73;72;74;74 08:40:06 INFO - PID 9143 | |4;audio-oscillator;78;78;77;77;78;120;77;79;76;77 08:40:06 INFO - PID 9143 | |5;imaging-gaussian-blur;113;113;110;114;111;113;114;111;114;114 08:40:06 INFO - PID 9143 | |6;imaging-darkroom;149;149;148;149;149;147;148;147;153;152 08:40:06 INFO - PID 9143 | |7;imaging-desaturate;94;93;94;94;94;94;94;95;95;94 08:40:06 INFO - PID 9143 | |8;json-parse-financial;46;44;45;42;44;44;43;44;43;42 08:40:06 INFO - PID 9143 | |9;json-stringify-tinderbox;39;39;38;39;39;39;39;38;40;38 08:40:06 INFO - PID 9143 | |10;stanford-crypto-aes;69;69;70;69;69;68;69;70;70;69 08:40:06 INFO - PID 9143 | |11;stanford-crypto-ccm;105;100;101;102;107;104;109;101;107;108 08:40:06 INFO - PID 9143 | |12;stanford-crypto-pbkdf2;146;158;152;146;150;151;149;147;154;152 08:40:06 INFO - PID 9143 | |13;stanford-crypto-sha256-iterative;62;59;60;57;60;57;58;59;58;57 08:40:06 INFO - PID 9143 | __end_tp_report 08:40:06 INFO - PID 9143 | __start_cc_report 08:40:06 INFO - PID 9143 | _x_x_mozilla_cycle_collect,691 08:40:06 INFO - PID 9143 | __end_cc_report 08:40:06 INFO - PID 9143 | __startTimestamp1506008406885__endTimestamp 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | ------- Summary: start ------- 08:40:06 INFO - PID 9143 | Number of tests: 14 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#0] ai-astar Cycles:10 Average:105.10 Median:105.50 stddev:1.37 (1.3%) stddev-sans-first:1.45 08:40:06 INFO - PID 9143 | Values: 105.0 105.0 104.0 102.0 105.0 105.0 106.0 106.0 107.0 106.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#1] audio-beat-detection Cycles:10 Average:111.70 Median:112.00 stddev:2.16 (1.9%) stddev-sans-first:2.06 08:40:06 INFO - PID 9143 | Values: 109.0 110.0 113.0 109.0 112.0 111.0 115.0 112.0 111.0 115.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#2] audio-dft Cycles:10 Average:162.40 Median:162.50 stddev:0.84 (0.5%) stddev-sans-first:0.87 08:40:06 INFO - PID 9143 | Values: 163.0 162.0 164.0 161.0 162.0 162.0 163.0 162.0 162.0 163.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#3] audio-fft Cycles:10 Average:73.50 Median:74.00 stddev:1.18 (1.6%) stddev-sans-first:0.83 08:40:06 INFO - PID 9143 | Values: 76.0 73.0 74.0 74.0 73.0 72.0 73.0 72.0 74.0 74.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#4] audio-oscillator Cycles:10 Average:81.70 Median:77.50 stddev:13.48 (17.4%) stddev-sans-first:14.23 08:40:06 INFO - PID 9143 | Values: 78.0 78.0 77.0 77.0 78.0 120.0 77.0 79.0 76.0 77.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#5] imaging-gaussian-blur Cycles:10 Average:112.70 Median:113.50 stddev:1.49 (1.3%) stddev-sans-first:1.58 08:40:06 INFO - PID 9143 | Values: 113.0 113.0 110.0 114.0 111.0 113.0 114.0 111.0 114.0 114.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#6] imaging-darkroom Cycles:10 Average:149.10 Median:149.00 stddev:1.97 (1.3%) stddev-sans-first:2.09 08:40:06 INFO - PID 9143 | Values: 149.0 149.0 148.0 149.0 149.0 147.0 148.0 147.0 153.0 152.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#7] imaging-desaturate Cycles:10 Average:94.10 Median:94.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 08:40:06 INFO - PID 9143 | Values: 94.0 93.0 94.0 94.0 94.0 94.0 94.0 95.0 95.0 94.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#8] json-parse-financial Cycles:10 Average:43.70 Median:44.00 stddev:1.25 (2.8%) stddev-sans-first:1.01 08:40:06 INFO - PID 9143 | Values: 46.0 44.0 45.0 42.0 44.0 44.0 43.0 44.0 43.0 42.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#9] json-stringify-tinderbox Cycles:10 Average:38.80 Median:39.00 stddev:0.63 (1.6%) stddev-sans-first:0.67 08:40:06 INFO - PID 9143 | Values: 39.0 39.0 38.0 39.0 39.0 39.0 39.0 38.0 40.0 38.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#10] stanford-crypto-aes Cycles:10 Average:69.20 Median:69.00 stddev:0.63 (0.9%) stddev-sans-first:0.67 08:40:06 INFO - PID 9143 | Values: 69.0 69.0 70.0 69.0 69.0 68.0 69.0 70.0 70.0 69.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#11] stanford-crypto-ccm Cycles:10 Average:104.40 Median:106.00 stddev:3.27 (3.1%) stddev-sans-first:3.46 08:40:06 INFO - PID 9143 | Values: 105.0 100.0 101.0 102.0 107.0 104.0 109.0 101.0 107.0 108.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.50 Median:151.50 stddev:3.78 (2.5%) stddev-sans-first:3.64 08:40:06 INFO - PID 9143 | Values: 146.0 158.0 152.0 146.0 150.0 151.0 149.0 147.0 154.0 152.0 08:40:06 INFO - PID 9143 | 08:40:06 INFO - PID 9143 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:58.70 Median:59.00 stddev:1.64 (2.8%) stddev-sans-first:1.22 08:40:06 INFO - PID 9143 | Values: 62.0 59.0 60.0 57.0 60.0 57.0 58.0 59.0 58.0 57.0 08:40:06 INFO - PID 9143 | -------- Summary: end -------- 08:40:06 INFO - PID 9143 | 08:40:07 INFO - PID 9143 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 08:40:07 INFO - TEST-INFO | 9143: exit 0 08:40:07 INFO - TEST-OK | kraken | took 58445ms 08:40:07 INFO - SUITE-END | took 1164s 08:40:07 INFO - Completed test suite (00:19:24) 08:40:07 INFO - javascript benchmark 08:40:07 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 9618.30111156813, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3984.0637450199206, 3986.282469155552, 4000.0, 4007.5591684914634, 4039.2931237033513, 6474.352564743529, 6476.384743449365, 6534.085228068068, 6548.9672551637295, 6595.076689263495, 6475.158229430168, 6483.1571895653615, 6567.376099270574, 6573.211214654249, 6576.96711516443, 5791.7972870949525, 5859.384764599709, 5905.822825315247, 5922.851928701773, 5947.970260148693, 5828.591998560102, 5844.123381492789, 5887.8528036799, 5891.88216235675, 5909.911351329733, 5882.5588080893895, 5977.432143946318, 5984.251968503937, 5988.191594134802, 5995.6102853314615, 5851.0, 5862.794802181925, 5863.442972917566, 5866.73599688015, 5930.525557955375, 5713.371529131792, 5755.597108202427, 5764.308283006024, 5766.250387449647, 5805.129230615399, 6409.775657851953, 6411.487081033506, 6435.292117867031, 6473.352664733536, 6474.125992990933, 6977.1278590176225, 6992.825179370506, 7061.187963384225, 7074.0, 7081.858362832766, 7018.403435707971, 7033.8944915826305, 7042.859142817166, 7087.8228044298785, 7125.0, 6435.227772667263, 6485.740570377179, 6490.318516555741, 6510.479161667103, 6583.012548117821, 7168.784936451915, 7203.819904502429, 7233.240509746401, 7247.855042899218, 7311.93976873361, 6944.826379340557, 6960.095187625678, 6960.164780226405, 7004.754833580902, 7051.471139664443, 6970.268121847234, 7035.33164349386, 7076.0801095857205, 7155.3202445767565, 7185.53294035886, 6945.131858517685, 6989.89515157273, 6995.335443132894, 7015.824604384931, 7027.227005029443, 6991.440684745208, 6994.720211191597, 7015.89476157858, 7051.717931282691, 7084.539504932163, 5218.269442278084, 5225.0, 5238.73806309683, 5272.868178295496, 5283.9471605284225, 4770.332153498513, 4807.302941073524, 4813.253945638432, 4818.68678535901, 4867.440244371872, 6452.516061295421, 6459.644719540376, 6529.836754081186, 6539.509536784665, 6540.345965403421, 7001.614911179832, 7003.089598352181, 7042.718291268395, 7084.2915708428745, 7100.5029647925185, 6380.851446739632, 6479.514036447191, 6496.512761542903, 6508.349165083454, 6528.151340325728, 5884.764609415661, 5943.702814859326, 5999.520038396918, 6015.54883383748, 6030.698465076729, 7185.0, 7221.31397517235, 7239.74660886877, 7283.3809126223805, 7372.262773722692, 6959.6868140933775, 7016.824579385556, 7017.929820701932, 7060.0, 7071.858562828817, 7296.854062918818, 7311.701805057715, 7317.0, 7371.078615173104, 7403.0, 6885.139357580302, 6932.0, 6950.096487456598, 7024.1571011478945, 7024.5082844200415, 7031.156261248683, 7060.0, 7068.257832927468, 7068.434525238072, 7093.042439270633, 6752.358525940028, 6792.626405547742, 6827.283135270924, 6831.214410342675, 6835.350641689031, 6759.0, 6837.076994605664, 6855.520113592001, 6870.587764734132, 6887.311268873273, 6696.732130714717, 6710.261871194067, 6777.254502004677, 6777.695003724745, 6792.456603471612, 6724.7646332378135, 6833.863322733617, 6904.0, 6914.723411063501, 6916.170059592881, 6602.702878370389, 6672.799816005528, 6693.263740988585, 6753.831154221184, 6768.932310677027], "value": 6450.324531725318, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [941.5904081724454, 967.086103632068, 994.8706668133143, 1006.4967516241879, 1009.4347165587271, 43811.342829857575, 45476.3178552322, 45779.31331030037, 45779.54220457794, 45837.0, 42467.78766106165, 42486.57513424873, 42560.14879702412, 42738.786306068425, 42835.14329713404, 8099.757007289776, 8176.1415051419635, 8180.713675021376, 8187.918120818775, 8191.0, 8042.235987581171, 8098.838023239532, 8134.633941472648, 8136.0, 8140.837183256332, 8797.164269394398, 8989.146031127066, 8999.055099214587, 9044.23124034458, 9052.094790520929, 8874.645014199425, 8928.910710892938, 8936.687215947442, 8940.463572185658, 8955.955220223857, 8695.347848911357, 8697.82604347916, 8713.956430217808, 8759.474431534065, 8782.07788182238, 40211.59788402108, 40400.79799600983, 40456.39315410242, 40523.39214911779, 40557.797211013756, 3789.317922773927, 3810.580836108026, 3811.6188381161937, 3815.923681526354, 3831.272058308912, 33964.15089622755, 33969.32061358759, 34035.14912127192, 34143.31713365744, 34152.31695366104, 5615.775368985236, 5649.0, 5655.660660360391, 5683.82422413064, 5777.364489906107, 217575.0, 217789.0, 217986.0, 218112.0, 218553.0, 52464.737676312136, 52756.47243527592, 52798.0, 56273.0, 56552.86894262092, 58798.0, 58966.0, 59025.70487147537, 59027.0, 59084.22747317587, 18931.43205703831, 19015.42953711391, 19049.0, 19064.618707626047, 19122.52193695169, 15562.0, 15660.608484787743, 15691.372345106069, 15766.92116539433, 15827.841721582867, 15957.281922313292, 16167.27247273852, 16257.593560160854, 16355.754663680054, 16406.343746250015, 6327.683615819191, 6464.838379040561, 6483.546151769425, 6513.8697226056165, 6529.183852018497, 1113.1261959361861, 1116.1740312168936, 1120.7926533591312, 1139.0204424195185, 1139.4018140476317, 26205.73794262071, 26331.868340658173, 26338.0, 26408.867955660484, 26533.204003879913, 1233.962981110568, 1237.2638280223252, 1239.6405042537563, 1239.8450193725785, 1248.057716424094, 13736.93131534356, 13783.586492405244, 13848.238346890816, 14117.08238964464, 14310.49913253052, 301787.0, 305448.0, 306018.0, 306301.0, 308880.0, 52563.0, 53159.46840531545, 60263.0, 60332.39667603268, 61385.38614613886, 1569.1291333310123, 1582.374961890047, 1583.200483755696, 1596.8163661179112, 1600.9439669611509, 31510.0, 31735.365292693554, 32011.839940800146, 32259.838700807286, 32457.0, 42707.35938960856, 42809.357859631506, 42916.1416771669, 42918.78540607402, 43024.354634681134, 252248.0, 252790.0, 253828.0, 254361.0, 255139.0, 37411.43882841705, 38517.422238667, 38830.0, 38868.416973744854, 38893.41659875161, 46354.76822615865, 47449.76275118603, 47842.282365763844, 47962.28056579085, 48035.75982120067, 35565.82217088898, 35705.46441803323, 35910.0, 36133.45799813057, 36348.818255908554, 35686.64313356937, 35777.28445431025, 36119.45820812637, 36260.81869590635, 36581.26837463289, 41473.37789933214, 41486.1702765949, 41546.16907661769, 41813.37279940742, 41944.1611167781, 33924.15189620279, 34776.0, 34878.82560587181, 35005.299894002485, 35066.824665876506, 25691.486170276865, 26009.21972340833, 26091.869540652933, 26517.0, 26665.60001599939], "value": 19462.81077736956, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [642.5522134799044, 643.401704965553, 644.8862383432895, 653.7473733364463, 654.8390311970496, 23758.40603984901, 24451.877740611293, 24480.632790508113, 24503.75496245037, 24505.0, 27384.726152738465, 27580.0, 27622.861885690592, 27696.446071078568, 27727.584086238723, 6839.794806155811, 7044.859102817941, 7104.076470058885, 7144.0712707347975, 7152.463565232602, 7020.087388639496, 7105.609191494465, 7107.111611048619, 7109.395701365364, 7123.287671232887, 6813.080234168398, 7021.61381124038, 7083.185433675142, 7089.893651595205, 7092.4326053915565, 6986.056882320872, 7021.052157958712, 7034.824129396755, 7038.577685338871, 7039.54242974205, 6573.474122070223, 6578.967105164492, 6592.967035164841, 6626.0, 6644.036614690843, 29357.119286421443, 30726.38547229065, 31247.218819529695, 31250.843745781352, 31303.84348078245, 2358.080348664005, 2439.024390243899, 2440.2679196241056, 2453.0065323543995, 2458.6557881896547, 20664.483387915272, 21254.893725531427, 21266.36200913975, 21272.78727212739, 21289.574208515896, 2637.222019504251, 2656.734326567328, 2679.490896729615, 2697.932551686204, 2702.662167229096, 142215.0, 149051.0, 168610.0, 173235.13382433134, 173672.0, 20409.591808163754, 23535.0, 23560.175393861133, 24203.39491512726, 25538.233852984442, 48340.5165948336, 48645.756771215914, 48804.0, 48892.7555362228, 48995.51004489909, 12757.298348590917, 12816.295103769196, 12996.350182491027, 13112.147710398984, 13173.275469849059, 10645.254832161829, 10728.517216725266, 10767.56929722818, 10824.783504330027, 10903.34579925207, 12642.936785316198, 12648.0, 12690.302033388252, 12836.229826210458, 12964.222146671042, 4522.954770452319, 4825.30033145192, 4919.670689792959, 4938.38270216223, 4982.676126051795, 1059.1262208677872, 1060.067140915989, 1065.7548763784218, 1070.737669271018, 1072.0940805019745, 21455.892720536296, 21793.782062179176, 21814.672779908313, 21860.89069554642, 22267.109315627516, 1154.59589143799, 1155.8208477685805, 1161.0552324855832, 1163.3950345820126, 1163.7730642524796, 11855.940720296516, 11973.46119424628, 12060.75878482443, 12133.393330333449, 12163.209391389708, 655842.0, 680392.0, 682230.0, 688447.0, 699564.0, 134577.3271133638, 134676.0, 135357.3232133833, 135782.0, 138907.0, 1134.1550544843979, 1247.8502579690496, 1261.7981123020272, 1288.0597164070282, 1303.1138825598493, 21870.57841240314, 22622.095116195826, 22635.378339465606, 22648.527845689976, 22657.546849063256, 63238.68380658067, 64758.676206618664, 64957.35042649513, 66288.6685566569, 66532.0, 78787.21212787798, 80068.19931800607, 82405.58797206216, 82908.58545707233, 84098.57950710207, 21435.67846482335, 22257.888710556344, 22326.33021009372, 22346.441338966655, 22369.77630223677, 24210.878945605862, 24293.271201863972, 24503.142390016263, 24597.0, 24626.384340391633, 19902.203911843364, 20124.79875201229, 20160.29438969629, 20506.69239961372, 20516.179352826315, 16655.004198488776, 17940.730889036415, 18123.093845307947, 18236.726449103007, 18767.436976890716, 19944.102515386552, 20363.592728145057, 20539.897300513403, 20698.586028279653, 20728.0, 21320.147194112684, 21399.67900481525, 21433.57132857303, 21656.35030949074, 21680.34958951234, 19801.00994950218, 19864.404067877407, 19874.701879472108, 19884.90057549703, 19888.60222795565], "value": 14277.470403247993, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1395.4418232706917, 1481.5333170051433, 1489.0990950474963, 1490.061261405316, 1492.3359105198192, 17197.22612482438, 17806.64386712265, 17818.554536136602, 17846.28614855404, 17856.375026874077, 17382.21780019899, 17567.209475573596, 17612.383566575172, 17621.0, 17633.470995870113, 3066.6013418255598, 3066.8466576671244, 3123.1567476781256, 3124.390743804959, 3126.656067832537, 3051.4965030769895, 3060.051384070934, 3069.7390721788565, 3079.0, 3080.1683545442716, 2963.836988965606, 3089.876404943811, 3090.752739780812, 3091.690830916913, 3091.8144911305394, 3155.9368812623734, 3173.1908363367424, 3184.331290429013, 3186.8884589039503, 3189.1070500259966, 3010.548417737357, 3079.076277116856, 3084.953725694116, 3102.4105419970133, 3123.453395655751, 17093.487195384158, 17279.568010799703, 17365.826341736672, 17392.565185870455, 17405.47783566495, 8885.0, 9137.314701397356, 9160.221381182608, 9168.541572921395, 9170.495622740747, 5792.923846111791, 5896.321922978869, 5996.4902983246475, 6014.3985601439945, 6200.224971878515, 2114.851960362775, 2159.557290755407, 2184.56308738253, 2210.712607361049, 2245.9887700561558, 31859.0, 32674.183145421317, 32683.0, 32693.6730632693, 32737.345253094805, 7293.598852063187, 7452.627368631547, 7456.813579660444, 7596.240375962359, 7684.154742978268, 20562.69155962662, 20568.588628227353, 20617.381478555668, 20636.17455301771, 20672.173113075307, 8560.957195213985, 8763.298936085226, 8765.386422950332, 8765.561721913879, 8776.034636190014, 7740.4194685398825, 7916.406269529808, 7916.683332666744, 7967.3626109911065, 7987.400944929153, 5781.624194427349, 5993.910091348634, 6012.7895523657335, 6044.848878777978, 6095.238095238095, 1654.6525229701897, 1707.3597400974634, 1733.5232810977081, 1771.1232939694933, 1784.8309357370943, 1015.3704703084135, 1047.2773786087575, 1048.4024106259512, 1053.3100818963592, 1056.3872953686844, 9822.116009559173, 10047.59809607622, 10125.696229113139, 10129.0, 10231.641892533726, 804.7545498622976, 830.9086000539936, 841.5750046226616, 852.3309202276183, 920.7329874336501, 6293.622382657055, 6376.043593461018, 6394.584352017104, 6428.971364581738, 6429.58207716497, 25977.480450391264, 26602.866985665336, 26742.19773406801, 26865.865670671912, 26956.0, 25379.492410152063, 27148.592771108448, 27386.72613273842, 27491.17526474209, 27501.449971000467, 12390.008799296034, 13055.477780888848, 13388.598342049754, 13480.662983425296, 13512.256825874474, 9998.20014398861, 10006.199504039805, 10016.348937319051, 10076.445795481319, 10226.028527289896, 20836.895815520824, 21792.67310990368, 21984.560308793414, 22225.888870555544, 23585.882070589538, 22938.311850644506, 23071.0, 23235.186768463023, 23457.178998734962, 23458.0, 12610.0, 12672.429740661877, 12773.105882588501, 12805.743885122432, 12836.486540538273, 15800.288986995383, 15801.68396632084, 15902.284397202386, 15909.602259943595, 16042.679146416773, 12606.810897836724, 12653.0, 12703.87296127064, 13035.934820325838, 13049.543265986025, 11739.11956603241, 11773.411329433666, 11779.52881884715, 12124.575639852563, 12257.14200005991, 11539.36533490666, 11657.475413606238, 11689.064874810165, 11787.174897757417, 11859.881401185878, 8690.913090869264, 8694.956525217334, 8770.736877893672, 8873.600687969187, 8876.289896808368, 8979.14698103679, 9073.77315567116, 9175.495347755937, 9195.172434480928, 9198.908010920073], "value": 7690.1081613963015, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [562.9099344104944, 569.8631230694765, 577.6505214345318, 599.0953659973441, 613.6594190224426, 6348.365163483655, 6362.0, 6368.3313252108555, 6461.19235095613, 6541.182352205974, 6275.9372406275925, 6299.842503937392, 6356.379123323558, 6405.878971180048, 6425.8714825703455, 5268.130758424855, 5271.710055946922, 5301.125314323132, 5305.840824775263, 5319.574434045287, 5210.661307015051, 5260.184671375943, 5262.789488420478, 5263.026415056627, 5279.41926388097, 5327.573794096463, 5349.7592608332525, 5359.0, 5384.973075134639, 5402.405735369106, 5278.788848446076, 5307.601929855237, 5313.574914006909, 5359.651622644516, 5375.596830237729, 4991.301217829507, 5028.472010438888, 5042.520960508782, 5078.97460512695, 5083.8983220335385, 6349.428551430394, 6361.0, 6385.563248269149, 6407.487401007908, 6429.971204607287, 6296.244450665904, 6320.399562041599, 6356.332585078592, 6411.3588641135975, 6425.775097871552, 6883.27725588816, 6922.965385173092, 6930.44556435489, 6966.79099627012, 6969.616671083139, 5440.238366628675, 5648.858778530528, 5682.801101961453, 5726.083826587767, 5742.109972954198, 6974.267701891279, 7068.611226382547, 7077.646117694147, 7108.857822843566, 7150.642467876585, 5771.94228057714, 5772.9711351442975, 5823.621464604787, 5833.183354330397, 5894.764209431661, 5867.295924489089, 5878.647281163144, 5889.528837692974, 5901.58688891782, 5951.393123856535, 6305.96847015762, 6315.778947736807, 6328.11406403104, 6374.9681251594375, 6404.7117879695525, 6883.414909732629, 6897.689603967833, 6898.827529311808, 6950.879981605659, 6986.860262794716, 2015.939521814348, 2028.6348457277832, 2040.9081591328427, 2045.3148195354424, 2057.845661575388, 1476.933537990793, 1534.37356402214, 1562.9218539073001, 1578.4159860851557, 1583.224220132127, 6207.472364848948, 6214.378562143749, 6216.378362163748, 6248.625082495065, 6266.811995640138, 6805.877030290046, 6849.931500685029, 6875.656217189121, 6889.379955804002, 6905.482088843357, 6248.750049997949, 6330.177076980055, 6333.769777413552, 6346.333634968354, 6396.5202609804455, 3598.7480876338404, 3682.0, 3684.207895302523, 3691.0, 3691.870784522529, 7165.426765858719, 7209.711611535585, 7224.30228896209, 7236.276372362827, 7276.381507571916, 7102.325279098477, 7146.92853071473, 7154.928450715426, 7182.209956904736, 7208.711651533985, 7209.495335326582, 7211.855762884713, 7212.3148300911325, 7219.963900180465, 7225.9522369256165, 6888.104546408935, 6907.792766217021, 6966.686499107451, 6982.301769822977, 7028.613426261605, 6918.8616227676175, 6936.549124306904, 6968.442524597918, 6975.755848545479, 7005.54463959841, 7179.989602911193, 7211.278872112747, 7246.347828695442, 7247.840345544688, 7261.564306141649, 5820.632151444492, 5845.327787304344, 5882.470577648032, 5883.911741323969, 5923.526117910471, 6390.616563006049, 6598.822388611842, 6804.081449004519, 6822.829429264308, 6857.965710171417, 6708.6981085850275, 6771.729130834711, 6810.693518791765, 6812.965935170292, 6846.486513511407, 6735.6295403753265, 6753.15585551806, 6814.522983391115, 6821.0, 6830.779996501057, 6714.899276510954, 6718.764843230463, 6721.899171512529, 6727.663616819237, 6751.797446076625, 6677.165354330708, 6813.625250611066, 6828.5902845829405, 6850.691718872762, 6867.519273650796, 6379.617222966637, 6473.320301368477, 6525.857974854476, 6610.305917878746, 6640.169978752656], "value": 5466.161550880811, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [978.7846673731776, 1021.9284650074493, 1036.9118624916882, 1041.8333066709329, 1054.7626783973606, 21650.0, 22261.22085727, 22303.888480557594, 22340.776592234073, 22378.32865014048, 17392.739108913378, 17887.195076221567, 17998.82001179988, 18160.54598635035, 18165.636687266247, 1006.2151521812998, 1011.1152741351318, 1011.9443430611313, 1012.018342208057, 1013.6604237580401, 1051.6792378324608, 1072.1476426241118, 1079.8974097460768, 1080.713610893114, 1083.5557421457204, 1155.8959693627571, 1165.6095208105253, 1169.4737368184308, 1171.9648410547654, 1174.0607513988818, 1164.6389619218069, 1172.050638982427, 1175.0540814644207, 1176.8881956214145, 1179.5399794080315, 863.6502216602286, 867.3754896474528, 868.8827008353918, 871.6034204436966, 872.4852337121129, 19217.615647687107, 19302.32441864528, 19308.4207473776, 19316.613667726568, 20455.693164602544, 24002.399940001465, 24035.87982060096, 24509.99999999982, 24675.38311542208, 24676.876615616988, 16656.0, 16678.249478773483, 16710.0, 16763.49709508717, 16804.57988550296, 4096.610821971908, 4147.191297696951, 4213.073123912734, 4229.175310814392, 4231.280682284019, 153226.0, 165834.0, 166728.16635916865, 167831.0, 168707.0, 16669.749953750703, 17188.742168867477, 17226.569335766457, 17227.655446891244, 17238.741418878726, 34518.0, 36165.09587260339, 36430.0, 36690.8165459171, 36778.0, 10310.690679279634, 10319.793604127875, 10397.168226541859, 10445.268831181897, 10505.789884202273, 4946.703197808071, 5045.192769156991, 5047.394312682502, 5058.418281897555, 5064.4935506449065, 6342.936570634327, 6422.0, 6430.453411459985, 6441.935580644227, 6448.451881590117, 1208.8428504294561, 1219.945102470391, 1257.874212578753, 1258.1758947888964, 1264.064592201764, 753.8718417868976, 763.4655740981335, 778.7118766056482, 779.3453499060817, 786.697121608185, 12864.871351286554, 13829.239391833344, 14646.340914658866, 15250.618734531725, 15480.458183963507, 753.9698412063566, 757.246539692998, 760.1144666463618, 764.7973287078928, 768.7040489411617, 6363.840903977438, 6409.391107844747, 6454.709538070704, 6469.385408386196, 6511.739530418825, 155740.0, 156044.21977890038, 157855.0, 158302.0, 159152.0, 138536.0, 138575.0, 140335.29832350978, 140524.0, 143263.0, 114963.42518287354, 115727.0, 117287.41356293164, 120348.0, 121704.0, 13861.168329900238, 14270.072445291024, 14307.57077287683, 14713.485028024395, 14791.0, 54563.45436545742, 54802.725986371406, 54819.45180548143, 55115.44884551103, 56308.0, 72425.0, 89775.55112224397, 93717.5314123425, 93729.0, 95405.5229723847, 20114.39656810298, 20428.285010024578, 20541.589168216255, 20549.38351849447, 20795.168193272704, 18983.33558325452, 19471.610567788848, 19597.0, 19608.8039119607, 22518.774812251668, 20689.689654655493, 20888.791112088686, 20990.265340713613, 22270.554588907806, 22349.217777377715, 20768.48078798042, 21107.472313192295, 21770.12919483203, 22109.226177083725, 22209.222677206868, 20637.484062898548, 21805.0, 22411.77588224097, 22696.319110426713, 22712.545749085257, 12616.495340186657, 13143.079984401, 13274.402651880882, 14219.075760075562, 14882.404703812159, 13792.655183620089, 13805.930970345486, 13845.446182153004, 13872.930635346758, 13895.374708137955], "value": 10507.768924184193, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1355.6000000000004, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 105.0, 104.0, 102.0, 105.0, 105.0, 106.0, 106.0, 107.0, 106.0], "value": 105.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 110.0, 113.0, 109.0, 112.0, 111.0, 115.0, 112.0, 111.0, 115.0], "value": 111.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 164.0, 161.0, 162.0, 162.0, 163.0, 162.0, 162.0, 163.0], "value": 162.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 73.0, 74.0, 74.0, 73.0, 72.0, 73.0, 72.0, 74.0, 74.0], "value": 73.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 78.0, 77.0, 77.0, 78.0, 120.0, 77.0, 79.0, 76.0, 77.0], "value": 81.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 113.0, 110.0, 114.0, 111.0, 113.0, 114.0, 111.0, 114.0, 114.0], "value": 112.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 149.0, 148.0, 149.0, 149.0, 147.0, 148.0, 147.0, 153.0, 152.0], "value": 149.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 93.0, 94.0, 94.0, 94.0, 94.0, 94.0, 95.0, 95.0, 94.0], "value": 94.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [46.0, 44.0, 45.0, 42.0, 44.0, 44.0, 43.0, 44.0, 43.0, 42.0], "value": 43.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [39.0, 39.0, 38.0, 39.0, 39.0, 39.0, 39.0, 38.0, 40.0, 38.0], "value": 38.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 69.0, 70.0, 69.0, 69.0, 68.0, 69.0, 70.0, 70.0, 69.0], "value": 69.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 100.0, 101.0, 102.0, 107.0, 104.0, 109.0, 101.0, 107.0, 108.0], "value": 104.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 158.0, 152.0, 146.0, 150.0, 151.0, 149.0, 147.0, 154.0, 152.0], "value": 150.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 59.0, 60.0, 57.0, 60.0, 57.0, 58.0, 59.0, 58.0, 57.0], "value": 58.7, "unit": "score"}]}]} 08:40:07 INFO - Return code: 0 08:40:07 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:40:07 INFO - # TBPL SUCCESS # 08:40:07 INFO - Running post-action listener: _package_coverage_data 08:40:07 INFO - Running post-action listener: _resource_record_post_action 08:40:07 INFO - [mozharness: 2017-09-21 15:40:07.670236Z] Finished run-tests step (success) 08:40:07 INFO - Running post-run listener: _resource_record_post_run 08:40:07 INFO - Total resource usage - Wall time: 1180s; CPU: 13.0%; Read bytes: 4096; Write bytes: 284553216; Read time: 16; Write time: 170356 08:40:07 INFO - TinderboxPrint: CPU usage
13.0% 08:40:07 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 08:40:07 INFO - TinderboxPrint: I/O write bytes / time
284,553,216 / 170,356 08:40:07 INFO - TinderboxPrint: CPU idle
8,180.4 (86.9%) 08:40:07 INFO - TinderboxPrint: CPU user
1,179.6 (12.5%) 08:40:07 INFO - TinderboxPrint: Swap in / out
0 / 0 08:40:07 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 9547776; Read time: 0; Write time: 1108 08:40:07 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 08:40:07 INFO - run-tests - Wall time: 1165s; CPU: 13.0%; Read bytes: 4096; Write bytes: 275005440; Read time: 16; Write time: 169248 08:40:08 INFO - Running post-run listener: _upload_blobber_files 08:40:08 INFO - Blob upload gear active. 08:40:08 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:40:08 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 08:40:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Beta-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:40:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Beta-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:40:08 INFO - (blobuploader) - INFO - Open directory for files ... 08:40:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 08:40:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:40:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:40:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 08:40:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:40:09 INFO - (blobuploader) - INFO - Done attempting. 08:40:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:40:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:40:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:40:16 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:40:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:40:16 INFO - (blobuploader) - INFO - Done attempting. 08:40:16 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 08:40:16 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:40:16 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:40:18 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 08:40:18 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:40:18 INFO - (blobuploader) - INFO - Done attempting. 08:40:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 08:40:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:40:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:40:19 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 08:40:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:40:19 INFO - (blobuploader) - INFO - Done attempting. 08:40:19 INFO - (blobuploader) - INFO - Iteration through files over. 08:40:19 INFO - Return code: 0 08:40:19 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:40:19 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:40:19 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/18ff5b77d67f3211ca1f1c75b3fe67264eceea2c98002653acb28a6503322e66968e165469ecd7d58eb95321f9e98091a425f8d282034a79b0a13d6c44734a19", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/7e087eb0a386ddd9ea09cd5b5efe0a201fe8828b06dd5fda9a0390846cbb4998fe3c0a5eba6bfaa650fa01d889b2859dda63ee50a8b9e982eadf56e39094acd7", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/034c3ff1ac64dfcf1589c419606ea121e781148fb4ceba475df1dfd0ee8c0417c79381996d7993b990c39c7663ddc33b36558321a8bebdb3f2bc24ba006b6924", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/29dc979b5f818d8a0418b273c61601a37ad3a91c5e1c3ef2df61a3dff30df86164a4ed474932cc9aff654516f850eb735d265170c1b176b809a75f89a86067d1"} 08:40:19 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:40:19 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:40:19 INFO - Contents: 08:40:19 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/18ff5b77d67f3211ca1f1c75b3fe67264eceea2c98002653acb28a6503322e66968e165469ecd7d58eb95321f9e98091a425f8d282034a79b0a13d6c44734a19", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/7e087eb0a386ddd9ea09cd5b5efe0a201fe8828b06dd5fda9a0390846cbb4998fe3c0a5eba6bfaa650fa01d889b2859dda63ee50a8b9e982eadf56e39094acd7", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/034c3ff1ac64dfcf1589c419606ea121e781148fb4ceba475df1dfd0ee8c0417c79381996d7993b990c39c7663ddc33b36558321a8bebdb3f2bc24ba006b6924", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/29dc979b5f818d8a0418b273c61601a37ad3a91c5e1c3ef2df61a3dff30df86164a4ed474932cc9aff654516f850eb735d265170c1b176b809a75f89a86067d1"} 08:40:19 INFO - Running post-run listener: copy_logs_to_upload_dir 08:40:19 INFO - Copying logs to upload dir... 08:40:19 INFO - mkdir: /builds/slave/test/build/upload/logs 08:40:19 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.890263 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2017-09-21 08:40:19.481883) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-21 08:40:19.488074) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/18ff5b77d67f3211ca1f1c75b3fe67264eceea2c98002653acb28a6503322e66968e165469ecd7d58eb95321f9e98091a425f8d282034a79b0a13d6c44734a19", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/7e087eb0a386ddd9ea09cd5b5efe0a201fe8828b06dd5fda9a0390846cbb4998fe3c0a5eba6bfaa650fa01d889b2859dda63ee50a8b9e982eadf56e39094acd7", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/034c3ff1ac64dfcf1589c419606ea121e781148fb4ceba475df1dfd0ee8c0417c79381996d7993b990c39c7663ddc33b36558321a8bebdb3f2bc24ba006b6924", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/29dc979b5f818d8a0418b273c61601a37ad3a91c5e1c3ef2df61a3dff30df86164a4ed474932cc9aff654516f850eb735d265170c1b176b809a75f89a86067d1"} build_url:https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011351 build_url: 'https://queue.taskcluster.net/v1/task/VSDIaYmzSnSLTWTcYt50dQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/18ff5b77d67f3211ca1f1c75b3fe67264eceea2c98002653acb28a6503322e66968e165469ecd7d58eb95321f9e98091a425f8d282034a79b0a13d6c44734a19", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/7e087eb0a386ddd9ea09cd5b5efe0a201fe8828b06dd5fda9a0390846cbb4998fe3c0a5eba6bfaa650fa01d889b2859dda63ee50a8b9e982eadf56e39094acd7", "dromaeojs-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/034c3ff1ac64dfcf1589c419606ea121e781148fb4ceba475df1dfd0ee8c0417c79381996d7993b990c39c7663ddc33b36558321a8bebdb3f2bc24ba006b6924", "perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta-Non-PGO/sha512/29dc979b5f818d8a0418b273c61601a37ad3a91c5e1c3ef2df61a3dff30df86164a4ed474932cc9aff654516f850eb735d265170c1b176b809a75f89a86067d1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-21 08:40:19.519783) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-21 08:40:19.520369) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1506006447.121778-1263721562 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004438 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-21 08:40:19.603130) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-21 08:40:19.603538) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-21 08:40:19.603881) ========= ========= Total master_lag: 0.21 =========