builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-062 starttime: 1460047654.5 results: success (0) buildid: 20160406112610 builduid: 54e806c800bf4a1c8905f8c301e39873 revision: 55f0de142be46043246b18108299aebf2bd95a64 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.505198) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.505688) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.505976) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] 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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.004983 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.527255) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.527547) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.540787) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.541144) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', '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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004563 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.590055) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.590373) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.590729) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.591003) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-07 09:47:35-- 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: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 67.3M=0s 2016-04-07 09:47:35 (67.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.147498 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.750834) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.751143) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] 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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023200 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:34.800887) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-07 09:47:34.801246) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 55f0de142be46043246b18108299aebf2bd95a64 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 55f0de142be46043246b18108299aebf2bd95a64 --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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-07 09:47:35,752 truncating revision to first 12 chars 2016-04-07 09:47:35,752 Setting DEBUG logging. 2016-04-07 09:47:35,752 attempt 1/10 2016-04-07 09:47:35,752 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/55f0de142be4?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-07 09:47:37,005 unpacking tar archive at: fx-team-55f0de142be4/testing/mozharness/ program finished with exit code 0 elapsedTime=1.524694 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-07 09:47:36.340220) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:36.340579) ========= echo 55f0de142be46043246b18108299aebf2bd95a64 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'55f0de142be46043246b18108299aebf2bd95a64'] 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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 55f0de142be46043246b18108299aebf2bd95a64 program finished with exit code 0 elapsedTime=0.004852 script_repo_revision: '55f0de142be46043246b18108299aebf2bd95a64' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:36.392338) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:36.392649) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-07 09:47:36.402386) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-04-07 09:47:36.402659) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-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', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:47:37 INFO - MultiFileLogger online at 20160407 09:47:37 in /builds/slave/test 09:47:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 09:47:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:47:37 INFO - {'append_to_log': False, 09:47:37 INFO - 'base_work_dir': '/builds/slave/test', 09:47:37 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 09:47:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:47:37 INFO - 'branch': 'Fx-Team-Non-PGO', 09:47:37 INFO - 'buildbot_json_path': 'buildprops.json', 09:47:37 INFO - 'config_files': ('talos/linux_config.py',), 09:47:37 INFO - 'default_actions': ('clobber', 09:47:37 INFO - 'read-buildbot-config', 09:47:37 INFO - 'download-and-extract', 09:47:37 INFO - 'populate-webroot', 09:47:37 INFO - 'create-virtualenv', 09:47:37 INFO - 'install', 09:47:37 INFO - 'run-tests'), 09:47:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:47:37 INFO - 'download_minidump_stackwalk': True, 09:47:37 INFO - 'download_symbols': 'ondemand', 09:47:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:47:37 INFO - 'tooltool.py': '/tools/tooltool.py', 09:47:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:47:37 INFO - '/tools/misc-python/virtualenv.py')}, 09:47:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:47:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:47:37 INFO - 'installer_path': 'installer.exe', 09:47:37 INFO - 'log_level': 'info', 09:47:37 INFO - 'log_name': 'talos', 09:47:37 INFO - 'log_to_console': True, 09:47:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:47:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:47:37 INFO - 'opt_config_files': (), 09:47:37 INFO - 'pip_index': False, 09:47:37 INFO - 'sps_profile': False, 09:47:37 INFO - 'sps_profile_interval': 0, 09:47:37 INFO - 'suite': 'dromaeojs-e10s', 09:47:37 INFO - 'system_bits': '32', 09:47:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:47:37 INFO - 'title': 'talos-linux64-ix-062', 09:47:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:47:37 INFO - 'use_talos_json': True, 09:47:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:47:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:47:37 INFO - 'work_dir': 'build'} 09:47:37 INFO - ##### 09:47:37 INFO - ##### Running clobber step. 09:47:37 INFO - ##### 09:47:37 INFO - Running pre-action listener: _resource_record_pre_action 09:47:37 INFO - Running main action method: clobber 09:47:37 INFO - rmtree: /builds/slave/test/build 09:47:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:47:37 INFO - Running post-action listener: _resource_record_post_action 09:47:37 INFO - ##### 09:47:37 INFO - ##### Running read-buildbot-config step. 09:47:37 INFO - ##### 09:47:37 INFO - Running pre-action listener: _resource_record_pre_action 09:47:37 INFO - Running main action method: read_buildbot_config 09:47:37 INFO - Using buildbot properties: 09:47:37 INFO - { 09:47:37 INFO - "project": "", 09:47:37 INFO - "product": "firefox", 09:47:37 INFO - "script_repo_revision": "production", 09:47:37 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 09:47:37 INFO - "repository": "", 09:47:37 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 09:47:37 INFO - "buildid": "20160406112610", 09:47:37 INFO - "pgo_build": "False", 09:47:37 INFO - "basedir": "/builds/slave/test", 09:47:37 INFO - "buildnumber": 1129, 09:47:37 INFO - "slavename": "talos-linux64-ix-062", 09:47:37 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 09:47:37 INFO - "platform": "ubuntu64_hw", 09:47:37 INFO - "scheduler": "tests-fx-team-linux64-talos", 09:47:37 INFO - "branch": "fx-team", 09:47:37 INFO - "repo_path": "integration/fx-team", 09:47:37 INFO - "revision": "55f0de142be46043246b18108299aebf2bd95a64", 09:47:37 INFO - "stage_platform": "linux64", 09:47:37 INFO - "builduid": "54e806c800bf4a1c8905f8c301e39873", 09:47:37 INFO - "slavebuilddir": "test" 09:47:37 INFO - } 09:47:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 09:47:37 INFO - Running post-action listener: _resource_record_post_action 09:47:37 INFO - ##### 09:47:37 INFO - ##### Running download-and-extract step. 09:47:37 INFO - ##### 09:47:37 INFO - Running pre-action listener: _resource_record_pre_action 09:47:37 INFO - Running main action method: download_and_extract 09:47:37 INFO - mkdir: /builds/slave/test/build/tests 09:47:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:37 INFO - https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 09:47:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 09:47:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 09:47:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 09:47:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 09:47:38 INFO - Downloaded 1361 bytes. 09:47:38 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 09:47:38 INFO - Using the following test package requirements: 09:47:38 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 09:47:38 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 09:47:38 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 09:47:38 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 09:47:38 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 09:47:38 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 09:47:38 INFO - u'jsshell-linux-x86_64.zip'], 09:47:38 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 09:47:38 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 09:47:38 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 09:47:38 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 09:47:38 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 09:47:38 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 09:47:38 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 09:47:38 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 09:47:38 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 09:47:38 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 09:47:38 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 09:47:38 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 09:47:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:38 INFO - https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:47:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 09:47:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 09:47:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 09:47:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:47:40 INFO - Downloaded 22136243 bytes. 09:47:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 09:47:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 09:47:41 INFO - Return code: 0 09:47:41 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 09:47:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:41 INFO - https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:47:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 09:47:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 09:47:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 09:47:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:47:43 INFO - Downloaded 22136243 bytes. 09:47:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 09:47:43 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 09:47:44 INFO - Return code: 0 09:47:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:44 INFO - https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 09:47:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 09:47:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 09:47:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 09:47:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 09:47:45 INFO - Downloaded 10847617 bytes. 09:47:45 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 09:47:45 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 09:47:46 INFO - Return code: 0 09:47:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:46 INFO - https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 09:47:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 09:47:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 09:47:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 09:47:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 09:47:47 INFO - Downloaded 54183057 bytes. 09:47:47 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 09:47:47 INFO - mkdir: /builds/slave/test/properties 09:47:47 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:47:47 INFO - Writing to file /builds/slave/test/properties/build_url 09:47:47 INFO - Contents: 09:47:47 INFO - build_url:https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 09:47:48 INFO - Running post-action listener: _resource_record_post_action 09:47:48 INFO - Running post-action listener: set_extra_try_arguments 09:47:48 INFO - ##### 09:47:48 INFO - ##### Running populate-webroot step. 09:47:48 INFO - ##### 09:47:48 INFO - Running pre-action listener: _resource_record_pre_action 09:47:48 INFO - Running main action method: populate_webroot 09:47:48 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:47:48 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:47:48 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:47:48 INFO - '--tppagecycles', 09:47:48 INFO - '7'], 09:47:48 INFO - 'tests': ['tsvgm']}}, 09:47:48 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:47:48 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:47:48 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:47:48 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:47:48 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:47:48 INFO - 'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:47:48 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:47:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:47:48 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:47:48 INFO - 'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['damp', 'tps']}, 09:47:48 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:47:48 INFO - 'tests': ['damp', 'tps']}, 09:47:48 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['dromaeo_dom']}, 09:47:48 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:47:48 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['a11yr', 09:47:48 INFO - 'ts_paint', 09:47:48 INFO - 'tpaint', 09:47:48 INFO - 'sessionrestore', 09:47:48 INFO - 'sessionrestore_no_auto_restore', 09:47:48 INFO - 'tabpaint']}, 09:47:48 INFO - 'other-e10s': {'tests': ['a11yr', 09:47:48 INFO - 'ts_paint', 09:47:48 INFO - 'tpaint', 09:47:48 INFO - 'sessionrestore', 09:47:48 INFO - 'sessionrestore_no_auto_restore', 09:47:48 INFO - 'tabpaint']}, 09:47:48 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:47:48 INFO - 'ts_paint', 09:47:48 INFO - 'tpaint', 09:47:48 INFO - 'sessionrestore', 09:47:48 INFO - 'sessionrestore_no_auto_restore', 09:47:48 INFO - 'tabpaint']}, 09:47:48 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:47:48 INFO - 'ts_paint', 09:47:48 INFO - 'tpaint', 09:47:48 INFO - 'sessionrestore', 09:47:48 INFO - 'sessionrestore_no_auto_restore', 09:47:48 INFO - 'tabpaint']}, 09:47:48 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['a11yr', 09:47:48 INFO - 'ts_paint', 09:47:48 INFO - 'tpaint', 09:47:48 INFO - 'sessionrestore', 09:47:48 INFO - 'sessionrestore_no_auto_restore', 09:47:48 INFO - 'tabpaint']}, 09:47:48 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['a11yr', 09:47:48 INFO - 'ts_paint', 09:47:48 INFO - 'tpaint', 09:47:48 INFO - 'sessionrestore', 09:47:48 INFO - 'sessionrestore_no_auto_restore', 09:47:48 INFO - 'tabpaint']}, 09:47:48 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['tsvgx', 09:47:48 INFO - 'tsvgr_opacity', 09:47:48 INFO - 'tart', 09:47:48 INFO - 'tscrollx', 09:47:48 INFO - 'cart']}, 09:47:48 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:47:48 INFO - 'tsvgr_opacity', 09:47:48 INFO - 'tart', 09:47:48 INFO - 'tscrollx', 09:47:48 INFO - 'cart']}, 09:47:48 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:47:48 INFO - 'talos_options': ['--disable-e10s'], 09:47:48 INFO - 'tests': ['tp5o']}, 09:47:48 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:47:48 INFO - 'tests': ['tp5o']}, 09:47:48 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:47:48 INFO - 'talos_options': ['--disable-e10s', 09:47:48 INFO - '--xperf_path', 09:47:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:47:48 INFO - 'tests': ['tp5n']}, 09:47:48 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:47:48 INFO - 'talos_options': ['--xperf_path', 09:47:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:47:48 INFO - 'tests': ['tp5n']}}, 09:47:48 INFO - 'talos.zip': {'path': '', 09:47:48 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:47:48 INFO - Running post-action listener: _resource_record_post_action 09:47:48 INFO - ##### 09:47:48 INFO - ##### Running create-virtualenv step. 09:47:48 INFO - ##### 09:47:48 INFO - Running pre-action listener: _resource_record_pre_action 09:47:48 INFO - Running main action method: create_virtualenv 09:47:48 INFO - Creating virtualenv /builds/slave/test/build/venv 09:47:48 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 09:47:48 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:47:48 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:47:48 INFO - Using real prefix '/usr' 09:47:48 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:47:48 INFO - Installing distribute.............................................................................................................................................................................................done. 09:47:50 INFO - Installing pip.................done. 09:47:50 INFO - Return code: 0 09:47:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:47:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:47:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:47:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:50 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:47:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:47:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 09:47:50 INFO - Using env: {'DISPLAY': ':0', 09:47:50 INFO - 'HOME': '/home/cltbld', 09:47:50 INFO - 'LANG': 'en_US.UTF-8', 09:47:50 INFO - 'LANGUAGE': 'en_US:en', 09:47:50 INFO - 'LOGNAME': 'cltbld', 09:47:50 INFO - 'MAIL': '/var/mail/cltbld', 09:47:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:47:50 INFO - 'MOZ_NO_REMOTE': '1', 09:47:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:47:50 INFO - 'NO_EM_RESTART': '1', 09:47:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:47:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:47:50 INFO - 'PWD': '/builds/slave/test', 09:47:50 INFO - 'SHELL': '/bin/bash', 09:47:50 INFO - 'SHLVL': '1', 09:47:50 INFO - 'TERM': 'linux', 09:47:50 INFO - 'TMOUT': '86400', 09:47:50 INFO - 'USER': 'cltbld', 09:47:50 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:47:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:47:50 INFO - '_': '/tools/buildbot/bin/python'} 09:47:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:47:51 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 09:47:51 INFO - Cleaning up... 09:47:51 INFO - Return code: 0 09:47:51 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 09:47:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:47:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:47:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:51 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:47:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 09:47:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 09:47:51 INFO - Using env: {'DISPLAY': ':0', 09:47:51 INFO - 'HOME': '/home/cltbld', 09:47:51 INFO - 'LANG': 'en_US.UTF-8', 09:47:51 INFO - 'LANGUAGE': 'en_US:en', 09:47:51 INFO - 'LOGNAME': 'cltbld', 09:47:51 INFO - 'MAIL': '/var/mail/cltbld', 09:47:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:47:51 INFO - 'MOZ_NO_REMOTE': '1', 09:47:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:47:51 INFO - 'NO_EM_RESTART': '1', 09:47:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:47:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:47:51 INFO - 'PWD': '/builds/slave/test', 09:47:51 INFO - 'SHELL': '/bin/bash', 09:47:51 INFO - 'SHLVL': '1', 09:47:51 INFO - 'TERM': 'linux', 09:47:51 INFO - 'TMOUT': '86400', 09:47:51 INFO - 'USER': 'cltbld', 09:47:51 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:47:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:47:51 INFO - '_': '/tools/buildbot/bin/python'} 09:47:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:47:51 INFO - Downloading/unpacking psutil>=0.7.1 09:47:51 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 09:47:51 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 09:47:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:51 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 09:47:51 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 09:47:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:47:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:47:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:47:53 INFO - Installing collected packages: psutil 09:47:53 INFO - Running setup.py install for psutil 09:47:53 INFO - building 'psutil._psutil_linux' extension 09:47:53 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 09:47:53 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 09:47:53 INFO - building 'psutil._psutil_posix' extension 09:47:53 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 09:47:53 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 09:47:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:47:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:47:53 INFO - Successfully installed psutil 09:47:53 INFO - Cleaning up... 09:47:53 INFO - Return code: 0 09:47:53 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 09:47:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:47:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:47:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:53 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:47:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 09:47:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 09:47:53 INFO - Using env: {'DISPLAY': ':0', 09:47:53 INFO - 'HOME': '/home/cltbld', 09:47:53 INFO - 'LANG': 'en_US.UTF-8', 09:47:53 INFO - 'LANGUAGE': 'en_US:en', 09:47:53 INFO - 'LOGNAME': 'cltbld', 09:47:53 INFO - 'MAIL': '/var/mail/cltbld', 09:47:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:47:53 INFO - 'MOZ_NO_REMOTE': '1', 09:47:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:47:53 INFO - 'NO_EM_RESTART': '1', 09:47:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:47:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:47:53 INFO - 'PWD': '/builds/slave/test', 09:47:53 INFO - 'SHELL': '/bin/bash', 09:47:53 INFO - 'SHLVL': '1', 09:47:53 INFO - 'TERM': 'linux', 09:47:53 INFO - 'TMOUT': '86400', 09:47:53 INFO - 'USER': 'cltbld', 09:47:53 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:47:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:47:53 INFO - '_': '/tools/buildbot/bin/python'} 09:47:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:47:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 09:47:54 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 09:47:54 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 09:47:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:54 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 09:47:54 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 09:47:55 INFO - Downloading mozsystemmonitor-0.0.tar.gz 09:47:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:47:55 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 09:47:56 INFO - Installing collected packages: mozsystemmonitor 09:47:56 INFO - Running setup.py install for mozsystemmonitor 09:47:56 INFO - Successfully installed mozsystemmonitor 09:47:56 INFO - Cleaning up... 09:47:56 INFO - Return code: 0 09:47:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:47:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:47:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:47:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:56 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:47:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:47:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 09:47:56 INFO - Using env: {'DISPLAY': ':0', 09:47:56 INFO - 'HOME': '/home/cltbld', 09:47:56 INFO - 'LANG': 'en_US.UTF-8', 09:47:56 INFO - 'LANGUAGE': 'en_US:en', 09:47:56 INFO - 'LOGNAME': 'cltbld', 09:47:56 INFO - 'MAIL': '/var/mail/cltbld', 09:47:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:47:56 INFO - 'MOZ_NO_REMOTE': '1', 09:47:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:47:56 INFO - 'NO_EM_RESTART': '1', 09:47:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:47:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:47:56 INFO - 'PWD': '/builds/slave/test', 09:47:56 INFO - 'SHELL': '/bin/bash', 09:47:56 INFO - 'SHLVL': '1', 09:47:56 INFO - 'TERM': 'linux', 09:47:56 INFO - 'TMOUT': '86400', 09:47:56 INFO - 'USER': 'cltbld', 09:47:56 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:47:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:47:56 INFO - '_': '/tools/buildbot/bin/python'} 09:47:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:47:56 INFO - Downloading/unpacking blobuploader==1.2.4 09:47:56 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 09:47:56 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 09:47:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:56 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 09:47:56 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 09:47:58 INFO - Downloading blobuploader-1.2.4.tar.gz 09:47:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:47:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:47:58 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 09:47:58 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 09:47:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:58 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 09:47:58 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 09:47:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:47:58 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:47:58 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 09:47:58 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 09:47:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:47:58 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 09:47:58 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 09:47:58 INFO - Downloading docopt-0.6.1.tar.gz 09:47:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:47:59 INFO - Installing collected packages: blobuploader, requests, docopt 09:47:59 INFO - Running setup.py install for blobuploader 09:47:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:47:59 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:47:59 INFO - Running setup.py install for requests 09:47:59 INFO - Running setup.py install for docopt 09:47:59 INFO - Successfully installed blobuploader requests docopt 09:47:59 INFO - Cleaning up... 09:47:59 INFO - Return code: 0 09:47:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:47:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:47:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:47:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:47:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:47:59 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:47:59 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:47:59 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:47:59 INFO - Using env: {'DISPLAY': ':0', 09:47:59 INFO - 'HOME': '/home/cltbld', 09:47:59 INFO - 'LANG': 'en_US.UTF-8', 09:47:59 INFO - 'LANGUAGE': 'en_US:en', 09:47:59 INFO - 'LOGNAME': 'cltbld', 09:47:59 INFO - 'MAIL': '/var/mail/cltbld', 09:47:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:47:59 INFO - 'MOZ_NO_REMOTE': '1', 09:47:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:47:59 INFO - 'NO_EM_RESTART': '1', 09:47:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:47:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:47:59 INFO - 'PWD': '/builds/slave/test', 09:47:59 INFO - 'SHELL': '/bin/bash', 09:47:59 INFO - 'SHLVL': '1', 09:47:59 INFO - 'TERM': 'linux', 09:47:59 INFO - 'TMOUT': '86400', 09:47:59 INFO - 'USER': 'cltbld', 09:47:59 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:47:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:47:59 INFO - '_': '/tools/buildbot/bin/python'} 09:47:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:47:59 INFO - Running setup.py (path:/tmp/pip-_31Nqb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:47:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:47:59 INFO - Running setup.py (path:/tmp/pip-L35bKK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:48:00 INFO - Running setup.py (path:/tmp/pip-Gj_4ms-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:48:00 INFO - Running setup.py (path:/tmp/pip-lH5SM_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:48:00 INFO - Running setup.py (path:/tmp/pip-1DB5Sm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:48:00 INFO - Running setup.py (path:/tmp/pip-DhwBeB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:48:00 INFO - Running setup.py (path:/tmp/pip-CHON2I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:48:00 INFO - Running setup.py (path:/tmp/pip-tjgnll-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:48:00 INFO - Running setup.py (path:/tmp/pip-BVsURZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:48:00 INFO - Running setup.py (path:/tmp/pip-ak0a4V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:48:00 INFO - Running setup.py (path:/tmp/pip-1b3ZOs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:48:00 INFO - Running setup.py (path:/tmp/pip-910YbG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:48:00 INFO - Running setup.py (path:/tmp/pip-M04S_E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:48:00 INFO - Running setup.py (path:/tmp/pip-6E3EUV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:48:00 INFO - Running setup.py (path:/tmp/pip-eI0_fZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:48:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:48:00 INFO - Running setup.py (path:/tmp/pip-rkSiL0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:48:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:48:01 INFO - Running setup.py (path:/tmp/pip-mrp0IG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:48:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:48:01 INFO - Running setup.py install for manifestparser 09:48:01 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Running setup.py install for mozcrash 09:48:01 INFO - Running setup.py install for mozdebug 09:48:01 INFO - Running setup.py install for mozdevice 09:48:01 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Running setup.py install for mozfile 09:48:01 INFO - Running setup.py install for mozhttpd 09:48:01 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Running setup.py install for mozinfo 09:48:01 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Running setup.py install for mozInstall 09:48:01 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:48:01 INFO - Running setup.py install for mozleak 09:48:01 INFO - Running setup.py install for mozlog 09:48:02 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:48:02 INFO - Running setup.py install for moznetwork 09:48:02 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:48:02 INFO - Running setup.py install for mozprocess 09:48:02 INFO - Running setup.py install for mozprofile 09:48:02 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:48:02 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:48:02 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:48:02 INFO - Running setup.py install for mozrunner 09:48:02 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:48:02 INFO - Running setup.py install for mozscreenshot 09:48:02 INFO - Running setup.py install for moztest 09:48:02 INFO - Running setup.py install for mozversion 09:48:02 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:48:02 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:48:02 INFO - Cleaning up... 09:48:02 INFO - Return code: 0 09:48:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:48:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:48:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:48:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:48:02 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:48:02 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:48:02 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:48:02 INFO - Using env: {'DISPLAY': ':0', 09:48:02 INFO - 'HOME': '/home/cltbld', 09:48:02 INFO - 'LANG': 'en_US.UTF-8', 09:48:02 INFO - 'LANGUAGE': 'en_US:en', 09:48:02 INFO - 'LOGNAME': 'cltbld', 09:48:02 INFO - 'MAIL': '/var/mail/cltbld', 09:48:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:48:02 INFO - 'MOZ_NO_REMOTE': '1', 09:48:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:48:02 INFO - 'NO_EM_RESTART': '1', 09:48:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:48:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:48:02 INFO - 'PWD': '/builds/slave/test', 09:48:02 INFO - 'SHELL': '/bin/bash', 09:48:02 INFO - 'SHLVL': '1', 09:48:02 INFO - 'TERM': 'linux', 09:48:02 INFO - 'TMOUT': '86400', 09:48:02 INFO - 'USER': 'cltbld', 09:48:02 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:48:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:48:02 INFO - '_': '/tools/buildbot/bin/python'} 09:48:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:48:03 INFO - Running setup.py (path:/tmp/pip-hjVGvF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:48:03 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:48:03 INFO - Running setup.py (path:/tmp/pip-Fi9koH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:48:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:48:03 INFO - Running setup.py (path:/tmp/pip-RT7FhV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:48:03 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:48:03 INFO - Running setup.py (path:/tmp/pip-kEySFi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:48:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:48:03 INFO - Running setup.py (path:/tmp/pip-IYh_ip-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:48:03 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:48:03 INFO - Running setup.py (path:/tmp/pip-nvPQC3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:48:03 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:48:03 INFO - Running setup.py (path:/tmp/pip-sl0qLj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:48:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:48:03 INFO - Running setup.py (path:/tmp/pip-YT3ycs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:48:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:48:03 INFO - Running setup.py (path:/tmp/pip-5rF9X9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:48:03 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:48:03 INFO - Running setup.py (path:/tmp/pip-cXNhUr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:48:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:48:03 INFO - Running setup.py (path:/tmp/pip-GCl52p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:48:03 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:48:03 INFO - Running setup.py (path:/tmp/pip-3F1ytd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:48:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 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)) 09:48:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:48:04 INFO - Running setup.py (path:/tmp/pip-qTM5LR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:48:04 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)) 09:48:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:48:04 INFO - Running setup.py (path:/tmp/pip-88rr9X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:48:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 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)) 09:48:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:48:04 INFO - Running setup.py (path:/tmp/pip-1YnZ_I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:48:04 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)) 09:48:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:48:04 INFO - Running setup.py (path:/tmp/pip-j9d069-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:48:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 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)) 09:48:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:48:04 INFO - Running setup.py (path:/tmp/pip-J4xZIW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:48:04 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)) 09:48:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:48:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:48:04 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)) 09:48:04 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:48:04 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:48:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:48:04 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 09:48:04 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 09:48:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:04 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 09:48:04 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 09:48:06 INFO - Downloading blessings-1.6.tar.gz 09:48:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:48:06 INFO - Installing collected packages: blessings 09:48:06 INFO - Running setup.py install for blessings 09:48:06 INFO - Successfully installed blessings 09:48:06 INFO - Cleaning up... 09:48:06 INFO - Return code: 0 09:48:06 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:48:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:48:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:48:06 INFO - Reading from file tmpfile_stdout 09:48:06 INFO - Current package versions: 09:48:06 INFO - argparse == 1.2.1 09:48:06 INFO - blessings == 1.6 09:48:06 INFO - blobuploader == 1.2.4 09:48:06 INFO - docopt == 0.6.1 09:48:06 INFO - manifestparser == 1.1 09:48:06 INFO - mozInstall == 1.12 09:48:06 INFO - mozcrash == 0.17 09:48:06 INFO - mozdebug == 0.1 09:48:06 INFO - mozdevice == 0.48 09:48:06 INFO - mozfile == 1.2 09:48:06 INFO - mozhttpd == 0.7 09:48:06 INFO - mozinfo == 0.9 09:48:06 INFO - mozleak == 0.1 09:48:06 INFO - mozlog == 3.1 09:48:06 INFO - moznetwork == 0.27 09:48:06 INFO - mozprocess == 0.22 09:48:06 INFO - mozprofile == 0.28 09:48:06 INFO - mozrunner == 6.11 09:48:06 INFO - mozscreenshot == 0.1 09:48:06 INFO - mozsystemmonitor == 0.0 09:48:06 INFO - moztest == 0.7 09:48:06 INFO - mozversion == 1.4 09:48:06 INFO - psutil == 3.1.1 09:48:06 INFO - requests == 1.2.3 09:48:06 INFO - wsgiref == 0.1.2 09:48:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:48:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:48:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:48:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:48:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:48:06 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:48:06 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 09:48:06 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 09:48:06 INFO - Using env: {'DISPLAY': ':0', 09:48:06 INFO - 'HOME': '/home/cltbld', 09:48:06 INFO - 'LANG': 'en_US.UTF-8', 09:48:06 INFO - 'LANGUAGE': 'en_US:en', 09:48:06 INFO - 'LOGNAME': 'cltbld', 09:48:06 INFO - 'MAIL': '/var/mail/cltbld', 09:48:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:48:06 INFO - 'MOZ_NO_REMOTE': '1', 09:48:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:48:06 INFO - 'NO_EM_RESTART': '1', 09:48:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:48:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:48:06 INFO - 'PWD': '/builds/slave/test', 09:48:06 INFO - 'SHELL': '/bin/bash', 09:48:06 INFO - 'SHLVL': '1', 09:48:06 INFO - 'TERM': 'linux', 09:48:06 INFO - 'TMOUT': '86400', 09:48:06 INFO - 'USER': 'cltbld', 09:48:06 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:48:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:48:06 INFO - '_': '/tools/buildbot/bin/python'} 09:48:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 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)) 09:48:06 INFO - Cleaning up... 09:48:06 INFO - Return code: 0 09:48:06 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:48:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:48:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:48:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:48:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:48:06 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:48:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 09:48:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 09:48:06 INFO - Using env: {'DISPLAY': ':0', 09:48:06 INFO - 'HOME': '/home/cltbld', 09:48:06 INFO - 'LANG': 'en_US.UTF-8', 09:48:06 INFO - 'LANGUAGE': 'en_US:en', 09:48:06 INFO - 'LOGNAME': 'cltbld', 09:48:06 INFO - 'MAIL': '/var/mail/cltbld', 09:48:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:48:06 INFO - 'MOZ_NO_REMOTE': '1', 09:48:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:48:06 INFO - 'NO_EM_RESTART': '1', 09:48:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:48:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:48:06 INFO - 'PWD': '/builds/slave/test', 09:48:06 INFO - 'SHELL': '/bin/bash', 09:48:06 INFO - 'SHLVL': '1', 09:48:06 INFO - 'TERM': 'linux', 09:48:06 INFO - 'TMOUT': '86400', 09:48:06 INFO - 'USER': 'cltbld', 09:48:06 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:48:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:48:06 INFO - '_': '/tools/buildbot/bin/python'} 09:48:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:48:07 INFO - Downloading/unpacking jsonschema 09:48:07 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 09:48:07 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 09:48:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:07 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 09:48:07 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 09:48:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:48:09 INFO - Downloading/unpacking functools32 (from jsonschema) 09:48: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 09:48: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 09:48:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48: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 09:48: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 09:48:09 INFO - Downloading functools32-3.2.3-2.tar.gz 09:48:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:48:09 INFO - warning: no files found matching '*.txt' 09:48:09 INFO - no previously-included directories found matching 'build' 09:48:09 INFO - no previously-included directories found matching 'dist' 09:48:09 INFO - no previously-included directories found matching '.git*' 09:48:09 INFO - Installing collected packages: jsonschema, functools32 09:48:09 INFO - Running setup.py install for functools32 09:48:09 INFO - warning: no files found matching '*.txt' 09:48:09 INFO - no previously-included directories found matching 'build' 09:48:09 INFO - no previously-included directories found matching 'dist' 09:48:09 INFO - no previously-included directories found matching '.git*' 09:48:09 INFO - Successfully installed jsonschema functools32 09:48:09 INFO - Cleaning up... 09:48:09 INFO - Return code: 0 09:48:09 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 09:48:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:48:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:48:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:48:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:48: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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f4c664bcf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e275a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', '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 09:48:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 09:48:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 09:48:09 INFO - Using env: {'DISPLAY': ':0', 09:48:09 INFO - 'HOME': '/home/cltbld', 09:48:09 INFO - 'LANG': 'en_US.UTF-8', 09:48:09 INFO - 'LANGUAGE': 'en_US:en', 09:48:09 INFO - 'LOGNAME': 'cltbld', 09:48:09 INFO - 'MAIL': '/var/mail/cltbld', 09:48:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:48:09 INFO - 'MOZ_NO_REMOTE': '1', 09:48:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:48:09 INFO - 'NO_EM_RESTART': '1', 09:48:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:48:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:48:09 INFO - 'PWD': '/builds/slave/test', 09:48:09 INFO - 'SHELL': '/bin/bash', 09:48:09 INFO - 'SHLVL': '1', 09:48:09 INFO - 'TERM': 'linux', 09:48:09 INFO - 'TMOUT': '86400', 09:48:09 INFO - 'USER': 'cltbld', 09:48:09 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:48:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:48:09 INFO - '_': '/tools/buildbot/bin/python'} 09:48:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:48:09 INFO - Downloading/unpacking flake8 09:48: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 09:48: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 09:48:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48: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 09:48: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 09:48:11 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 09:48:11 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 09:48: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 09:48: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 09:48:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48: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 09:48: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 09:48:11 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 09:48:11 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 09:48: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 09:48: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 09:48:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48: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 09:48: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 09:48:12 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 09:48:12 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 09:48:12 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 09:48:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:48:12 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 09:48:12 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 09:48:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 09:48:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 09:48:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 09:48:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 09:48:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 09:48:12 INFO - no previously-included directories found matching 'docs/_build' 09:48:12 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 09:48:12 INFO - Running setup.py install for pep8 09:48:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 09:48:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 09:48:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 09:48:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 09:48:12 INFO - no previously-included directories found matching 'docs/_build' 09:48:12 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 09:48:12 INFO - Successfully installed flake8 mccabe pyflakes pep8 09:48:12 INFO - Cleaning up... 09:48:12 INFO - Return code: 0 09:48:12 INFO - Running post-action listener: _resource_record_post_action 09:48:12 INFO - Running post-action listener: _start_resource_monitoring 09:48:12 INFO - Starting resource monitoring. 09:48:12 INFO - ##### 09:48:12 INFO - ##### Running install step. 09:48:12 INFO - ##### 09:48:12 INFO - Running pre-action listener: _resource_record_pre_action 09:48:12 INFO - Running main action method: install 09:48:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:48:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:48:12 INFO - Reading from file tmpfile_stdout 09:48:12 INFO - Detecting whether we're running mozinstall >=1.0... 09:48:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:48:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:48:12 INFO - Reading from file tmpfile_stdout 09:48:12 INFO - Output received: 09:48:12 INFO - Usage: mozinstall [options] installer 09:48:12 INFO - Options: 09:48:12 INFO - -h, --help show this help message and exit 09:48:12 INFO - -d DEST, --destination=DEST 09:48:12 INFO - Directory to install application into. [default: 09:48:12 INFO - "/builds/slave/test"] 09:48:12 INFO - --app=APP Application being installed. [default: firefox] 09:48:12 INFO - mkdir: /builds/slave/test/build/application 09:48:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 09:48:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 09:48:28 INFO - Reading from file tmpfile_stdout 09:48:28 INFO - Output received: 09:48:28 INFO - /builds/slave/test/build/application/firefox/firefox 09:48:28 INFO - Running post-action listener: _resource_record_post_action 09:48:28 INFO - ##### 09:48:28 INFO - ##### Running run-tests step. 09:48:28 INFO - ##### 09:48:28 INFO - Running pre-action listener: _resource_record_pre_action 09:48:28 INFO - Running main action method: run_tests 09:48:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:48:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:48:28 INFO - Python 2.7.3 09:48:28 INFO - Return code: 0 09:48:28 INFO - grabbing minidump binary from tooltool 09:48:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:48:28 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1eb6410>, '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 0x1eb7310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1eb77a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:48:28 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--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 09:48:28 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 09:48:28 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:48:28 INFO - Return code: 0 09:48:28 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:48:28 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:48:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:48:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:48:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:48:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 09:48:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 09:48:29 INFO - Return code: 0 09:48:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--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 09:48:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-062 --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 09:48:29 INFO - Using env: {'DISPLAY': ':0', 09:48:29 INFO - 'HOME': '/home/cltbld', 09:48:29 INFO - 'LANG': 'en_US.UTF-8', 09:48:29 INFO - 'LANGUAGE': 'en_US:en', 09:48:29 INFO - 'LOGNAME': 'cltbld', 09:48:29 INFO - 'MAIL': '/var/mail/cltbld', 09:48:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:48:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:48:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:48:29 INFO - 'MOZ_NO_REMOTE': '1', 09:48:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:48:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:48:29 INFO - 'NO_EM_RESTART': '1', 09:48:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:48:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:48:29 INFO - 'PWD': '/builds/slave/test', 09:48:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:48:29 INFO - 'SHELL': '/bin/bash', 09:48:29 INFO - 'SHLVL': '1', 09:48:29 INFO - 'TERM': 'linux', 09:48:29 INFO - 'TMOUT': '86400', 09:48:29 INFO - 'USER': 'cltbld', 09:48:29 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235', 09:48:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:48:29 INFO - '_': '/tools/buildbot/bin/python'} 09:48:29 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--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 09:48:29 INFO - mozversion application_buildid: 20160406112610 09:48:29 INFO - mozversion application_changeset: 55f0de142be46043246b18108299aebf2bd95a64 09:48:29 INFO - mozversion application_display_name: Nightly 09:48:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:48:29 INFO - mozversion application_name: Firefox 09:48:29 INFO - mozversion application_remotingname: firefox 09:48:29 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 09:48:29 INFO - mozversion application_vendor: Mozilla 09:48:29 INFO - mozversion application_version: 48.0a1 09:48:29 INFO - mozversion platform_buildid: 20160406112610 09:48:29 INFO - mozversion platform_changeset: 55f0de142be46043246b18108299aebf2bd95a64 09:48:29 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 09:48:29 INFO - mozversion platform_version: 48.0a1 09:48:29 INFO - using testdate: 1460047709 09:48:29 INFO - actual date: 1460047709 09:48:29 INFO - starting webserver on 'localhost:35908' 09:48:29 INFO - SUITE-START | Running 2 tests 09:48:29 INFO - TEST-START | dromaeo_css 09:48:29 INFO - operating with platform_type : linux_ 09:48:29 INFO - Initialising browser for dromaeo_css test... 09:48:29 INFO - TEST-INFO | started process 32658 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmppgnCKf/profile http://localhost:35908/getInfo.html) 09:48:33 INFO - PROCESS | 32658 | 09:48:33 INFO - PROCESS | 32658 | (process:32728): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 09:48:33 INFO - PROCESS | 32658 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 09:48:34 INFO - PROCESS | 32658 | __metrics Screen width/height:1600/1200 09:48:34 INFO - PROCESS | 32658 | colorDepth:24 09:48:34 INFO - PROCESS | 32658 | Browser inner width/height: 1024/697 09:48:34 INFO - PROCESS | 32658 | __metrics 09:48:34 ERROR - PROCESS | 32658 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2881: TypeError: this.tabs is undefined 09:48:35 INFO - TEST-INFO | 32658: exit 0 09:48:35 INFO - Browser initialized. 09:48:35 INFO - Running cycle 1/1 for dromaeo_css test... 09:48:35 INFO - TEST-INFO | started process 311 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmppgnCKf/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:48:37 INFO - PROCESS | 311 | 09:48:37 INFO - PROCESS | 311 | (process:369): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 09:48:47 INFO - PROCESS | 311 | RSS: Main: 164454400 09:48:47 INFO - PROCESS | 311 | 09:49:37 INFO - PROCESS | 311 | 1460047777014 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 09:51:48 INFO - PROCESS | 311 | Cycle 1(1): loaded http://localhost:35908/tests/dromaeo/cssquery-dojo.html (next: http://localhost:35908/tests/dromaeo/cssquery-ext.html) 09:51:49 INFO - PROCESS | 311 | RSS: Main: 168714240 09:51:49 INFO - PROCESS | 311 | 09:54:51 INFO - PROCESS | 311 | Cycle 1(1): loaded http://localhost:35908/tests/dromaeo/cssquery-ext.html (next: http://localhost:35908/tests/dromaeo/cssquery-jquery.html) 09:54:52 INFO - PROCESS | 311 | RSS: Main: 165732352 09:54:52 INFO - PROCESS | 311 | 09:57:53 INFO - PROCESS | 311 | Cycle 1(1): loaded http://localhost:35908/tests/dromaeo/cssquery-jquery.html (next: http://localhost:35908/tests/dromaeo/cssquery-mootools.html) 09:57:54 INFO - PROCESS | 311 | RSS: Main: 166473728 09:57:54 INFO - PROCESS | 311 | 10:00:56 INFO - PROCESS | 311 | Cycle 1(1): loaded http://localhost:35908/tests/dromaeo/cssquery-mootools.html (next: http://localhost:35908/tests/dromaeo/cssquery-prototype.html) 10:00:56 INFO - PROCESS | 311 | RSS: Main: 164831232 10:00:56 INFO - PROCESS | 311 | 10:03:59 INFO - PROCESS | 311 | Cycle 1(1): loaded http://localhost:35908/tests/dromaeo/cssquery-prototype.html (next: http://localhost:35908/tests/dromaeo/cssquery-yui.html) 10:04:00 INFO - PROCESS | 311 | RSS: Main: 165572608 10:04:00 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | Cycle 1(1): loaded http://localhost:35908/tests/dromaeo/cssquery-yui.html (next: http://localhost:35908/tests/dromaeo/cssquery-dojo.html) 10:07:02 INFO - PROCESS | 311 | RSS: Main: 168046592 10:07:02 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | __start_tp_report 10:07:02 INFO - PROCESS | 311 | _x_x_mozilla_page_load 10:07:02 INFO - PROCESS | 311 | _x_x_mozilla_page_load_details 10:07:02 INFO - PROCESS | 311 | |i|pagename|runs| 10:07:02 INFO - PROCESS | 311 | |0;dojo.html;2601.518719036978;2706.594010898365;2719.7960152988508;2730.112713368155;2731.4810186064633;4742.596879265262;4758.191107511731;4760.90478190436;4769.236922092466;4773.403324584427;4714.434267887858;4770.570648641621;4813.951860481394;4891;4891.6331275154325;4398.428204333432;4411.889702757425;4499.595036446735;4514.052049069699;4599.2871104978785;4439.711418757786;4445.84439544616;4478.910421791562;4495.415595972519;4497.078098989716;4382.824687012531;4402.537733537996;4403.64770818337;4446.93329600053;4489.236829738919;4394.362817391492;4394.868153955386;4398.824047038147;4431.667624928144;4466.687331886769;4283.100548884738;4336.284513055342;4373.693841431101;4385.079133381993;4408.911821763579;4633.536646335373;4654;4658.021815418766;4685.2269375553;4713.316569097462;5075.6447048706605;5115.693058416507;5119.180931051014;5133.512316329943;5146.974265128651;5018.096742586333;5036.420811606676;5136.691798492065;5160.432352441228;5198.896022079575;4736.384270044872;4737.526247375304;4749.145153872301;4792.137415265216;4844.733539655317;5208.7916483341;5224.03355379256;5249.212618107238;5257.027449921777;5276.261323414725;4823;4928.186849169919;4945.480724523945;4948.628852836052;5110.029094472113;5125.308083408767;5196.168613021899;5198.948010519846;5221.451747566451;5248.868778280574;5062.316587260672;5082.390113186368;5085.059264036091;5095.082885080721;5145.45972672864;4975.502449754996;5049.520295571915;5054.7978080876355;5067.87330316745;5068.82259120929;4369.453818272716;4373.475182978;4377.671674624416;4409.5149533551285;4412.536683648235;3810.8094595270127;3818.503594532693;3821.675157611634;3847.211321679049;3858.3055050090693;4290.828366865353;4442.822287108479;4502.887427814331;4503.729776213438;4514.0971805639;5071.771770270347;5078.314427552307;5122.180451127876;5146.588272938231;5176.068307704574;4438.755868427203;4457.4205353304515;4467.664925130628;4484.12559550891;4519.977400112978;4513.300438432048;4575.931361029588;4591.655625828076;4602.309653551927;4653.837115700934;4812.663113582085;4832.927506087482;4853;4891.144049791344;4924.212126059813;5168.0697474454955;5175.197844334134;5185.351831021122;5189.325387699575;5238.292830467838;4689.906201875875;4736.478987311324;4810.494898035796;4864.051509955525;4930.531599498186;5052.646314758079;5061.797528098835;5079.212722028092;5083.1358669027095;5101.20931255656;5148.0476111919415;5151.922721159261;5157.045946499909;5171.612129090408;5193.402758682649;4743.573078422958;4993.750312484434;5030.8239211627415;5082.796688132434;5111.744412779271;4978.352814134139;5000.724960127228;5001.799928002839;5005.824796132118;5044.772985215747;4864.221724524059;4896.167651499325;4902.9019419610695;4920.975395123145;4948.134076536519;4944.92582611254;4978.228374601942;5046.268291097844;5065.265536497261;5071.1632580625255;4915.287283343823;4920.286558449076;4977.352944117241;4982.526659967298;5013.248012797963 10:07:02 INFO - PROCESS | 311 | |1;ext.html;533.2135100726427;539.7759929629204;543.1635281666232;557.7824648387128;568.6218664588049;36167.63832361675;36758.081047973814;36769.44845827312;36857.26285474289;36910.26179476409;37978;38375.80812095936;38470.23059538808;38728.419073713914;38752.612473875255;7598.468107232482;7761.301482866569;7768.57272849993;7784.844303113934;7788.571628560427;7640.274173953466;7759.573223472707;7792.10390805059;7794.298513133816;7797.337226335769;7686.308232259095;7717.803740420216;7748.108967468757;7793.532388056707;7821.178776228499;7670.731524396647;7742.496737712059;7763.961180194091;7770.145284018753;7815.8436831263625;7687.500312479727;7767.262110099531;7791.181925897812;7813.492123011986;7815.53106813593;34088.65911340904;34399.828000860085;34570.827145864365;34613.82693086519;34751.82624086889;2989.446952313829;2999.0852789899072;3045.8172509649494;3093.551435041906;3127.781055326128;27809.304767380774;28159.436811263866;28231;28393.290167745767;29166.27084322909;3417.2994536120036;3459.290845376717;3493.1441796759705;3500.1424650960676;3601.1897323102353;226630;228055;231276.9999999983;231696;232812;41099.589004110174;50811.491885081414;52652;52972.735136324074;53346.46653533493;38713.41929871054;38867;38970.2205955885;39269.6073039266;39333.213335733126;13284.335783210994;13615.115017524027;13622;13640.795388069188;13690.452381904612;10630.521626526825;10720.195985301134;10768.892311076946;10770.353778773298;10819.513121909533;13806.240656763774;13819.792703109462;14322.281326240918;14327.283635818376;14397.064190827563;5649.180868774005;5689.6586204827845;5762.596618236683;5813.273340832396;5885.735141918624;901.7069452427987;922.8707980882682;977.1791694976254;995.3182070281736;1007.1338648762058;26104.73895261061;26186.86906565493;26582;27022.32444188911;27064.864675676494;957.5978089202551;964.5129209749172;1002.5789168549227;1013.3109485549896;1016.6594190946116;13356.933215334055;13469.932650336686;13475.460981560627;13596.524121655695;13719.45122195101;356707;358405;361770;362151;364068;46305.768471157426;46460.5353946463;46602.76698616553;46745.766271168424;46800;1218.7014181525406;1220.652114147446;1246.389269258057;1247.1020864977202;1251.5869762978195;24613.261602151248;25435.872820635777;25614.23157305284;25729.485410291316;25830;34765;35320;35361;35405.114872128404;35510.46734299039;260469;261463;261764;262284;262487;30658.84670576633;30785.384292314477;30911.536326955564;31085.68914310828;31550.36899262048;37857.2428551433;38550.2289954205;38984.610153898095;39231.80384098061;39297.80351098226;32101.197470063435;32437.67562324441;32942.67057329396;33397.49903751494;33767.4934875982;32272.35455290928;32717.672823271463;32854.507182391804;32985.34029319448;33419.66580334263;33285.16787080342;33343.49984750279;37199.62800371962;38701;38765.806170968965;28600.713992859804;31215.84392078116;31540.52689209618;31542.526862096627;31557.8422107888;24131.155409560582;24640.419581116883;24805.99398023491;24869.25392238236;24894.875525622258 10:07:02 INFO - PROCESS | 311 | |2;jquery.html;329.3741890408225;338.9711874490668;348.8587122215504;352.6138877928669;358.16904780908305;14913;15529.92235038826;15566.066036037846;15642.765358519631;16184.271707773149;14929.850701492982;15150.696986060273;15341.769873451907;15459.381624735026;15497.457588984387;4770.403699537549;5017.724025178613;5025.246213068051;5027.84916452507;5035.546800787928;4647.163510568096;4843.15244832153;4894.902101957977;4897.436794768594;4899.559039686427;4768.380110585619;4769.855234743672;4775.617950563947;4782.473927867949;4802.03959208158;4574.954250457503;4788;4824.276358546211;4910.975445122787;4918.901621967577;4372.540883207249;4382.211201983641;4393.868183954486;4395.912081758347;4396.450443694538;18323;18526.722099168524;18617.627647446974;18924.621507569907;18996.62006759857;1873.3443294846695;1882.6893562562161;1885.8397036251936;1941.0585865855048;2003.0185209247509;12545.498180072786;12617.179883307555;12663.620091397273;12772.680682982907;13059.085863989525;1738.5392870889225;1767.2047578589686;1791.2260788179365;1834.5780470491861;1844.7140693192578;48325;52282;54583.727081364734;54978.725106374615;55644.443555564736;8656.740297791077;8828.8675669865;9091.227245684058;9092.636294548143;9115.316351273548;12048.578299759642;12131.818022729665;12167.209131406431;12198.817017744741;12206.267623942593;6992.720291188295;7074.540154889915;7238.52949558277;7239.565626062453;7279.144916728809;7025.683844227022;7074.327938845904;7152.249013853574;7152.535085219444;7207.279272072751;5430.782768689208;5512.972435137799;5536.169574563767;5703.258576385043;5767.942320576824;1633.8121116071566;1658.1957750491001;1685.2247965935808;1716.3992602588994;1738.2612389734313;410.9404136400205;411.6151398442466;428.1971303805365;849.1847826086902;881.3213825354569;9811.705648830546;10025.298229123891;10165.4917254137;10227.130693890953;10272.280940334105;422.7843799662133;429.70350458183754;430.26210049764177;441.2586854085168;452.8392420690673;5544.556435485151;5553.861153471114;5578.693171875505;5731.254936858265;5733.054046082433;134280;134493;135669;136228;136898;51915.22380338923;63009.68495157495;65888.67055664786;67248.32751672421;68488.17850482665;416.7312083706053;445.3920398655876;449.5571861716207;449.59536417224103;450.79714128641587;9730.902690973282;9779.853302200616;9840.212782977487;10026.29324940714;10037.44794036335;31869.20326991844;32259;32739.508907365933;32830.17924551905;33213;44149.33775993298;44244.55755442533;45300.546994529635;45356.77321613371;45774.31338529858;7227.7831665050135;7356.8896466554115;7377.741779037708;7405.111386633638;7478.962605186939;9810.85283720759;10595;10810.4865318857;11040.723981900517;11191.832122518332;8857.822843542965;9196;9386.67146649864;9554.187894029086;9816.116549510578;5058.013687331082;9271.76820579491;9575.473348965874;9752.024797520191;9907.950460247652;4983.750812459435;5080.949190508196;9481.336306458481;9531.142197202285;9956.502174891371;7188.7124515020905;7337.889931651136;7377.889331660137;7461.179270280373;7470.439717021354;9222.354435189472;9595.520223988913;9779.902200978184;9898.950505247427;9907.752306192115 10:07:02 INFO - PROCESS | 311 | |3;mootools.html;1417.333853089048;1426.9714605707888;1567.5532473245128;1738.7739593852798;1778.3153485907922;6469.514786391028;7295.197528271886;7443.292887175717;7628.084629844419;7676.309132178103;7137;7143.142822861251;7216.783496495101;7278.526895751786;7278.854422911539;2161.9891900540474;2170.9782902170973;2184.6613774864923;2204.3937917072853;2205.63607004844;2051.579426217629;2103.568768402474;2104.410764985799;2114.534802343482;2120.8303335733103;2107.873527588342;2117.9364619061375;2120.321497120922;2130.4034870236283;2168.8590241634324;2099.2232873836624;2116.248731700255;2118.9828882136508;2126.8830214338204;2127.5425783456553;2120.7985241402043;2152.720146380976;2164.231697747293;2166.2201607421316;2169.023939227354;7341.229170937028;7415.258474152595;7417.072865891763;7417.740379086706;7448.5158464699625;4581.244094724367;4714.175019371596;4725.125851717443;4730.101280756679;4767.237242041291;2960.86676099576;3050.3594245208533;3131.279805644692;3150.9054728358187;3164.8734050637945;912.1562554637001;956.8756061712003;969.0890562870878;983.1151963233076;988.7972965542046;9263.722088337361;9268.814623707556;9320.347575669706;9372.20336271411;9414.388064775767;4020.939685904655;4074.409210664437;4134.986928202609;4147.755673298059;4189.07840275139;8108.1891810819625;8130.3495720342235;8150.918490815135;8157.143499932422;8179.182081791773;4606.101810147056;4630.351750754897;4645.349651048856;4648.140094082605;4686.882827929261;3773.6226377362595;4149.045719484536;4194.601512856335;4324.048709283952;4326.6754993375625;3332.983335083309;3360.781549199294;3382.661733826647;3396.3037577296595;3407.0119665297284;1034.2656713733184;1034.425893629028;1052.6894566103017;1059.147386353977;1059.1473863539925;1191.1304747534348;1192.7077865922904;1203.8314635950974;1214.0833670578656;1244.6328333141746;7090.75182368625;7149.213586505481;7163.247858974837;7176.174739904874;7341.119065712149;433.76143121283167;434.41137259014215;435.9411479450297;441.126569392598;450.86023332766945;5429.592780541475;5452.809151679672;5480.890382192334;5524.530414914697;5548.889022219614;9077.319201059947;9294.581743821544;9364.204042656314;9539.427634341962;9549.9045009549;9362.719118426457;9385.202257808027;9388.436693798258;9413.388129771543;9423.293253005915;6932.965335173392;7112.751053713096;7126.821829454305;7285.562866228043;7366.742164024234;7086.185088714864;7141.571505709674;7145.85708285821;7147.749828755968;7179.784606461814;7999.680012799423;8253.422260441712;8304.086550479564;8305.294050005818;8375.37184711137;8248.051474080557;8365.372597055124;8410.369222308474;8431.95784021076;8464.365172611955;6551.574147680385;6585.835354116185;6724.831879203059;6764.830879228059;6768.695408706719;7272.854542909006;7382.852342953218;7403;7405;7420.6289685516585;6664.766733164316;6796.184457865088;6805.761798337035;6900.3444672756;6974.616396098263;6663.433608143168;6669.566478178903;6694.698738556874;6731.730730770714;6785.93214067853;6894.758683446055;6911.5853048817235;7021.297870213142;7028.402585780266;7040.929590704232;6217.564770466024;6272.968635156795;6297.496200303873;6324.335944725922;6327.303996560467;6543.0185472179555;6549.443297319781;6563.409293163638;6575.375339342755;6624.006399040182 10:07:02 INFO - PROCESS | 311 | |4;prototype.html;305.9678733732958;311.3834607477194;314.8945103390364;319.2099553604828;319.7330229258569;5552.4169962154;5614.831555053344;5659.151127330892;5676.091825307952;5706.914396284059;5644.125160600103;5659.151127330892;5665.660060396379;5667.234923285355;5687.7156142192935;4167.937480937789;4259.829606815723;4362.716423432483;4386.605205531501;4401.0317730099405;4331.913361732763;4363.563643635627;4370.781460926957;4394.231009573328;4401.317795741666;4353.455818022747;4374.321980093091;4375;4376.803043863018;4380.9923717544825;4318.913621727579;4343.609075183217;4355.281378572532;4362.912741745147;4366.345048242757;3834;3849.5188101487315;3850.306944749944;3853.537575490931;3855.9203423041595;5330.307060082203;5361.946380536223;5368.62419630626;5410.972945135289;5411.648242864201;4741.407324084489;4894.559489645913;4940.357753492059;5028.823991160292;5030.622703297267;5895.263092113486;5920.792772252994;5938.821835344904;5954.047352423591;5959.910601340984;4068.084680946793;4068.776217308047;4069.877903662895;4074.144429669743;4077.8368865245357;6222;6229.906551401733;6230.7819226326865;6260.561760676755;6302.590331628429;4148.937765933513;4149.336106223051;4158.189153115174;4165.271077561415;4183.707140500136;4225.429567008476;4231.428757117811;4234.767087810138;4238.385434112037;4240.300350442142;4762.119007983534;4873.147199240189;4909.0672772173175;4910.189818679949;4911.287863259879;5896.823095307148;5902.055671092605;5906.8818623627285;5919.112133180058;5958.702064896738;1445.0534899640752;1484.5546336099128;1487.21177775779;1489.7392956232616;1491.246920305239;951.8143961927358;953.4565297780199;975.6341371985505;985.7486340983004;994.0606127209718;5217.739113044408;5219.399769026534;5233.502817232356;5239.47605239473;5250.789968401297;6157.922363586355;6192.721327540272;6217.0052791554035;6226.377362263737;6229.065640153923;5028.245763135559;5143.6399452037995;5211.296474975906;5214.504622060898;5244.056069907453;3340.231746698273;3366.9663303367142;3379.121428428626;3381.492776083607;3387.2548039431285;5801.564882633819;5838;5850.795222167204;5871.794487192928;5873.853153671193;6364.745410183634;6400.359964003563;6411.1024456576115;6418.26189988148;6419.871602568016;5762.481376676119;5797.36229014808;5804.970975145097;5847.502962248256;5864.941350586525;6048.0927860819465;6195.907061393992;6263.874722505616;6264.436200741955;6265.718042688181;6052.697365131814;6087.634741915499;6087.66517841523;6092.603980741238;6107.816765497042;5761.654300741969;5816.592838501264;5820.097884827858;5836.970815145897;5837.328707198557;4159.438475805728;4176.206520761046;4186.602272784081;4187.539370669163;4187.560306167808;6207.410296021871;6230.501559875109;6234.0025595904435;6235.438810507076;6238.594491358047;5858.238429004202;6021.819345419644;6029.216201893726;6030.668313242813;6049.0926361046195;6037.154798328325;6059.787907423395;6075.878482430415;6086.573939824169;6098.725557349841;5903.173555702119;5928.555358348055;5929.080992446005;5929.258842644669;5929.407059294036;6002.129691194839;6002.909956350571;6039.48664363534;6045.093236014457;6061.090836374579;5696.943030569641;5876.764929402776;5884.08796636522;5901.675407852609;5920.141579471038 10:07:02 INFO - PROCESS | 311 | |5;yui.html;704.1655638068888;708.4438715608247;710.1939298895753;742.743753405075;750.8761054426017;11206.551737930484;11368.431578421067;11407;11419.25774824637;11452.541898324067;11813.822792658117;11969.042476601873;12042.096842736808;12052.276863388202;12130;785.2226295966994;794.285143370965;795.2683531151355;795.3358945280697;801.0747586537558;647.2621211818531;783.9333656639193;811.3225456743596;816.7631386897792;817.697451942782;851.5018714052287;852.4416507187802;853.0403296291672;854.3378881366929;856.2550580994543;851.3146916732028;854.8674955381895;856.8886044814196;857.8498762716562;859.0378775771114;618.8019833653233;623.6601052426438;623.9812805615838;627.0656721485;627.4478458956089;11815.645530634094;11859.110566707532;11882.465289061927;11893.762124757543;11909.523619055228;12322.137450378477;12619.495220191182;12680;12828.230306181658;13106.80339794904;9791.412515249036;9907.157891579152;9926.305158638897;9934.056264654919;9972.551235194434;3283.540304357392;3338.332333533303;3357.462805951036;3393.253484233465;3404.063882432326;40818.38772418416;40843.59156408428;40943.795281023704;41091.794541027404;42199.57800421956;9284.814303713887;9571.473568953774;9703.272254580934;9784.657536986171;9858.30991830565;17497.300107995794;17513.47459576215;17539.561510962074;17562.912185438992;17686.380976665754;6616.669166541654;6699.330066993261;6705.899411508832;6722.563033402813;6948.791536253921;3370.140614143427;3388.9491657625153;3397.456406974872;3435.553378060836;3444.0873168610337;2795.398989217328;2795.804293699462;2820.506411378001;2822.7741780657498;2823.3365159187574;488.5236894028365;493.1985523524273;498.7531172069849;499.2511233150275;505.39100384037147;437.6061544609877;456.698578937906;511.6900734120663;540.1849784723327;540.8318033048596;7867.685292588232;7916.129225785159;7938.960305198552;7976.401769867283;8107.594620268963;474.62030375699993;558.8993981083444;559.8544378461548;579.4176852263448;583.8657108864985;3576.8926932192076;3602.7838329700303;3626.202235508184;3732.9734323061375;3769.3780526212868;46471.767641161576;46511.76744116258;46799.76600116977;47540.76229618899;47698.5230147701;43905.12189756251;44370.77814610906;44616;44819;45205.77397112994;39782;40243.798781005906;40476.59523404787;40564.39153412701;40750.9812254696;7285.635718213962;7324.194338622854;7379.778606641809;7385.224551422023;7558.508696934681;32319.51520727238;32369.838150810036;32478;32534.34931301408;32674.183145421553;38883.2223355537;39176.216475670895;39668.20663586655;40087.79956100201;40880.79559602183;10215.642452514126;10490.160787136858;10504.789904202025;10557.736056598647;10587.894121058998;10869.51087201062;10888.94555527249;10974;11088.445577721242;11120.833187502032;10486.475676216007;10558.155347572329;10570.154387649123;10751.462426878781;11127.276727012719;10841.67474975752;10958.28771129874;11174.161937854857;11179.385133817717;11486.36824974601;10577.36535807854;10745.838812417976;10784;11040.33757974524;11071.778564428505;9050.049744776703;9075.773105672411;9273.383380481753;9409.670661526814;9482.288828337765;8879.24526415262;9025.50359730195;9170.201326244132;9479.241660667269;9737.318387712792 10:07:02 INFO - PROCESS | 311 | __end_tp_report 10:07:02 INFO - PROCESS | 311 | __start_cc_report 10:07:02 INFO - PROCESS | 311 | _x_x_mozilla_cycle_collect,365 10:07:02 INFO - PROCESS | 311 | __end_cc_report 10:07:02 INFO - PROCESS | 311 | __startTimestamp1460048822543__endTimestamp 10:07:02 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | ------- Summary: start ------- 10:07:02 INFO - PROCESS | 311 | Number of tests: 6 10:07:02 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | [#0] dojo.html Cycles:165 Average:4741.48 Median:4864.22 stddev:488.73 (10.0%) stddev-sans-first:460.50 10:07:02 INFO - PROCESS | 311 | Values: 2601.5 2706.6 2719.8 2730.1 2731.5 4742.6 4758.2 4760.9 4769.2 4773.4 4714.4 4770.6 4814.0 4891.0 4891.6 4398.4 4411.9 4499.6 4514.1 4599.3 4439.7 4445.8 4478.9 4495.4 4497.1 4382.8 4402.5 4403.6 4446.9 4489.2 4394.4 4394.9 4398.8 4431.7 4466.7 4283.1 4336.3 4373.7 4385.1 4408.9 4633.5 4654.0 4658.0 4685.2 4713.3 5075.6 5115.7 5119.2 5133.5 5147.0 5018.1 5036.4 5136.7 5160.4 5198.9 4736.4 4737.5 4749.1 4792.1 4844.7 5208.8 5224.0 5249.2 5257.0 5276.3 4823.0 4928.2 4945.5 4948.6 5110.0 5125.3 5196.2 5198.9 5221.5 5248.9 5062.3 5082.4 5085.1 5095.1 5145.5 4975.5 5049.5 5054.8 5067.9 5068.8 4369.5 4373.5 4377.7 4409.5 4412.5 3810.8 3818.5 3821.7 3847.2 3858.3 4290.8 4442.8 4502.9 4503.7 4514.1 5071.8 5078.3 5122.2 5146.6 5176.1 4438.8 4457.4 4467.7 4484.1 4520.0 4513.3 4575.9 4591.7 4602.3 4653.8 4812.7 4832.9 4853.0 4891.1 4924.2 5168.1 5175.2 5185.4 5189.3 5238.3 4689.9 4736.5 4810.5 4864.1 4930.5 5052.6 5061.8 5079.2 5083.1 5101.2 5148.0 5151.9 5157.0 5171.6 5193.4 4743.6 4993.8 5030.8 5082.8 5111.7 4978.4 5000.7 5001.8 5005.8 5044.8 4864.2 4896.2 4902.9 4921.0 4948.1 4944.9 4978.2 5046.3 5065.3 5071.2 4915.3 4920.3 4977.4 4982.5 5013.2 10:07:02 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | [#1] ext.html Cycles:180 Average:42990.81 Median:19036.56 stddev:76069.27 (399.6%) stddev-sans-first:76215.87 10:07:02 INFO - PROCESS | 311 | Values: 533.2 539.8 543.2 557.8 568.6 36167.6 36758.1 36769.4 36857.3 36910.3 37978.0 38375.8 38470.2 38728.4 38752.6 7598.5 7761.3 7768.6 7784.8 7788.6 7640.3 7759.6 7792.1 7794.3 7797.3 7686.3 7717.8 7748.1 7793.5 7821.2 7670.7 7742.5 7764.0 7770.1 7815.8 7687.5 7767.3 7791.2 7813.5 7815.5 34088.7 34399.8 34570.8 34613.8 34751.8 2989.4 2999.1 3045.8 3093.6 3127.8 27809.3 28159.4 28231.0 28393.3 29166.3 3417.3 3459.3 3493.1 3500.1 3601.2 226630.0 228055.0 231277.0 231696.0 232812.0 41099.6 50811.5 52652.0 52972.7 53346.5 38713.4 38867.0 38970.2 39269.6 39333.2 13284.3 13615.1 13622.0 13640.8 13690.5 10630.5 10720.2 10768.9 10770.4 10819.5 13806.2 13819.8 14322.3 14327.3 14397.1 5649.2 5689.7 5762.6 5813.3 5885.7 901.7 922.9 977.2 995.3 1007.1 26104.7 26186.9 26582.0 27022.3 27064.9 957.6 964.5 1002.6 1013.3 1016.7 13356.9 13469.9 13475.5 13596.5 13719.5 356707.0 358405.0 361770.0 362151.0 364068.0 46305.8 46460.5 46602.8 46745.8 46800.0 1218.7 1220.7 1246.4 1247.1 1251.6 24613.3 25435.9 25614.2 25729.5 25830.0 34765.0 35320.0 35361.0 35405.1 35510.5 260469.0 261463.0 261764.0 262284.0 262487.0 30658.8 30785.4 30911.5 31085.7 31550.4 37857.2 38550.2 38984.6 39231.8 39297.8 32101.2 32437.7 32942.7 33397.5 33767.5 32272.4 32717.7 32854.5 32985.3 33419.7 33285.2 33343.5 37199.6 38701.0 38765.8 28600.7 31215.8 31540.5 31542.5 31557.8 24131.2 24640.4 24806.0 24869.3 24894.9 10:07:02 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | [#2] jquery.html Cycles:180 Average:15288.15 Median:4769.12 stddev:24882.89 (521.8%) stddev-sans-first:24927.35 10:07:02 INFO - PROCESS | 311 | Values: 329.4 339.0 348.9 352.6 358.2 14913.0 15529.9 15566.1 15642.8 16184.3 14929.9 15150.7 15341.8 15459.4 15497.5 4770.4 5017.7 5025.2 5027.8 5035.5 4647.2 4843.2 4894.9 4897.4 4899.6 4768.4 4769.9 4775.6 4782.5 4802.0 4575.0 4788.0 4824.3 4911.0 4918.9 4372.5 4382.2 4393.9 4395.9 4396.5 18323.0 18526.7 18617.6 18924.6 18996.6 1873.3 1882.7 1885.8 1941.1 2003.0 12545.5 12617.2 12663.6 12772.7 13059.1 1738.5 1767.2 1791.2 1834.6 1844.7 48325.0 52282.0 54583.7 54978.7 55644.4 8656.7 8828.9 9091.2 9092.6 9115.3 12048.6 12131.8 12167.2 12198.8 12206.3 6992.7 7074.5 7238.5 7239.6 7279.1 7025.7 7074.3 7152.2 7152.5 7207.3 5430.8 5513.0 5536.2 5703.3 5767.9 1633.8 1658.2 1685.2 1716.4 1738.3 410.9 411.6 428.2 849.2 881.3 9811.7 10025.3 10165.5 10227.1 10272.3 422.8 429.7 430.3 441.3 452.8 5544.6 5553.9 5578.7 5731.3 5733.1 134280.0 134493.0 135669.0 136228.0 136898.0 51915.2 63009.7 65888.7 67248.3 68488.2 416.7 445.4 449.6 449.6 450.8 9730.9 9779.9 9840.2 10026.3 10037.4 31869.2 32259.0 32739.5 32830.2 33213.0 44149.3 44244.6 45300.5 45356.8 45774.3 7227.8 7356.9 7377.7 7405.1 7479.0 9810.9 10595.0 10810.5 11040.7 11191.8 8857.8 9196.0 9386.7 9554.2 9816.1 5058.0 9271.8 9575.5 9752.0 9908.0 4983.8 5080.9 9481.3 9531.1 9956.5 7188.7 7337.9 7377.9 7461.2 7470.4 9222.4 9595.5 9779.9 9899.0 9907.8 10:07:02 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | [#3] mootools.html Cycles:180 Average:5255.72 Median:6580.61 stddev:2735.07 (41.6%) stddev-sans-first:2727.52 10:07:02 INFO - PROCESS | 311 | Values: 1417.3 1427.0 1567.6 1738.8 1778.3 6469.5 7295.2 7443.3 7628.1 7676.3 7137.0 7143.1 7216.8 7278.5 7278.9 2162.0 2171.0 2184.7 2204.4 2205.6 2051.6 2103.6 2104.4 2114.5 2120.8 2107.9 2117.9 2120.3 2130.4 2168.9 2099.2 2116.2 2119.0 2126.9 2127.5 2120.8 2152.7 2164.2 2166.2 2169.0 7341.2 7415.3 7417.1 7417.7 7448.5 4581.2 4714.2 4725.1 4730.1 4767.2 2960.9 3050.4 3131.3 3150.9 3164.9 912.2 956.9 969.1 983.1 988.8 9263.7 9268.8 9320.3 9372.2 9414.4 4020.9 4074.4 4135.0 4147.8 4189.1 8108.2 8130.3 8150.9 8157.1 8179.2 4606.1 4630.4 4645.3 4648.1 4686.9 3773.6 4149.0 4194.6 4324.0 4326.7 3333.0 3360.8 3382.7 3396.3 3407.0 1034.3 1034.4 1052.7 1059.1 1059.1 1191.1 1192.7 1203.8 1214.1 1244.6 7090.8 7149.2 7163.2 7176.2 7341.1 433.8 434.4 435.9 441.1 450.9 5429.6 5452.8 5480.9 5524.5 5548.9 9077.3 9294.6 9364.2 9539.4 9549.9 9362.7 9385.2 9388.4 9413.4 9423.3 6933.0 7112.8 7126.8 7285.6 7366.7 7086.2 7141.6 7145.9 7147.7 7179.8 7999.7 8253.4 8304.1 8305.3 8375.4 8248.1 8365.4 8410.4 8432.0 8464.4 6551.6 6585.8 6724.8 6764.8 6768.7 7272.9 7382.9 7403.0 7405.0 7420.6 6664.8 6796.2 6805.8 6900.3 6974.6 6663.4 6669.6 6694.7 6731.7 6785.9 6894.8 6911.6 7021.3 7028.4 7040.9 6217.6 6273.0 6297.5 6324.3 6327.3 6543.0 6549.4 6563.4 6575.4 6624.0 10:07:02 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | [#4] prototype.html Cycles:180 Average:4930.89 Median:5666.45 stddev:1473.45 (26.0%) stddev-sans-first:1436.11 10:07:02 INFO - PROCESS | 311 | Values: 306.0 311.4 314.9 319.2 319.7 5552.4 5614.8 5659.2 5676.1 5706.9 5644.1 5659.2 5665.7 5667.2 5687.7 4167.9 4259.8 4362.7 4386.6 4401.0 4331.9 4363.6 4370.8 4394.2 4401.3 4353.5 4374.3 4375.0 4376.8 4381.0 4318.9 4343.6 4355.3 4362.9 4366.3 3834.0 3849.5 3850.3 3853.5 3855.9 5330.3 5361.9 5368.6 5411.0 5411.6 4741.4 4894.6 4940.4 5028.8 5030.6 5895.3 5920.8 5938.8 5954.0 5959.9 4068.1 4068.8 4069.9 4074.1 4077.8 6222.0 6229.9 6230.8 6260.6 6302.6 4148.9 4149.3 4158.2 4165.3 4183.7 4225.4 4231.4 4234.8 4238.4 4240.3 4762.1 4873.1 4909.1 4910.2 4911.3 5896.8 5902.1 5906.9 5919.1 5958.7 1445.1 1484.6 1487.2 1489.7 1491.2 951.8 953.5 975.6 985.7 994.1 5217.7 5219.4 5233.5 5239.5 5250.8 6157.9 6192.7 6217.0 6226.4 6229.1 5028.2 5143.6 5211.3 5214.5 5244.1 3340.2 3367.0 3379.1 3381.5 3387.3 5801.6 5838.0 5850.8 5871.8 5873.9 6364.7 6400.4 6411.1 6418.3 6419.9 5762.5 5797.4 5805.0 5847.5 5864.9 6048.1 6195.9 6263.9 6264.4 6265.7 6052.7 6087.6 6087.7 6092.6 6107.8 5761.7 5816.6 5820.1 5837.0 5837.3 4159.4 4176.2 4186.6 4187.5 4187.6 6207.4 6230.5 6234.0 6235.4 6238.6 5858.2 6021.8 6029.2 6030.7 6049.1 6037.2 6059.8 6075.9 6086.6 6098.7 5903.2 5928.6 5929.1 5929.3 5929.4 6002.1 6002.9 6039.5 6045.1 6061.1 5696.9 5876.8 5884.1 5901.7 5920.1 10:07:02 INFO - PROCESS | 311 | 10:07:02 INFO - PROCESS | 311 | [#5] yui.html Cycles:180 Average:12348.59 Median:22171.36 stddev:13693.67 (61.8%) stddev-sans-first:13704.16 10:07:02 INFO - PROCESS | 311 | Values: 704.2 708.4 710.2 742.7 750.9 11206.6 11368.4 11407.0 11419.3 11452.5 11813.8 11969.0 12042.1 12052.3 12130.0 785.2 794.3 795.3 795.3 801.1 647.3 783.9 811.3 816.8 817.7 851.5 852.4 853.0 854.3 856.3 851.3 854.9 856.9 857.8 859.0 618.8 623.7 624.0 627.1 627.4 11815.6 11859.1 11882.5 11893.8 11909.5 12322.1 12619.5 12680.0 12828.2 13106.8 9791.4 9907.2 9926.3 9934.1 9972.6 3283.5 3338.3 3357.5 3393.3 3404.1 40818.4 40843.6 40943.8 41091.8 42199.6 9284.8 9571.5 9703.3 9784.7 9858.3 17497.3 17513.5 17539.6 17562.9 17686.4 6616.7 6699.3 6705.9 6722.6 6948.8 3370.1 3388.9 3397.5 3435.6 3444.1 2795.4 2795.8 2820.5 2822.8 2823.3 488.5 493.2 498.8 499.3 505.4 437.6 456.7 511.7 540.2 540.8 7867.7 7916.1 7939.0 7976.4 8107.6 474.6 558.9 559.9 579.4 583.9 3576.9 3602.8 3626.2 3733.0 3769.4 46471.8 46511.8 46799.8 47540.8 47698.5 43905.1 44370.8 44616.0 44819.0 45205.8 39782.0 40243.8 40476.6 40564.4 40751.0 7285.6 7324.2 7379.8 7385.2 7558.5 32319.5 32369.8 32478.0 32534.3 32674.2 38883.2 39176.2 39668.2 40087.8 40880.8 10215.6 10490.2 10504.8 10557.7 10587.9 10869.5 10888.9 10974.0 11088.4 11120.8 10486.5 10558.2 10570.2 10751.5 11127.3 10841.7 10958.3 11174.2 11179.4 11486.4 10577.4 10745.8 10784.0 11040.3 11071.8 9050.0 9075.8 9273.4 9409.7 9482.3 8879.2 9025.5 9170.2 9479.2 9737.3 10:07:02 INFO - PROCESS | 311 | -------- Summary: end -------- 10:07:02 INFO - PROCESS | 311 | 10:07:03 INFO - TEST-INFO | 311: exit 0 10:07:03 INFO - TEST-OK | dromaeo_css | took 1113381ms 10:07:03 INFO - TEST-START | kraken 10:07:03 INFO - operating with platform_type : linux_ 10:07:03 INFO - Initialising browser for kraken test... 10:07:03 INFO - TEST-INFO | started process 545 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpRwk3kP/profile http://localhost:35908/getInfo.html) 10:07:06 INFO - PROCESS | 545 | 10:07:06 INFO - PROCESS | 545 | (process:614): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 10:07:06 INFO - PROCESS | 545 | JavaScript error: jar:file:///builds/slave/test/build/application/firefox/omni.ja!/components/Weave.js, line 13: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIXPCComponents_Utils.import] 10:07:07 INFO - PROCESS | 545 | __metrics Screen width/height:1600/1200 10:07:07 INFO - PROCESS | 545 | colorDepth:24 10:07:07 INFO - PROCESS | 545 | Browser inner width/height: 1024/697 10:07:07 INFO - PROCESS | 545 | __metrics 10:07:07 ERROR - PROCESS | 545 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2881: TypeError: this.tabs is undefined 10:07:08 INFO - TEST-INFO | 545: exit 0 10:07:08 INFO - Browser initialized. 10:07:08 INFO - Running cycle 1/1 for kraken test... 10:07:08 INFO - TEST-INFO | started process 665 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpRwk3kP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:07:10 INFO - PROCESS | 665 | 10:07:10 INFO - PROCESS | 665 | (process:724): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 10:07:20 INFO - PROCESS | 665 | RSS: Main: 164089856 10:07:20 INFO - PROCESS | 665 | 10:07:23 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:35908/tests/kraken/driver.html?testName=audio-beat-detection) 10:07:23 INFO - PROCESS | 665 | RSS: Main: 168353792 10:07:23 INFO - PROCESS | 665 | 10:07:26 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:35908/tests/kraken/driver.html?testName=audio-dft) 10:07:27 INFO - PROCESS | 665 | RSS: Main: 171589632 10:07:27 INFO - PROCESS | 665 | 10:07:30 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:35908/tests/kraken/driver.html?testName=audio-fft) 10:07:30 INFO - PROCESS | 665 | RSS: Main: 163725312 10:07:30 INFO - PROCESS | 665 | 10:07:33 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:35908/tests/kraken/driver.html?testName=audio-oscillator) 10:07:33 INFO - PROCESS | 665 | RSS: Main: 164147200 10:07:33 INFO - PROCESS | 665 | 10:07:36 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:35908/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:07:36 INFO - PROCESS | 665 | RSS: Main: 164872192 10:07:36 INFO - PROCESS | 665 | 10:07:39 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:35908/tests/kraken/driver.html?testName=imaging-darkroom) 10:07:40 INFO - PROCESS | 665 | RSS: Main: 164585472 10:07:40 INFO - PROCESS | 665 | 10:07:43 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:35908/tests/kraken/driver.html?testName=imaging-desaturate) 10:07:44 INFO - PROCESS | 665 | RSS: Main: 165015552 10:07:44 INFO - PROCESS | 665 | 10:07:47 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:35908/tests/kraken/driver.html?testName=json-parse-financial) 10:07:48 INFO - PROCESS | 665 | RSS: Main: 165244928 10:07:48 INFO - PROCESS | 665 | 10:07:49 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:35908/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:07:50 INFO - PROCESS | 665 | RSS: Main: 165912576 10:07:50 INFO - PROCESS | 665 | 10:07:52 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:35908/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:07:52 INFO - PROCESS | 665 | RSS: Main: 165257216 10:07:52 INFO - PROCESS | 665 | 10:07:55 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:35908/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:07:55 INFO - PROCESS | 665 | RSS: Main: 165548032 10:07:55 INFO - PROCESS | 665 | 10:07:58 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:35908/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:07:58 INFO - PROCESS | 665 | RSS: Main: 166051840 10:07:58 INFO - PROCESS | 665 | 10:08:01 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:35908/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:08:02 INFO - PROCESS | 665 | RSS: Main: 165789696 10:08:02 INFO - PROCESS | 665 | 10:08:03 INFO - PROCESS | 665 | Cycle 1(1): loaded http://localhost:35908/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:35908/tests/kraken/driver.html?testName=ai-astar) 10:08:04 INFO - PROCESS | 665 | RSS: Main: 167223296 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | __start_tp_report 10:08:04 INFO - PROCESS | 665 | _x_x_mozilla_page_load 10:08:04 INFO - PROCESS | 665 | _x_x_mozilla_page_load_details 10:08:04 INFO - PROCESS | 665 | |i|pagename|runs| 10:08:04 INFO - PROCESS | 665 | |0;ai-astar;114;107;113;114;113;126;113;112;111;113 10:08:04 INFO - PROCESS | 665 | |1;audio-beat-detection;156;144;163;185;136;170;160;139;184;142 10:08:04 INFO - PROCESS | 665 | |2;audio-dft;163;163;163;165;167;169;168;166;166;164 10:08:04 INFO - PROCESS | 665 | |3;audio-fft;75;75;74;75;78;75;74;144;75;73 10:08:04 INFO - PROCESS | 665 | |4;audio-oscillator;95;96;146;95;95;94;132;95;95;143 10:08:04 INFO - PROCESS | 665 | |5;imaging-gaussian-blur;120;118;118;117;119;119;120;118;118;118 10:08:04 INFO - PROCESS | 665 | |6;imaging-darkroom;149;149;149;148;148;150;149;150;149;148 10:08:04 INFO - PROCESS | 665 | |7;imaging-desaturate;98;97;96;97;96;96;97;97;96;96 10:08:04 INFO - PROCESS | 665 | |8;json-parse-financial;67;67;70;68;69;67;76;67;64;66 10:08:04 INFO - PROCESS | 665 | |9;json-stringify-tinderbox;65;66;66;65;66;66;65;64;66;66 10:08:04 INFO - PROCESS | 665 | |10;stanford-crypto-aes;82;84;85;83;83;92;83;84;85;83 10:08:04 INFO - PROCESS | 665 | |11;stanford-crypto-ccm;128;137;117;122;135;119;129;123;119;133 10:08:04 INFO - PROCESS | 665 | |12;stanford-crypto-pbkdf2;138;144;141;152;149;136;151;149;147;132 10:08:04 INFO - PROCESS | 665 | |13;stanford-crypto-sha256-iterative;71;71;68;68;69;78;67;68;70;68 10:08:04 INFO - PROCESS | 665 | __end_tp_report 10:08:04 INFO - PROCESS | 665 | __start_cc_report 10:08:04 INFO - PROCESS | 665 | _x_x_mozilla_cycle_collect,946 10:08:04 INFO - PROCESS | 665 | __end_cc_report 10:08:04 INFO - PROCESS | 665 | __startTimestamp1460048884134__endTimestamp 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | ------- Summary: start ------- 10:08:04 INFO - PROCESS | 665 | Number of tests: 14 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#0] ai-astar Cycles:10 Average:113.60 Median:113.00 stddev:4.81 (4.3%) stddev-sans-first:5.10 10:08:04 INFO - PROCESS | 665 | Values: 114.0 107.0 113.0 114.0 113.0 126.0 113.0 112.0 111.0 113.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#1] audio-beat-detection Cycles:10 Average:157.90 Median:161.50 stddev:17.89 (11.1%) stddev-sans-first:18.96 10:08:04 INFO - PROCESS | 665 | Values: 156.0 144.0 163.0 185.0 136.0 170.0 160.0 139.0 184.0 142.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#2] audio-dft Cycles:10 Average:165.40 Median:166.00 stddev:2.17 (1.3%) stddev-sans-first:2.12 10:08:04 INFO - PROCESS | 665 | Values: 163.0 163.0 163.0 165.0 167.0 169.0 168.0 166.0 166.0 164.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#3] audio-fft Cycles:10 Average:81.80 Median:75.00 stddev:21.89 (29.2%) stddev-sans-first:23.08 10:08:04 INFO - PROCESS | 665 | Values: 75.0 75.0 74.0 75.0 78.0 75.0 74.0 144.0 75.0 73.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#4] audio-oscillator Cycles:10 Average:108.60 Median:95.00 stddev:22.18 (23.3%) stddev-sans-first:22.97 10:08:04 INFO - PROCESS | 665 | Values: 95.0 96.0 146.0 95.0 95.0 94.0 132.0 95.0 95.0 143.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#5] imaging-gaussian-blur Cycles:10 Average:118.50 Median:118.50 stddev:0.97 (0.8%) stddev-sans-first:0.87 10:08:04 INFO - PROCESS | 665 | Values: 120.0 118.0 118.0 117.0 119.0 119.0 120.0 118.0 118.0 118.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#6] imaging-darkroom Cycles:10 Average:148.90 Median:149.00 stddev:0.74 (0.5%) stddev-sans-first:0.78 10:08:04 INFO - PROCESS | 665 | Values: 149.0 149.0 149.0 148.0 148.0 150.0 149.0 150.0 149.0 148.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#7] imaging-desaturate Cycles:10 Average:96.60 Median:97.00 stddev:0.70 (0.7%) stddev-sans-first:0.53 10:08:04 INFO - PROCESS | 665 | Values: 98.0 97.0 96.0 97.0 96.0 96.0 97.0 97.0 96.0 96.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#8] json-parse-financial Cycles:10 Average:68.10 Median:67.50 stddev:3.21 (4.8%) stddev-sans-first:3.38 10:08:04 INFO - PROCESS | 665 | Values: 67.0 67.0 70.0 68.0 69.0 67.0 76.0 67.0 64.0 66.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#9] json-stringify-tinderbox Cycles:10 Average:65.50 Median:66.00 stddev:0.71 (1.1%) stddev-sans-first:0.73 10:08:04 INFO - PROCESS | 665 | Values: 65.0 66.0 66.0 65.0 66.0 66.0 65.0 64.0 66.0 66.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#10] stanford-crypto-aes Cycles:10 Average:84.40 Median:84.00 stddev:2.84 (3.4%) stddev-sans-first:2.87 10:08:04 INFO - PROCESS | 665 | Values: 82.0 84.0 85.0 83.0 83.0 92.0 83.0 84.0 85.0 83.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#11] stanford-crypto-ccm Cycles:10 Average:126.20 Median:128.50 stddev:7.21 (5.6%) stddev-sans-first:7.62 10:08:04 INFO - PROCESS | 665 | Values: 128.0 137.0 117.0 122.0 135.0 119.0 129.0 123.0 119.0 133.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.90 Median:148.00 stddev:6.87 (4.6%) stddev-sans-first:6.95 10:08:04 INFO - PROCESS | 665 | Values: 138.0 144.0 141.0 152.0 149.0 136.0 151.0 149.0 147.0 132.0 10:08:04 INFO - PROCESS | 665 | 10:08:04 INFO - PROCESS | 665 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.80 Median:69.50 stddev:3.19 (4.6%) stddev-sans-first:3.35 10:08:04 INFO - PROCESS | 665 | Values: 71.0 71.0 68.0 68.0 69.0 78.0 67.0 68.0 70.0 68.0 10:08:04 INFO - PROCESS | 665 | -------- Summary: end -------- 10:08:04 INFO - PROCESS | 665 | 10:08:05 INFO - TEST-INFO | 665: exit 0 10:08:05 INFO - TEST-OK | kraken | took 61900ms 10:08:05 INFO - SUITE-END | took 1175s 10:08:05 INFO - Completed test suite (00:19:35) 10:08:05 INFO - javascript benchmark 10:08:05 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2601.518719036978, 2706.594010898365, 2719.7960152988508, 2730.112713368155, 2731.4810186064633, 4742.596879265262, 4758.191107511731, 4760.90478190436, 4769.236922092466, 4773.403324584427, 4714.434267887858, 4770.570648641621, 4813.951860481394, 4891.0, 4891.6331275154325, 4398.428204333432, 4411.889702757425, 4499.595036446735, 4514.052049069699, 4599.2871104978785, 4439.711418757786, 4445.84439544616, 4478.910421791562, 4495.415595972519, 4497.078098989716, 4382.824687012531, 4402.537733537996, 4403.64770818337, 4446.93329600053, 4489.236829738919, 4394.362817391492, 4394.868153955386, 4398.824047038147, 4431.667624928144, 4466.687331886769, 4283.100548884738, 4336.284513055342, 4373.693841431101, 4385.079133381993, 4408.911821763579, 4633.536646335373, 4654.0, 4658.021815418766, 4685.2269375553, 4713.316569097462, 5075.6447048706605, 5115.693058416507, 5119.180931051014, 5133.512316329943, 5146.974265128651, 5018.096742586333, 5036.420811606676, 5136.691798492065, 5160.432352441228, 5198.896022079575, 4736.384270044872, 4737.526247375304, 4749.145153872301, 4792.137415265216, 4844.733539655317, 5208.7916483341, 5224.03355379256, 5249.212618107238, 5257.027449921777, 5276.261323414725, 4823.0, 4928.186849169919, 4945.480724523945, 4948.628852836052, 5110.029094472113, 5125.308083408767, 5196.168613021899, 5198.948010519846, 5221.451747566451, 5248.868778280574, 5062.316587260672, 5082.390113186368, 5085.059264036091, 5095.082885080721, 5145.45972672864, 4975.502449754996, 5049.520295571915, 5054.7978080876355, 5067.87330316745, 5068.82259120929, 4369.453818272716, 4373.475182978, 4377.671674624416, 4409.5149533551285, 4412.536683648235, 3810.8094595270127, 3818.503594532693, 3821.675157611634, 3847.211321679049, 3858.3055050090693, 4290.828366865353, 4442.822287108479, 4502.887427814331, 4503.729776213438, 4514.0971805639, 5071.771770270347, 5078.314427552307, 5122.180451127876, 5146.588272938231, 5176.068307704574, 4438.755868427203, 4457.4205353304515, 4467.664925130628, 4484.12559550891, 4519.977400112978, 4513.300438432048, 4575.931361029588, 4591.655625828076, 4602.309653551927, 4653.837115700934, 4812.663113582085, 4832.927506087482, 4853.0, 4891.144049791344, 4924.212126059813, 5168.0697474454955, 5175.197844334134, 5185.351831021122, 5189.325387699575, 5238.292830467838, 4689.906201875875, 4736.478987311324, 4810.494898035796, 4864.051509955525, 4930.531599498186, 5052.646314758079, 5061.797528098835, 5079.212722028092, 5083.1358669027095, 5101.20931255656, 5148.0476111919415, 5151.922721159261, 5157.045946499909, 5171.612129090408, 5193.402758682649, 4743.573078422958, 4993.750312484434, 5030.8239211627415, 5082.796688132434, 5111.744412779271, 4978.352814134139, 5000.724960127228, 5001.799928002839, 5005.824796132118, 5044.772985215747, 4864.221724524059, 4896.167651499325, 4902.9019419610695, 4920.975395123145, 4948.134076536519, 4944.92582611254, 4978.228374601942, 5046.268291097844, 5065.265536497261, 5071.1632580625255, 4915.287283343823, 4920.286558449076, 4977.352944117241, 4982.526659967298, 5013.248012797963], "unit": "score", "name": "dojo.html", "value": 4710.867654443314}, {"lowerIsBetter": false, "replicates": [533.2135100726427, 539.7759929629204, 543.1635281666232, 557.7824648387128, 568.6218664588049, 36167.63832361675, 36758.081047973814, 36769.44845827312, 36857.26285474289, 36910.26179476409, 37978.0, 38375.80812095936, 38470.23059538808, 38728.419073713914, 38752.612473875255, 7598.468107232482, 7761.301482866569, 7768.57272849993, 7784.844303113934, 7788.571628560427, 7640.274173953466, 7759.573223472707, 7792.10390805059, 7794.298513133816, 7797.337226335769, 7686.308232259095, 7717.803740420216, 7748.108967468757, 7793.532388056707, 7821.178776228499, 7670.731524396647, 7742.496737712059, 7763.961180194091, 7770.145284018753, 7815.8436831263625, 7687.500312479727, 7767.262110099531, 7791.181925897812, 7813.492123011986, 7815.53106813593, 34088.65911340904, 34399.828000860085, 34570.827145864365, 34613.82693086519, 34751.82624086889, 2989.446952313829, 2999.0852789899072, 3045.8172509649494, 3093.551435041906, 3127.781055326128, 27809.304767380774, 28159.436811263866, 28231.0, 28393.290167745767, 29166.27084322909, 3417.2994536120036, 3459.290845376717, 3493.1441796759705, 3500.1424650960676, 3601.1897323102353, 226630.0, 228055.0, 231276.9999999983, 231696.0, 232812.0, 41099.589004110174, 50811.491885081414, 52652.0, 52972.735136324074, 53346.46653533493, 38713.41929871054, 38867.0, 38970.2205955885, 39269.6073039266, 39333.213335733126, 13284.335783210994, 13615.115017524027, 13622.0, 13640.795388069188, 13690.452381904612, 10630.521626526825, 10720.195985301134, 10768.892311076946, 10770.353778773298, 10819.513121909533, 13806.240656763774, 13819.792703109462, 14322.281326240918, 14327.283635818376, 14397.064190827563, 5649.180868774005, 5689.6586204827845, 5762.596618236683, 5813.273340832396, 5885.735141918624, 901.7069452427987, 922.8707980882682, 977.1791694976254, 995.3182070281736, 1007.1338648762058, 26104.73895261061, 26186.86906565493, 26582.0, 27022.32444188911, 27064.864675676494, 957.5978089202551, 964.5129209749172, 1002.5789168549227, 1013.3109485549896, 1016.6594190946116, 13356.933215334055, 13469.932650336686, 13475.460981560627, 13596.524121655695, 13719.45122195101, 356707.0, 358405.0, 361770.0, 362151.0, 364068.0, 46305.768471157426, 46460.5353946463, 46602.76698616553, 46745.766271168424, 46800.0, 1218.7014181525406, 1220.652114147446, 1246.389269258057, 1247.1020864977202, 1251.5869762978195, 24613.261602151248, 25435.872820635777, 25614.23157305284, 25729.485410291316, 25830.0, 34765.0, 35320.0, 35361.0, 35405.114872128404, 35510.46734299039, 260469.0, 261463.0, 261764.0, 262284.0, 262487.0, 30658.84670576633, 30785.384292314477, 30911.536326955564, 31085.68914310828, 31550.36899262048, 37857.2428551433, 38550.2289954205, 38984.610153898095, 39231.80384098061, 39297.80351098226, 32101.197470063435, 32437.67562324441, 32942.67057329396, 33397.49903751494, 33767.4934875982, 32272.35455290928, 32717.672823271463, 32854.507182391804, 32985.34029319448, 33419.66580334263, 33285.16787080342, 33343.49984750279, 37199.62800371962, 38701.0, 38765.806170968965, 28600.713992859804, 31215.84392078116, 31540.52689209618, 31542.526862096627, 31557.8422107888, 24131.155409560582, 24640.419581116883, 24805.99398023491, 24869.25392238236, 24894.875525622258], "unit": "score", "name": "ext.html", "value": 16536.14669119796}, {"lowerIsBetter": false, "replicates": [329.3741890408225, 338.9711874490668, 348.8587122215504, 352.6138877928669, 358.16904780908305, 14913.0, 15529.92235038826, 15566.066036037846, 15642.765358519631, 16184.271707773149, 14929.850701492982, 15150.696986060273, 15341.769873451907, 15459.381624735026, 15497.457588984387, 4770.403699537549, 5017.724025178613, 5025.246213068051, 5027.84916452507, 5035.546800787928, 4647.163510568096, 4843.15244832153, 4894.902101957977, 4897.436794768594, 4899.559039686427, 4768.380110585619, 4769.855234743672, 4775.617950563947, 4782.473927867949, 4802.03959208158, 4574.954250457503, 4788.0, 4824.276358546211, 4910.975445122787, 4918.901621967577, 4372.540883207249, 4382.211201983641, 4393.868183954486, 4395.912081758347, 4396.450443694538, 18323.0, 18526.722099168524, 18617.627647446974, 18924.621507569907, 18996.62006759857, 1873.3443294846695, 1882.6893562562161, 1885.8397036251936, 1941.0585865855048, 2003.0185209247509, 12545.498180072786, 12617.179883307555, 12663.620091397273, 12772.680682982907, 13059.085863989525, 1738.5392870889225, 1767.2047578589686, 1791.2260788179365, 1834.5780470491861, 1844.7140693192578, 48325.0, 52282.0, 54583.727081364734, 54978.725106374615, 55644.443555564736, 8656.740297791077, 8828.8675669865, 9091.227245684058, 9092.636294548143, 9115.316351273548, 12048.578299759642, 12131.818022729665, 12167.209131406431, 12198.817017744741, 12206.267623942593, 6992.720291188295, 7074.540154889915, 7238.52949558277, 7239.565626062453, 7279.144916728809, 7025.683844227022, 7074.327938845904, 7152.249013853574, 7152.535085219444, 7207.279272072751, 5430.782768689208, 5512.972435137799, 5536.169574563767, 5703.258576385043, 5767.942320576824, 1633.8121116071566, 1658.1957750491001, 1685.2247965935808, 1716.3992602588994, 1738.2612389734313, 410.9404136400205, 411.6151398442466, 428.1971303805365, 849.1847826086902, 881.3213825354569, 9811.705648830546, 10025.298229123891, 10165.4917254137, 10227.130693890953, 10272.280940334105, 422.7843799662133, 429.70350458183754, 430.26210049764177, 441.2586854085168, 452.8392420690673, 5544.556435485151, 5553.861153471114, 5578.693171875505, 5731.254936858265, 5733.054046082433, 134280.0, 134493.0, 135669.0, 136228.0, 136898.0, 51915.22380338923, 63009.68495157495, 65888.67055664786, 67248.32751672421, 68488.17850482665, 416.7312083706053, 445.3920398655876, 449.5571861716207, 449.59536417224103, 450.79714128641587, 9730.902690973282, 9779.853302200616, 9840.212782977487, 10026.29324940714, 10037.44794036335, 31869.20326991844, 32259.0, 32739.508907365933, 32830.17924551905, 33213.0, 44149.33775993298, 44244.55755442533, 45300.546994529635, 45356.77321613371, 45774.31338529858, 7227.7831665050135, 7356.8896466554115, 7377.741779037708, 7405.111386633638, 7478.962605186939, 9810.85283720759, 10595.0, 10810.4865318857, 11040.723981900517, 11191.832122518332, 8857.822843542965, 9196.0, 9386.67146649864, 9554.187894029086, 9816.116549510578, 5058.013687331082, 9271.76820579491, 9575.473348965874, 9752.024797520191, 9907.950460247652, 4983.750812459435, 5080.949190508196, 9481.336306458481, 9531.142197202285, 9956.502174891371, 7188.7124515020905, 7337.889931651136, 7377.889331660137, 7461.179270280373, 7470.439717021354, 9222.354435189472, 9595.520223988913, 9779.902200978184, 9898.950505247427, 9907.752306192115], "unit": "score", "name": "jquery.html", "value": 6866.921988390834}, {"lowerIsBetter": false, "replicates": [1417.333853089048, 1426.9714605707888, 1567.5532473245128, 1738.7739593852798, 1778.3153485907922, 6469.514786391028, 7295.197528271886, 7443.292887175717, 7628.084629844419, 7676.309132178103, 7137.0, 7143.142822861251, 7216.783496495101, 7278.526895751786, 7278.854422911539, 2161.9891900540474, 2170.9782902170973, 2184.6613774864923, 2204.3937917072853, 2205.63607004844, 2051.579426217629, 2103.568768402474, 2104.410764985799, 2114.534802343482, 2120.8303335733103, 2107.873527588342, 2117.9364619061375, 2120.321497120922, 2130.4034870236283, 2168.8590241634324, 2099.2232873836624, 2116.248731700255, 2118.9828882136508, 2126.8830214338204, 2127.5425783456553, 2120.7985241402043, 2152.720146380976, 2164.231697747293, 2166.2201607421316, 2169.023939227354, 7341.229170937028, 7415.258474152595, 7417.072865891763, 7417.740379086706, 7448.5158464699625, 4581.244094724367, 4714.175019371596, 4725.125851717443, 4730.101280756679, 4767.237242041291, 2960.86676099576, 3050.3594245208533, 3131.279805644692, 3150.9054728358187, 3164.8734050637945, 912.1562554637001, 956.8756061712003, 969.0890562870878, 983.1151963233076, 988.7972965542046, 9263.722088337361, 9268.814623707556, 9320.347575669706, 9372.20336271411, 9414.388064775767, 4020.939685904655, 4074.409210664437, 4134.986928202609, 4147.755673298059, 4189.07840275139, 8108.1891810819625, 8130.3495720342235, 8150.918490815135, 8157.143499932422, 8179.182081791773, 4606.101810147056, 4630.351750754897, 4645.349651048856, 4648.140094082605, 4686.882827929261, 3773.6226377362595, 4149.045719484536, 4194.601512856335, 4324.048709283952, 4326.6754993375625, 3332.983335083309, 3360.781549199294, 3382.661733826647, 3396.3037577296595, 3407.0119665297284, 1034.2656713733184, 1034.425893629028, 1052.6894566103017, 1059.147386353977, 1059.1473863539925, 1191.1304747534348, 1192.7077865922904, 1203.8314635950974, 1214.0833670578656, 1244.6328333141746, 7090.75182368625, 7149.213586505481, 7163.247858974837, 7176.174739904874, 7341.119065712149, 433.76143121283167, 434.41137259014215, 435.9411479450297, 441.126569392598, 450.86023332766945, 5429.592780541475, 5452.809151679672, 5480.890382192334, 5524.530414914697, 5548.889022219614, 9077.319201059947, 9294.581743821544, 9364.204042656314, 9539.427634341962, 9549.9045009549, 9362.719118426457, 9385.202257808027, 9388.436693798258, 9413.388129771543, 9423.293253005915, 6932.965335173392, 7112.751053713096, 7126.821829454305, 7285.562866228043, 7366.742164024234, 7086.185088714864, 7141.571505709674, 7145.85708285821, 7147.749828755968, 7179.784606461814, 7999.680012799423, 8253.422260441712, 8304.086550479564, 8305.294050005818, 8375.37184711137, 8248.051474080557, 8365.372597055124, 8410.369222308474, 8431.95784021076, 8464.365172611955, 6551.574147680385, 6585.835354116185, 6724.831879203059, 6764.830879228059, 6768.695408706719, 7272.854542909006, 7382.852342953218, 7403.0, 7405.0, 7420.6289685516585, 6664.766733164316, 6796.184457865088, 6805.761798337035, 6900.3444672756, 6974.616396098263, 6663.433608143168, 6669.566478178903, 6694.698738556874, 6731.730730770714, 6785.93214067853, 6894.758683446055, 6911.5853048817235, 7021.297870213142, 7028.402585780266, 7040.929590704232, 6217.564770466024, 6272.968635156795, 6297.496200303873, 6324.335944725922, 6327.303996560467, 6543.0185472179555, 6549.443297319781, 6563.409293163638, 6575.375339342755, 6624.006399040182], "unit": "score", "name": "mootools.html", "value": 4228.9318851341395}, {"lowerIsBetter": false, "replicates": [305.9678733732958, 311.3834607477194, 314.8945103390364, 319.2099553604828, 319.7330229258569, 5552.4169962154, 5614.831555053344, 5659.151127330892, 5676.091825307952, 5706.914396284059, 5644.125160600103, 5659.151127330892, 5665.660060396379, 5667.234923285355, 5687.7156142192935, 4167.937480937789, 4259.829606815723, 4362.716423432483, 4386.605205531501, 4401.0317730099405, 4331.913361732763, 4363.563643635627, 4370.781460926957, 4394.231009573328, 4401.317795741666, 4353.455818022747, 4374.321980093091, 4375.0, 4376.803043863018, 4380.9923717544825, 4318.913621727579, 4343.609075183217, 4355.281378572532, 4362.912741745147, 4366.345048242757, 3834.0, 3849.5188101487315, 3850.306944749944, 3853.537575490931, 3855.9203423041595, 5330.307060082203, 5361.946380536223, 5368.62419630626, 5410.972945135289, 5411.648242864201, 4741.407324084489, 4894.559489645913, 4940.357753492059, 5028.823991160292, 5030.622703297267, 5895.263092113486, 5920.792772252994, 5938.821835344904, 5954.047352423591, 5959.910601340984, 4068.084680946793, 4068.776217308047, 4069.877903662895, 4074.144429669743, 4077.8368865245357, 6222.0, 6229.906551401733, 6230.7819226326865, 6260.561760676755, 6302.590331628429, 4148.937765933513, 4149.336106223051, 4158.189153115174, 4165.271077561415, 4183.707140500136, 4225.429567008476, 4231.428757117811, 4234.767087810138, 4238.385434112037, 4240.300350442142, 4762.119007983534, 4873.147199240189, 4909.0672772173175, 4910.189818679949, 4911.287863259879, 5896.823095307148, 5902.055671092605, 5906.8818623627285, 5919.112133180058, 5958.702064896738, 1445.0534899640752, 1484.5546336099128, 1487.21177775779, 1489.7392956232616, 1491.246920305239, 951.8143961927358, 953.4565297780199, 975.6341371985505, 985.7486340983004, 994.0606127209718, 5217.739113044408, 5219.399769026534, 5233.502817232356, 5239.47605239473, 5250.789968401297, 6157.922363586355, 6192.721327540272, 6217.0052791554035, 6226.377362263737, 6229.065640153923, 5028.245763135559, 5143.6399452037995, 5211.296474975906, 5214.504622060898, 5244.056069907453, 3340.231746698273, 3366.9663303367142, 3379.121428428626, 3381.492776083607, 3387.2548039431285, 5801.564882633819, 5838.0, 5850.795222167204, 5871.794487192928, 5873.853153671193, 6364.745410183634, 6400.359964003563, 6411.1024456576115, 6418.26189988148, 6419.871602568016, 5762.481376676119, 5797.36229014808, 5804.970975145097, 5847.502962248256, 5864.941350586525, 6048.0927860819465, 6195.907061393992, 6263.874722505616, 6264.436200741955, 6265.718042688181, 6052.697365131814, 6087.634741915499, 6087.66517841523, 6092.603980741238, 6107.816765497042, 5761.654300741969, 5816.592838501264, 5820.097884827858, 5836.970815145897, 5837.328707198557, 4159.438475805728, 4176.206520761046, 4186.602272784081, 4187.539370669163, 4187.560306167808, 6207.410296021871, 6230.501559875109, 6234.0025595904435, 6235.438810507076, 6238.594491358047, 5858.238429004202, 6021.819345419644, 6029.216201893726, 6030.668313242813, 6049.0926361046195, 6037.154798328325, 6059.787907423395, 6075.878482430415, 6086.573939824169, 6098.725557349841, 5903.173555702119, 5928.555358348055, 5929.080992446005, 5929.258842644669, 5929.407059294036, 6002.129691194839, 6002.909956350571, 6039.48664363534, 6045.093236014457, 6061.090836374579, 5696.943030569641, 5876.764929402776, 5884.08796636522, 5901.675407852609, 5920.141579471038], "unit": "score", "name": "prototype.html", "value": 4449.373655706112}, {"lowerIsBetter": false, "replicates": [704.1655638068888, 708.4438715608247, 710.1939298895753, 742.743753405075, 750.8761054426017, 11206.551737930484, 11368.431578421067, 11407.0, 11419.25774824637, 11452.541898324067, 11813.822792658117, 11969.042476601873, 12042.096842736808, 12052.276863388202, 12130.0, 785.2226295966994, 794.285143370965, 795.2683531151355, 795.3358945280697, 801.0747586537558, 647.2621211818531, 783.9333656639193, 811.3225456743596, 816.7631386897792, 817.697451942782, 851.5018714052287, 852.4416507187802, 853.0403296291672, 854.3378881366929, 856.2550580994543, 851.3146916732028, 854.8674955381895, 856.8886044814196, 857.8498762716562, 859.0378775771114, 618.8019833653233, 623.6601052426438, 623.9812805615838, 627.0656721485, 627.4478458956089, 11815.645530634094, 11859.110566707532, 11882.465289061927, 11893.762124757543, 11909.523619055228, 12322.137450378477, 12619.495220191182, 12680.0, 12828.230306181658, 13106.80339794904, 9791.412515249036, 9907.157891579152, 9926.305158638897, 9934.056264654919, 9972.551235194434, 3283.540304357392, 3338.332333533303, 3357.462805951036, 3393.253484233465, 3404.063882432326, 40818.38772418416, 40843.59156408428, 40943.795281023704, 41091.794541027404, 42199.57800421956, 9284.814303713887, 9571.473568953774, 9703.272254580934, 9784.657536986171, 9858.30991830565, 17497.300107995794, 17513.47459576215, 17539.561510962074, 17562.912185438992, 17686.380976665754, 6616.669166541654, 6699.330066993261, 6705.899411508832, 6722.563033402813, 6948.791536253921, 3370.140614143427, 3388.9491657625153, 3397.456406974872, 3435.553378060836, 3444.0873168610337, 2795.398989217328, 2795.804293699462, 2820.506411378001, 2822.7741780657498, 2823.3365159187574, 488.5236894028365, 493.1985523524273, 498.7531172069849, 499.2511233150275, 505.39100384037147, 437.6061544609877, 456.698578937906, 511.6900734120663, 540.1849784723327, 540.8318033048596, 7867.685292588232, 7916.129225785159, 7938.960305198552, 7976.401769867283, 8107.594620268963, 474.62030375699993, 558.8993981083444, 559.8544378461548, 579.4176852263448, 583.8657108864985, 3576.8926932192076, 3602.7838329700303, 3626.202235508184, 3732.9734323061375, 3769.3780526212868, 46471.767641161576, 46511.76744116258, 46799.76600116977, 47540.76229618899, 47698.5230147701, 43905.12189756251, 44370.77814610906, 44616.0, 44819.0, 45205.77397112994, 39782.0, 40243.798781005906, 40476.59523404787, 40564.39153412701, 40750.9812254696, 7285.635718213962, 7324.194338622854, 7379.778606641809, 7385.224551422023, 7558.508696934681, 32319.51520727238, 32369.838150810036, 32478.0, 32534.34931301408, 32674.183145421553, 38883.2223355537, 39176.216475670895, 39668.20663586655, 40087.79956100201, 40880.79559602183, 10215.642452514126, 10490.160787136858, 10504.789904202025, 10557.736056598647, 10587.894121058998, 10869.51087201062, 10888.94555527249, 10974.0, 11088.445577721242, 11120.833187502032, 10486.475676216007, 10558.155347572329, 10570.154387649123, 10751.462426878781, 11127.276727012719, 10841.67474975752, 10958.28771129874, 11174.161937854857, 11179.385133817717, 11486.36824974601, 10577.36535807854, 10745.838812417976, 10784.0, 11040.33757974524, 11071.778564428505, 9050.049744776703, 9075.773105672411, 9273.383380481753, 9409.670661526814, 9482.288828337765, 8879.24526415262, 9025.50359730195, 9170.201326244132, 9479.241660667269, 9737.318387712792], "unit": "score", "name": "yui.html", "value": 5773.410109449436}], "name": "dromaeo_css", "value": 6223.714185997159}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [114.0, 107.0, 113.0, 114.0, 113.0, 126.0, 113.0, 112.0, 111.0, 113.0], "unit": "score", "name": "ai-astar", "value": 113.6}, {"lowerIsBetter": true, "replicates": [156.0, 144.0, 163.0, 185.0, 136.0, 170.0, 160.0, 139.0, 184.0, 142.0], "unit": "score", "name": "audio-beat-detection", "value": 157.9}, {"lowerIsBetter": true, "replicates": [163.0, 163.0, 163.0, 165.0, 167.0, 169.0, 168.0, 166.0, 166.0, 164.0], "unit": "score", "name": "audio-dft", "value": 165.4}, {"lowerIsBetter": true, "replicates": [75.0, 75.0, 74.0, 75.0, 78.0, 75.0, 74.0, 144.0, 75.0, 73.0], "unit": "score", "name": "audio-fft", "value": 81.8}, {"lowerIsBetter": true, "replicates": [95.0, 96.0, 146.0, 95.0, 95.0, 94.0, 132.0, 95.0, 95.0, 143.0], "unit": "score", "name": "audio-oscillator", "value": 108.6}, {"lowerIsBetter": true, "replicates": [120.0, 118.0, 118.0, 117.0, 119.0, 119.0, 120.0, 118.0, 118.0, 118.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 118.5}, {"lowerIsBetter": true, "replicates": [149.0, 149.0, 149.0, 148.0, 148.0, 150.0, 149.0, 150.0, 149.0, 148.0], "unit": "score", "name": "imaging-darkroom", "value": 148.9}, {"lowerIsBetter": true, "replicates": [98.0, 97.0, 96.0, 97.0, 96.0, 96.0, 97.0, 97.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.6}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 70.0, 68.0, 69.0, 67.0, 76.0, 67.0, 64.0, 66.0], "unit": "score", "name": "json-parse-financial", "value": 68.1}, {"lowerIsBetter": true, "replicates": [65.0, 66.0, 66.0, 65.0, 66.0, 66.0, 65.0, 64.0, 66.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 65.5}, {"lowerIsBetter": true, "replicates": [82.0, 84.0, 85.0, 83.0, 83.0, 92.0, 83.0, 84.0, 85.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.4}, {"lowerIsBetter": true, "replicates": [128.0, 137.0, 117.0, 122.0, 135.0, 119.0, 129.0, 123.0, 119.0, 133.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 126.2}, {"lowerIsBetter": true, "replicates": [138.0, 144.0, 141.0, 152.0, 149.0, 136.0, 151.0, 149.0, 147.0, 132.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 143.9}, {"lowerIsBetter": true, "replicates": [71.0, 71.0, 68.0, 68.0, 69.0, 78.0, 67.0, 68.0, 70.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.8}], "name": "kraken", "value": 1549.2}]} 10:08:05 INFO - Return code: 0 10:08:05 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 10:08:05 ERROR - # TBPL SUCCESS # 10:08:05 INFO - Running post-action listener: _resource_record_post_action 10:08:05 INFO - Running post-run listener: _resource_record_post_run 10:08:06 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 4096; Write bytes: 521883648; Read time: 12; Write time: 451736 10:08:06 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 233562112; Read time: 0; Write time: 285920 10:08:06 INFO - run-tests - Wall time: 1177s; CPU: 13.0%; Read bytes: 4096; Write bytes: 288321536; Read time: 12; Write time: 165816 10:08:06 INFO - Running post-run listener: _upload_blobber_files 10:08:06 INFO - Blob upload gear active. 10:08:06 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:08:06 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 10:08:06 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', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:08:06 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 Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:08:06 INFO - (blobuploader) - INFO - Open directory for files ... 10:08:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 10:08:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:08:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:08:07 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 10:08:07 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:08:07 INFO - (blobuploader) - INFO - Done attempting. 10:08:07 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 10:08:07 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:08:07 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:08:08 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 10:08:08 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:08:08 INFO - (blobuploader) - INFO - Done attempting. 10:08:08 INFO - (blobuploader) - INFO - Iteration through files over. 10:08:08 INFO - Return code: 0 10:08:08 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:08:08 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:08:08 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/679e798689c36fba718fc61a725784d93d96ddd134be60f4c638b6852d36ae9b13b194923bbb612bebded21eb08dc2722c8f124d071d8b38e50c39b3ef02cf32", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/eb8a14bd2b9cb6f836abcaa875de11c366da04809df1bc35682c319c0a0cdf21313aa21966c1c229e67056dbcd78dcd459ad457aa88d8e091dab5bfee9e88784"} 10:08:08 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:08:08 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:08:08 INFO - Contents: 10:08:08 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/679e798689c36fba718fc61a725784d93d96ddd134be60f4c638b6852d36ae9b13b194923bbb612bebded21eb08dc2722c8f124d071d8b38e50c39b3ef02cf32", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/eb8a14bd2b9cb6f836abcaa875de11c366da04809df1bc35682c319c0a0cdf21313aa21966c1c229e67056dbcd78dcd459ad457aa88d8e091dab5bfee9e88784"} 10:08:08 INFO - Running post-run listener: copy_logs_to_upload_dir 10:08:08 INFO - Copying logs to upload dir... 10:08:08 INFO - mkdir: /builds/slave/test/build/upload/logs 10:08:08 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1231.400329 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 31 secs) (at 2016-04-07 10:08:07.818590) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-07 10:08:07.822634) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/679e798689c36fba718fc61a725784d93d96ddd134be60f4c638b6852d36ae9b13b194923bbb612bebded21eb08dc2722c8f124d071d8b38e50c39b3ef02cf32", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/eb8a14bd2b9cb6f836abcaa875de11c366da04809df1bc35682c319c0a0cdf21313aa21966c1c229e67056dbcd78dcd459ad457aa88d8e091dab5bfee9e88784"} build_url:https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011196 build_url: 'https://queue.taskcluster.net/v1/task/T0pXxoQLRFStP2W5TAmt4w/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/679e798689c36fba718fc61a725784d93d96ddd134be60f4c638b6852d36ae9b13b194923bbb612bebded21eb08dc2722c8f124d071d8b38e50c39b3ef02cf32", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/eb8a14bd2b9cb6f836abcaa875de11c366da04809df1bc35682c319c0a0cdf21313aa21966c1c229e67056dbcd78dcd459ad457aa88d8e091dab5bfee9e88784"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-07 10:08:07.849700) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 10:08:07.850018) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1460047654.742343-1568824235 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004680 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-07 10:08:07.931950) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-07 10:08:07.932299) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-07 10:08:07.932593) ========= ========= Total master_lag: 0.27 =========