builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-044 starttime: 1458453041.16 results: success (0) buildid: 20160319212638 builduid: 313f368400d54c58888d4f98eaef89c0 revision: f14898695ee0dd14615914f3e1401f17df57fdd7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.158315) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.158755) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.159070) ========= 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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006337 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.183335) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.183651) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.200278) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.200564) ========= 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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004546 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.250306) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.250758) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.251295) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.251773) ========= 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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-19 22:50:42-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 82.2M=0s 2016-03-19 22:50:42 (82.2 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.082556 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.347283) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.347584) ========= 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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022300 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.399107) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.399437) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev f14898695ee0dd14615914f3e1401f17df57fdd7 --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 f14898695ee0dd14615914f3e1401f17df57fdd7 --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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-19 22:50:42,883 truncating revision to first 12 chars 2016-03-19 22:50:42,883 Setting DEBUG logging. 2016-03-19 22:50:42,883 attempt 1/10 2016-03-19 22:50:42,883 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/f14898695ee0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-19 22:50:43,145 unpacking tar archive at: fx-team-f14898695ee0/testing/mozharness/ program finished with exit code 0 elapsedTime=0.540669 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.957588) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:41.957975) ========= echo f14898695ee0dd14615914f3e1401f17df57fdd7 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'f14898695ee0dd14615914f3e1401f17df57fdd7'] 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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False f14898695ee0dd14615914f3e1401f17df57fdd7 program finished with exit code 0 elapsedTime=0.003550 script_repo_revision: 'f14898695ee0dd14615914f3e1401f17df57fdd7' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:42.006311) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:42.006643) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-19 22:50:42.018704) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2016-03-19 22:50:42.019000) ========= /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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 22:50:43 INFO - MultiFileLogger online at 20160319 22:50:43 in /builds/slave/test 22:50:43 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 22:50:43 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 22:50:43 INFO - {'append_to_log': False, 22:50:43 INFO - 'base_work_dir': '/builds/slave/test', 22:50:43 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 22:50:43 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 22:50:43 INFO - 'branch': 'Fx-Team-Non-PGO', 22:50:43 INFO - 'buildbot_json_path': 'buildprops.json', 22:50:43 INFO - 'config_files': ('talos/linux_config.py',), 22:50:43 INFO - 'default_actions': ('clobber', 22:50:43 INFO - 'read-buildbot-config', 22:50:43 INFO - 'download-and-extract', 22:50:43 INFO - 'populate-webroot', 22:50:43 INFO - 'create-virtualenv', 22:50:43 INFO - 'install', 22:50:43 INFO - 'run-tests'), 22:50:43 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 22:50:43 INFO - 'download_minidump_stackwalk': True, 22:50:43 INFO - 'download_symbols': 'ondemand', 22:50:43 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 22:50:43 INFO - 'tooltool.py': '/tools/tooltool.py', 22:50:43 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 22:50:43 INFO - '/tools/misc-python/virtualenv.py')}, 22:50:43 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 22:50:43 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 22:50:43 INFO - 'installer_path': 'installer.exe', 22:50:43 INFO - 'log_level': 'info', 22:50:43 INFO - 'log_name': 'talos', 22:50:43 INFO - 'log_to_console': True, 22:50:43 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 22:50:43 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 22:50:43 INFO - 'opt_config_files': (), 22:50:43 INFO - 'pip_index': False, 22:50:43 INFO - 'sps_profile': False, 22:50:43 INFO - 'sps_profile_interval': 0, 22:50:43 INFO - 'suite': 'dromaeojs-e10s', 22:50:43 INFO - 'system_bits': '32', 22:50:43 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 22:50:43 INFO - 'title': 'talos-linux64-ix-044', 22:50:43 INFO - 'tooltool_cache': '/builds/tooltool_cache', 22:50:43 INFO - 'use_talos_json': True, 22:50:43 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 22:50:43 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 22:50:43 INFO - 'work_dir': 'build'} 22:50:43 INFO - ##### 22:50:43 INFO - ##### Running clobber step. 22:50:43 INFO - ##### 22:50:43 INFO - Running pre-action listener: _resource_record_pre_action 22:50:43 INFO - Running main action method: clobber 22:50:43 INFO - rmtree: /builds/slave/test/build 22:50:43 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 22:50:44 INFO - Running post-action listener: _resource_record_post_action 22:50:44 INFO - ##### 22:50:44 INFO - ##### Running read-buildbot-config step. 22:50:44 INFO - ##### 22:50:44 INFO - Running pre-action listener: _resource_record_pre_action 22:50:44 INFO - Running main action method: read_buildbot_config 22:50:44 INFO - Using buildbot properties: 22:50:44 INFO - { 22:50:44 INFO - "project": "", 22:50:44 INFO - "product": "firefox", 22:50:44 INFO - "script_repo_revision": "production", 22:50:44 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 22:50:44 INFO - "repository": "", 22:50:44 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 22:50:44 INFO - "buildid": "20160319212638", 22:50:44 INFO - "pgo_build": "False", 22:50:44 INFO - "basedir": "/builds/slave/test", 22:50:44 INFO - "buildnumber": 1264, 22:50:44 INFO - "slavename": "talos-linux64-ix-044", 22:50:44 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 22:50:44 INFO - "platform": "ubuntu64_hw", 22:50:44 INFO - "scheduler": "tests-fx-team-linux64-talos", 22:50:44 INFO - "branch": "fx-team", 22:50:44 INFO - "repo_path": "integration/fx-team", 22:50:44 INFO - "revision": "f14898695ee0dd14615914f3e1401f17df57fdd7", 22:50:44 INFO - "stage_platform": "linux64", 22:50:44 INFO - "builduid": "313f368400d54c58888d4f98eaef89c0", 22:50:44 INFO - "slavebuilddir": "test" 22:50:44 INFO - } 22:50:44 INFO - Found installer url https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 22:50:44 INFO - Running post-action listener: _resource_record_post_action 22:50:44 INFO - ##### 22:50:44 INFO - ##### Running download-and-extract step. 22:50:44 INFO - ##### 22:50:44 INFO - Running pre-action listener: _resource_record_pre_action 22:50:44 INFO - Running main action method: download_and_extract 22:50:44 INFO - mkdir: /builds/slave/test/build/tests 22:50: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')]} 22:50:44 INFO - https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 22:50:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 22:50:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 22:50:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:50:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:50:45 INFO - Downloaded 1361 bytes. 22:50:45 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 22:50:45 INFO - Using the following test package requirements: 22:50:45 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 22:50:45 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 22:50:45 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 22:50:45 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 22:50:45 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 22:50:45 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 22:50:45 INFO - u'jsshell-linux-x86_64.zip'], 22:50:45 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 22:50:45 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 22:50:45 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 22:50:45 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 22:50:45 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 22:50:45 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 22:50:45 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 22:50:45 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 22:50:45 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 22:50:45 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 22:50:45 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 22:50:45 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 22:50:45 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')]} 22:50:45 INFO - https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 22:50:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 22:50:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 22:50:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:50:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:50:46 INFO - Downloaded 21999954 bytes. 22:50:46 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'] 22:50:46 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 22:50:48 INFO - Return code: 0 22:50:48 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 22:50:48 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')]} 22:50:48 INFO - https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 22:50:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 22:50:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 22:50:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:50:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:51:07 INFO - Downloaded 21999954 bytes. 22:51:07 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'] 22:51:07 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 22:51:08 INFO - Return code: 0 22:51:08 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')]} 22:51:08 INFO - https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 22:51:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 22:51:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 22:51:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:51:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:51:10 INFO - Downloaded 10847637 bytes. 22:51:10 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'] 22:51:10 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 22:51:10 INFO - Return code: 0 22:51:10 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')]} 22:51:10 INFO - https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 22:51:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 22:51:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 22:51:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:51:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/KNKzkNBzQciSMaHO0AQL2g/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 22:51:12 INFO - Downloaded 54150360 bytes. 22:51:12 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 22:51:12 INFO - mkdir: /builds/slave/test/properties 22:51:12 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 22:51:12 INFO - Writing to file /builds/slave/test/properties/build_url 22:51:12 INFO - Contents: 22:51:12 INFO - build_url:https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 22:51:12 INFO - Running post-action listener: _resource_record_post_action 22:51:12 INFO - Running post-action listener: set_extra_try_arguments 22:51:12 INFO - ##### 22:51:12 INFO - ##### Running populate-webroot step. 22:51:12 INFO - ##### 22:51:12 INFO - Running pre-action listener: _resource_record_pre_action 22:51:12 INFO - Running main action method: populate_webroot 22:51:12 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 22:51:12 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 22:51:12 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 22:51:12 INFO - '--tppagecycles', 22:51:12 INFO - '7'], 22:51:12 INFO - 'tests': ['tsvgm']}}, 22:51:12 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 22:51:12 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 22:51:12 INFO - 'tests': ['tresize', 'tcanvasmark']}, 22:51:12 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 22:51:12 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 22:51:12 INFO - 'tests': ['dromaeo_css', 'kraken']}, 22:51:12 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:51:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 22:51:12 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:51:12 INFO - 'talos_options': ['--e10s'], 22:51:12 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 22:51:12 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:51:12 INFO - 'tests': ['damp', 'tps']}, 22:51:12 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:51:12 INFO - 'talos_options': ['--e10s'], 22:51:12 INFO - 'tests': ['damp', 'tps']}, 22:51:12 INFO - 'g3': {'tests': ['dromaeo_dom']}, 22:51:12 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 22:51:12 INFO - 'other': {'tests': ['a11yr', 22:51:12 INFO - 'ts_paint', 22:51:12 INFO - 'tpaint', 22:51:12 INFO - 'sessionrestore', 22:51:12 INFO - 'sessionrestore_no_auto_restore', 22:51:12 INFO - 'tabpaint']}, 22:51:12 INFO - 'other-e10s': {'talos_options': ['--e10s'], 22:51:12 INFO - 'tests': ['a11yr', 22:51:12 INFO - 'ts_paint', 22:51:12 INFO - 'tpaint', 22:51:12 INFO - 'sessionrestore', 22:51:12 INFO - 'sessionrestore_no_auto_restore', 22:51:12 INFO - 'tabpaint']}, 22:51:13 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 22:51:13 INFO - 'tests': ['a11yr', 22:51:13 INFO - 'ts_paint', 22:51:13 INFO - 'tpaint', 22:51:13 INFO - 'sessionrestore', 22:51:13 INFO - 'sessionrestore_no_auto_restore', 22:51:13 INFO - 'tabpaint']}, 22:51:13 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 22:51:13 INFO - 'tests': ['a11yr', 22:51:13 INFO - 'ts_paint', 22:51:13 INFO - 'tpaint', 22:51:13 INFO - 'sessionrestore', 22:51:13 INFO - 'sessionrestore_no_auto_restore', 22:51:13 INFO - 'tabpaint']}, 22:51:13 INFO - 'other_l64': {'tests': ['a11yr', 22:51:13 INFO - 'ts_paint', 22:51:13 INFO - 'tpaint', 22:51:13 INFO - 'sessionrestore', 22:51:13 INFO - 'sessionrestore_no_auto_restore', 22:51:13 INFO - 'tabpaint']}, 22:51:13 INFO - 'other_nol64': {'tests': ['a11yr', 22:51:13 INFO - 'ts_paint', 22:51:13 INFO - 'tpaint', 22:51:13 INFO - 'sessionrestore', 22:51:13 INFO - 'sessionrestore_no_auto_restore', 22:51:13 INFO - 'tabpaint']}, 22:51:13 INFO - 'svgr': {'tests': ['tsvgx', 22:51:13 INFO - 'tsvgr_opacity', 22:51:13 INFO - 'tart', 22:51:13 INFO - 'tscrollx', 22:51:13 INFO - 'cart']}, 22:51:13 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 22:51:13 INFO - 'tests': ['tsvgx', 22:51:13 INFO - 'tsvgr_opacity', 22:51:13 INFO - 'tart', 22:51:13 INFO - 'tscrollx', 22:51:13 INFO - 'cart']}, 22:51:13 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:51:13 INFO - 'tests': ['tp5o']}, 22:51:13 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:51:13 INFO - 'talos_options': ['--e10s'], 22:51:13 INFO - 'tests': ['tp5o']}, 22:51:13 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:51:13 INFO - 'talos_options': ['--xperf_path', 22:51:13 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 22:51:13 INFO - 'tests': ['tp5n']}, 22:51:13 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 22:51:13 INFO - 'talos_options': ['--e10s', 22:51:13 INFO - '--xperf_path', 22:51:13 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 22:51:13 INFO - 'tests': ['tp5n']}}, 22:51:13 INFO - 'talos.zip': {'path': '', 22:51:13 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 22:51:13 INFO - Running post-action listener: _resource_record_post_action 22:51:13 INFO - ##### 22:51:13 INFO - ##### Running create-virtualenv step. 22:51:13 INFO - ##### 22:51:13 INFO - Running pre-action listener: _resource_record_pre_action 22:51:13 INFO - Running main action method: create_virtualenv 22:51:13 INFO - Creating virtualenv /builds/slave/test/build/venv 22:51:13 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 22:51:13 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 22:51:13 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 22:51:13 INFO - Using real prefix '/usr' 22:51:13 INFO - New python executable in /builds/slave/test/build/venv/bin/python 22:51:13 INFO - Installing distribute.............................................................................................................................................................................................done. 22:51:15 INFO - Installing pip.................done. 22:51:15 INFO - Return code: 0 22:51:15 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 22:51:15 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')]} 22:51:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:15 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')]} 22:51:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:15 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 22:51:15 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 22:51:15 INFO - Using env: {'DISPLAY': ':0', 22:51:15 INFO - 'HOME': '/home/cltbld', 22:51:15 INFO - 'LANG': 'en_US.UTF-8', 22:51:15 INFO - 'LANGUAGE': 'en_US:en', 22:51:15 INFO - 'LOGNAME': 'cltbld', 22:51:15 INFO - 'MAIL': '/var/mail/cltbld', 22:51:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:15 INFO - 'MOZ_NO_REMOTE': '1', 22:51:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:15 INFO - 'NO_EM_RESTART': '1', 22:51:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:15 INFO - 'PWD': '/builds/slave/test', 22:51:15 INFO - 'SHELL': '/bin/bash', 22:51:15 INFO - 'SHLVL': '1', 22:51:15 INFO - 'TERM': 'linux', 22:51:15 INFO - 'TMOUT': '86400', 22:51:15 INFO - 'USER': 'cltbld', 22:51:15 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:15 INFO - '_': '/tools/buildbot/bin/python'} 22:51:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:15 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 22:51:15 INFO - Cleaning up... 22:51:15 INFO - Return code: 0 22:51:15 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 22:51:15 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')]} 22:51:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:15 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')]} 22:51:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:15 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 22:51:15 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 22:51:15 INFO - Using env: {'DISPLAY': ':0', 22:51:15 INFO - 'HOME': '/home/cltbld', 22:51:15 INFO - 'LANG': 'en_US.UTF-8', 22:51:15 INFO - 'LANGUAGE': 'en_US:en', 22:51:15 INFO - 'LOGNAME': 'cltbld', 22:51:15 INFO - 'MAIL': '/var/mail/cltbld', 22:51:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:15 INFO - 'MOZ_NO_REMOTE': '1', 22:51:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:15 INFO - 'NO_EM_RESTART': '1', 22:51:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:15 INFO - 'PWD': '/builds/slave/test', 22:51:15 INFO - 'SHELL': '/bin/bash', 22:51:15 INFO - 'SHLVL': '1', 22:51:15 INFO - 'TERM': 'linux', 22:51:15 INFO - 'TMOUT': '86400', 22:51:15 INFO - 'USER': 'cltbld', 22:51:15 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:15 INFO - '_': '/tools/buildbot/bin/python'} 22:51:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:16 INFO - Downloading/unpacking psutil>=0.7.1 22:51:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:51:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:51:16 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 22:51:16 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 22:51:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:51:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:51:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 22:51:17 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 22:51:17 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 22:51:17 INFO - Installing collected packages: psutil 22:51:17 INFO - Running setup.py install for psutil 22:51:18 INFO - building 'psutil._psutil_linux' extension 22:51:18 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 22:51:18 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 22:51:18 INFO - building 'psutil._psutil_posix' extension 22:51:18 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 22:51:18 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 22:51:18 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 22:51:18 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 22:51:18 INFO - Successfully installed psutil 22:51:18 INFO - Cleaning up... 22:51:18 INFO - Return code: 0 22:51:18 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 22:51:18 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')]} 22:51:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:18 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')]} 22:51:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:18 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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:18 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 22:51:18 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 22:51:18 INFO - Using env: {'DISPLAY': ':0', 22:51:18 INFO - 'HOME': '/home/cltbld', 22:51:18 INFO - 'LANG': 'en_US.UTF-8', 22:51:18 INFO - 'LANGUAGE': 'en_US:en', 22:51:18 INFO - 'LOGNAME': 'cltbld', 22:51:18 INFO - 'MAIL': '/var/mail/cltbld', 22:51:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:18 INFO - 'MOZ_NO_REMOTE': '1', 22:51:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:18 INFO - 'NO_EM_RESTART': '1', 22:51:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:18 INFO - 'PWD': '/builds/slave/test', 22:51:18 INFO - 'SHELL': '/bin/bash', 22:51:18 INFO - 'SHLVL': '1', 22:51:18 INFO - 'TERM': 'linux', 22:51:18 INFO - 'TMOUT': '86400', 22:51:18 INFO - 'USER': 'cltbld', 22:51:18 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:18 INFO - '_': '/tools/buildbot/bin/python'} 22:51:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:18 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 22:51:18 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 22:51:18 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 22:51:18 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 22:51:18 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 22:51:18 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 22:51:18 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 22:51:20 INFO - Downloading mozsystemmonitor-0.0.tar.gz 22:51:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 22:51:20 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 22:51:20 INFO - Installing collected packages: mozsystemmonitor 22:51:20 INFO - Running setup.py install for mozsystemmonitor 22:51:20 INFO - Successfully installed mozsystemmonitor 22:51:20 INFO - Cleaning up... 22:51:20 INFO - Return code: 0 22:51:20 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 22:51:20 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')]} 22:51:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:20 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')]} 22:51:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:20 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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:20 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 22:51:20 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 22:51:20 INFO - Using env: {'DISPLAY': ':0', 22:51:20 INFO - 'HOME': '/home/cltbld', 22:51:20 INFO - 'LANG': 'en_US.UTF-8', 22:51:20 INFO - 'LANGUAGE': 'en_US:en', 22:51:20 INFO - 'LOGNAME': 'cltbld', 22:51:20 INFO - 'MAIL': '/var/mail/cltbld', 22:51:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:20 INFO - 'MOZ_NO_REMOTE': '1', 22:51:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:20 INFO - 'NO_EM_RESTART': '1', 22:51:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:20 INFO - 'PWD': '/builds/slave/test', 22:51:20 INFO - 'SHELL': '/bin/bash', 22:51:20 INFO - 'SHLVL': '1', 22:51:20 INFO - 'TERM': 'linux', 22:51:20 INFO - 'TMOUT': '86400', 22:51:20 INFO - 'USER': 'cltbld', 22:51:20 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:20 INFO - '_': '/tools/buildbot/bin/python'} 22:51:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:20 INFO - Downloading/unpacking blobuploader==1.2.4 22:51:20 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 22:51:20 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 22:51:20 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 22:51:20 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 22:51:20 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 22:51:20 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 22:51:22 INFO - Downloading blobuploader-1.2.4.tar.gz 22:51:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 22:51:22 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 22:51:22 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 22:51:22 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 22:51:22 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 22:51:22 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 22:51:22 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 22:51:22 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 22:51:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 22:51:23 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 22:51:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:51:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:51:23 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 22:51:23 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 22:51:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 22:51:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 22:51:23 INFO - Downloading docopt-0.6.1.tar.gz 22:51:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 22:51:23 INFO - Installing collected packages: blobuploader, requests, docopt 22:51:23 INFO - Running setup.py install for blobuploader 22:51:23 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 22:51:23 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 22:51:23 INFO - Running setup.py install for requests 22:51:24 INFO - Running setup.py install for docopt 22:51:24 INFO - Successfully installed blobuploader requests docopt 22:51:24 INFO - Cleaning up... 22:51:24 INFO - Return code: 0 22:51:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:51:24 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')]} 22:51:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:24 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')]} 22:51:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:24 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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:24 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 22:51:24 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 22:51:24 INFO - Using env: {'DISPLAY': ':0', 22:51:24 INFO - 'HOME': '/home/cltbld', 22:51:24 INFO - 'LANG': 'en_US.UTF-8', 22:51:24 INFO - 'LANGUAGE': 'en_US:en', 22:51:24 INFO - 'LOGNAME': 'cltbld', 22:51:24 INFO - 'MAIL': '/var/mail/cltbld', 22:51:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:24 INFO - 'MOZ_NO_REMOTE': '1', 22:51:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:24 INFO - 'NO_EM_RESTART': '1', 22:51:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:24 INFO - 'PWD': '/builds/slave/test', 22:51:24 INFO - 'SHELL': '/bin/bash', 22:51:24 INFO - 'SHLVL': '1', 22:51:24 INFO - 'TERM': 'linux', 22:51:24 INFO - 'TMOUT': '86400', 22:51:24 INFO - 'USER': 'cltbld', 22:51:24 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:24 INFO - '_': '/tools/buildbot/bin/python'} 22:51:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 22:51:24 INFO - Running setup.py (path:/tmp/pip-0SK7Lp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 22:51:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 22:51:24 INFO - Running setup.py (path:/tmp/pip-OHrdvv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 22:51:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 22:51:24 INFO - Running setup.py (path:/tmp/pip-ekgrXU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 22:51:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 22:51:24 INFO - Running setup.py (path:/tmp/pip-R9WvOM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 22:51:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 22:51:24 INFO - Running setup.py (path:/tmp/pip-5TrH89-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 22:51:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 22:51:24 INFO - Running setup.py (path:/tmp/pip-SXKe94-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 22:51:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 22:51:24 INFO - Running setup.py (path:/tmp/pip-KQbu9w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 22:51:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 22:51:24 INFO - Running setup.py (path:/tmp/pip-7hPV0t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 22:51:25 INFO - Running setup.py (path:/tmp/pip-M020Sk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 22:51:25 INFO - Running setup.py (path:/tmp/pip-TFr2KT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 22:51:25 INFO - Running setup.py (path:/tmp/pip-7A49Az-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 22:51:25 INFO - Running setup.py (path:/tmp/pip-SpMj53-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 22:51:25 INFO - Running setup.py (path:/tmp/pip-e1GtGm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 22:51:25 INFO - Running setup.py (path:/tmp/pip-bnC5tH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 22:51:25 INFO - Running setup.py (path:/tmp/pip-8tSceA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 22:51:25 INFO - Running setup.py (path:/tmp/pip-JQZGcu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 22:51:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 22:51:25 INFO - Running setup.py (path:/tmp/pip-c8C98A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 22:51:25 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 22:51:25 INFO - Running setup.py install for manifestparser 22:51:25 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 22:51:25 INFO - Running setup.py install for mozcrash 22:51:25 INFO - Running setup.py install for mozdebug 22:51:25 INFO - Running setup.py install for mozdevice 22:51:26 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Installing dm script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Running setup.py install for mozfile 22:51:26 INFO - Running setup.py install for mozhttpd 22:51:26 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Running setup.py install for mozinfo 22:51:26 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Running setup.py install for mozInstall 22:51:26 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Running setup.py install for mozleak 22:51:26 INFO - Running setup.py install for mozlog 22:51:26 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Running setup.py install for moznetwork 22:51:26 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Running setup.py install for mozprocess 22:51:26 INFO - Running setup.py install for mozprofile 22:51:26 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 22:51:26 INFO - Running setup.py install for mozrunner 22:51:27 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 22:51:27 INFO - Running setup.py install for mozscreenshot 22:51:27 INFO - Running setup.py install for moztest 22:51:27 INFO - Running setup.py install for mozversion 22:51:27 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 22:51:27 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 22:51:27 INFO - Cleaning up... 22:51:27 INFO - Return code: 0 22:51:27 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:51:27 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')]} 22:51:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:27 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')]} 22:51:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:27 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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:27 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 22:51:27 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 22:51:27 INFO - Using env: {'DISPLAY': ':0', 22:51:27 INFO - 'HOME': '/home/cltbld', 22:51:27 INFO - 'LANG': 'en_US.UTF-8', 22:51:27 INFO - 'LANGUAGE': 'en_US:en', 22:51:27 INFO - 'LOGNAME': 'cltbld', 22:51:27 INFO - 'MAIL': '/var/mail/cltbld', 22:51:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:27 INFO - 'MOZ_NO_REMOTE': '1', 22:51:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:27 INFO - 'NO_EM_RESTART': '1', 22:51:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:27 INFO - 'PWD': '/builds/slave/test', 22:51:27 INFO - 'SHELL': '/bin/bash', 22:51:27 INFO - 'SHLVL': '1', 22:51:27 INFO - 'TERM': 'linux', 22:51:27 INFO - 'TMOUT': '86400', 22:51:27 INFO - 'USER': 'cltbld', 22:51:27 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:27 INFO - '_': '/tools/buildbot/bin/python'} 22:51:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 22:51:27 INFO - Running setup.py (path:/tmp/pip-Dgb9kD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 22:51:27 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)) 22:51:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 22:51:27 INFO - Running setup.py (path:/tmp/pip-80vvUt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 22:51:27 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)) 22:51:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 22:51:27 INFO - Running setup.py (path:/tmp/pip-NZeF6m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 22:51:27 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)) 22:51:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 22:51:27 INFO - Running setup.py (path:/tmp/pip-9bBH00-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 22:51:27 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)) 22:51:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 22:51:27 INFO - Running setup.py (path:/tmp/pip-Lm_OvE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 22:51:28 INFO - Running setup.py (path:/tmp/pip-gJkpF6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 22:51:28 INFO - Running setup.py (path:/tmp/pip-6iyS5K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 22:51:28 INFO - Running setup.py (path:/tmp/pip-xDFAxz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 22:51:28 INFO - Running setup.py (path:/tmp/pip-cNUbCO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 22:51:28 INFO - Running setup.py (path:/tmp/pip-Wgiins-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 22:51:28 INFO - Running setup.py (path:/tmp/pip-voxxkE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 22:51:28 INFO - Running setup.py (path:/tmp/pip-bN8fPS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 22:51:28 INFO - Running setup.py (path:/tmp/pip-AlIBr5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 22:51:28 INFO - Running setup.py (path:/tmp/pip-ul5dVW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 22:51:28 INFO - Running setup.py (path:/tmp/pip-lEgAEl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 22:51:28 INFO - Running setup.py (path:/tmp/pip-tDSRh0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 22:51:28 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)) 22:51:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 22:51:28 INFO - Running setup.py (path:/tmp/pip-SF8mcw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 22:51:28 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)) 22:51:28 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)) 22:51:28 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)) 22:51:28 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)) 22:51:28 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)) 22:51:28 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)) 22:51:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 22:51:28 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 22:51:28 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 22:51:28 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 22:51:28 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 22:51:28 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 22:51:28 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 22:51:30 INFO - Downloading blessings-1.6.tar.gz 22:51:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 22:51:30 INFO - Installing collected packages: blessings 22:51:30 INFO - Running setup.py install for blessings 22:51:30 INFO - Successfully installed blessings 22:51:30 INFO - Cleaning up... 22:51:30 INFO - Return code: 0 22:51:30 INFO - Done creating virtualenv /builds/slave/test/build/venv. 22:51:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 22:51:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 22:51:31 INFO - Reading from file tmpfile_stdout 22:51:31 INFO - Current package versions: 22:51:31 INFO - argparse == 1.2.1 22:51:31 INFO - blessings == 1.6 22:51:31 INFO - blobuploader == 1.2.4 22:51:31 INFO - docopt == 0.6.1 22:51:31 INFO - manifestparser == 1.1 22:51:31 INFO - mozInstall == 1.12 22:51:31 INFO - mozcrash == 0.17 22:51:31 INFO - mozdebug == 0.1 22:51:31 INFO - mozdevice == 0.48 22:51:31 INFO - mozfile == 1.2 22:51:31 INFO - mozhttpd == 0.7 22:51:31 INFO - mozinfo == 0.9 22:51:31 INFO - mozleak == 0.1 22:51:31 INFO - mozlog == 3.1 22:51:31 INFO - moznetwork == 0.27 22:51:31 INFO - mozprocess == 0.22 22:51:31 INFO - mozprofile == 0.28 22:51:31 INFO - mozrunner == 6.11 22:51:31 INFO - mozscreenshot == 0.1 22:51:31 INFO - mozsystemmonitor == 0.0 22:51:31 INFO - moztest == 0.7 22:51:31 INFO - mozversion == 1.4 22:51:31 INFO - psutil == 3.1.1 22:51:31 INFO - requests == 1.2.3 22:51:31 INFO - wsgiref == 0.1.2 22:51:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 22:51:31 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')]} 22:51:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:31 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')]} 22:51:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:31 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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:31 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 22:51:31 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 22:51:31 INFO - Using env: {'DISPLAY': ':0', 22:51:31 INFO - 'HOME': '/home/cltbld', 22:51:31 INFO - 'LANG': 'en_US.UTF-8', 22:51:31 INFO - 'LANGUAGE': 'en_US:en', 22:51:31 INFO - 'LOGNAME': 'cltbld', 22:51:31 INFO - 'MAIL': '/var/mail/cltbld', 22:51:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:31 INFO - 'MOZ_NO_REMOTE': '1', 22:51:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:31 INFO - 'NO_EM_RESTART': '1', 22:51:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:31 INFO - 'PWD': '/builds/slave/test', 22:51:31 INFO - 'SHELL': '/bin/bash', 22:51:31 INFO - 'SHLVL': '1', 22:51:31 INFO - 'TERM': 'linux', 22:51:31 INFO - 'TMOUT': '86400', 22:51:31 INFO - 'USER': 'cltbld', 22:51:31 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:31 INFO - '_': '/tools/buildbot/bin/python'} 22:51:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 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)) 22:51:31 INFO - Cleaning up... 22:51:31 INFO - Return code: 0 22:51:31 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 22:51:31 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')]} 22:51:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:31 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')]} 22:51:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:31 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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:31 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 22:51:31 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 22:51:31 INFO - Using env: {'DISPLAY': ':0', 22:51:31 INFO - 'HOME': '/home/cltbld', 22:51:31 INFO - 'LANG': 'en_US.UTF-8', 22:51:31 INFO - 'LANGUAGE': 'en_US:en', 22:51:31 INFO - 'LOGNAME': 'cltbld', 22:51:31 INFO - 'MAIL': '/var/mail/cltbld', 22:51:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:31 INFO - 'MOZ_NO_REMOTE': '1', 22:51:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:31 INFO - 'NO_EM_RESTART': '1', 22:51:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:31 INFO - 'PWD': '/builds/slave/test', 22:51:31 INFO - 'SHELL': '/bin/bash', 22:51:31 INFO - 'SHLVL': '1', 22:51:31 INFO - 'TERM': 'linux', 22:51:31 INFO - 'TMOUT': '86400', 22:51:31 INFO - 'USER': 'cltbld', 22:51:31 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:31 INFO - '_': '/tools/buildbot/bin/python'} 22:51:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:31 INFO - Downloading/unpacking jsonschema 22:51:31 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 22:51:31 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 22:51:31 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 22:51:31 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 22:51:31 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 22:51:31 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 22:51:33 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 22:51:33 INFO - Downloading/unpacking functools32 (from jsonschema) 22:51:33 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 22:51:33 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 22:51:33 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 22:51:33 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 22:51:33 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 22:51:33 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 22:51:33 INFO - Downloading functools32-3.2.3-2.tar.gz 22:51:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 22:51:33 INFO - warning: no files found matching '*.txt' 22:51:33 INFO - no previously-included directories found matching 'build' 22:51:33 INFO - no previously-included directories found matching 'dist' 22:51:33 INFO - no previously-included directories found matching '.git*' 22:51:33 INFO - Installing collected packages: jsonschema, functools32 22:51:33 INFO - Running setup.py install for functools32 22:51:33 INFO - warning: no files found matching '*.txt' 22:51:33 INFO - no previously-included directories found matching 'build' 22:51:33 INFO - no previously-included directories found matching 'dist' 22:51:33 INFO - no previously-included directories found matching '.git*' 22:51:33 INFO - Successfully installed jsonschema functools32 22:51:33 INFO - Cleaning up... 22:51:33 INFO - Return code: 0 22:51:33 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 22:51:33 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')]} 22:51:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 22:51:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:33 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')]} 22:51:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 22:51:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 22:51:33 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 0x7f8af54f8f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20248a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x20ef5a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, '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': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', '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 22:51:33 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 22:51:33 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 22:51:33 INFO - Using env: {'DISPLAY': ':0', 22:51:33 INFO - 'HOME': '/home/cltbld', 22:51:33 INFO - 'LANG': 'en_US.UTF-8', 22:51:33 INFO - 'LANGUAGE': 'en_US:en', 22:51:33 INFO - 'LOGNAME': 'cltbld', 22:51:33 INFO - 'MAIL': '/var/mail/cltbld', 22:51:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:33 INFO - 'MOZ_NO_REMOTE': '1', 22:51:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:33 INFO - 'NO_EM_RESTART': '1', 22:51:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:33 INFO - 'PWD': '/builds/slave/test', 22:51:33 INFO - 'SHELL': '/bin/bash', 22:51:33 INFO - 'SHLVL': '1', 22:51:33 INFO - 'TERM': 'linux', 22:51:33 INFO - 'TMOUT': '86400', 22:51:33 INFO - 'USER': 'cltbld', 22:51:33 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:33 INFO - '_': '/tools/buildbot/bin/python'} 22:51:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 22:51:34 INFO - Downloading/unpacking flake8 22:51:34 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 22:51:34 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 22:51:34 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 22:51:34 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 22:51:34 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 22:51:34 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 22:51:36 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 22:51:36 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 22:51:36 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 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 22:51:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 22:51:36 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 22:51:36 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 22:51:36 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 22:51:36 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 22:51:36 INFO - no previously-included directories found matching 'docs/_build' 22:51:36 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 22:51:36 INFO - Running setup.py install for pep8 22:51:36 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 22:51:36 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 22:51:36 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 22:51:36 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 22:51:36 INFO - no previously-included directories found matching 'docs/_build' 22:51:36 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 22:51:36 INFO - Successfully installed flake8 mccabe pyflakes pep8 22:51:36 INFO - Cleaning up... 22:51:37 INFO - Return code: 0 22:51:37 INFO - Running post-action listener: _resource_record_post_action 22:51:37 INFO - Running post-action listener: _start_resource_monitoring 22:51:37 INFO - Starting resource monitoring. 22:51:37 INFO - ##### 22:51:37 INFO - ##### Running install step. 22:51:37 INFO - ##### 22:51:37 INFO - Running pre-action listener: _resource_record_pre_action 22:51:37 INFO - Running main action method: install 22:51:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 22:51:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 22:51:37 INFO - Reading from file tmpfile_stdout 22:51:37 INFO - Detecting whether we're running mozinstall >=1.0... 22:51:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 22:51:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 22:51:37 INFO - Reading from file tmpfile_stdout 22:51:37 INFO - Output received: 22:51:37 INFO - Usage: mozinstall [options] installer 22:51:37 INFO - Options: 22:51:37 INFO - -h, --help show this help message and exit 22:51:37 INFO - -d DEST, --destination=DEST 22:51:37 INFO - Directory to install application into. [default: 22:51:37 INFO - "/builds/slave/test"] 22:51:37 INFO - --app=APP Application being installed. [default: firefox] 22:51:37 INFO - mkdir: /builds/slave/test/build/application 22:51:37 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'] 22:51:37 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 22:51:52 INFO - Reading from file tmpfile_stdout 22:51:52 INFO - Output received: 22:51:52 INFO - /builds/slave/test/build/application/firefox/firefox 22:51:52 INFO - Running post-action listener: _resource_record_post_action 22:51:52 INFO - ##### 22:51:52 INFO - ##### Running run-tests step. 22:51:52 INFO - ##### 22:51:52 INFO - Running pre-action listener: _resource_record_pre_action 22:51:52 INFO - Running main action method: run_tests 22:51:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 22:51:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 22:51:52 INFO - Python 2.7.3 22:51:52 INFO - Return code: 0 22:51:52 INFO - grabbing minidump binary from tooltool 22:51:52 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')]} 22:51:52 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 0x217e410>, '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 0x217f310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x217f7a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 22:51:52 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 22:51:52 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 22:51:53 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 22:51:53 INFO - Return code: 0 22:51:53 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 22:51:53 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 22:51:53 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 22:51:53 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 22:51:53 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 22:51:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 22:51:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 22:51:54 INFO - Return code: 0 22:51:54 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/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-044', '--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 22:51:54 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/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-044 --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 22:51:54 INFO - Using env: {'DISPLAY': ':0', 22:51:54 INFO - 'HOME': '/home/cltbld', 22:51:54 INFO - 'LANG': 'en_US.UTF-8', 22:51:54 INFO - 'LANGUAGE': 'en_US:en', 22:51:54 INFO - 'LOGNAME': 'cltbld', 22:51:54 INFO - 'MAIL': '/var/mail/cltbld', 22:51:54 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 22:51:54 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 22:51:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 22:51:54 INFO - 'MOZ_NO_REMOTE': '1', 22:51:54 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 22:51:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 22:51:54 INFO - 'NO_EM_RESTART': '1', 22:51:54 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 22:51:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 22:51:54 INFO - 'PWD': '/builds/slave/test', 22:51:54 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 22:51:54 INFO - 'SHELL': '/bin/bash', 22:51:54 INFO - 'SHLVL': '1', 22:51:54 INFO - 'TERM': 'linux', 22:51:54 INFO - 'TMOUT': '86400', 22:51:54 INFO - 'USER': 'cltbld', 22:51:54 INFO - 'XDG_SESSION_COOKIE': '574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852', 22:51:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 22:51:54 INFO - '_': '/tools/buildbot/bin/python'} 22:51:54 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/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-044', '--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 22:51:54 INFO - mozversion application_buildid: 20160319212638 22:51:54 INFO - mozversion application_changeset: f14898695ee0dd14615914f3e1401f17df57fdd7 22:51:54 INFO - mozversion application_display_name: Nightly 22:51:54 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 22:51:54 INFO - mozversion application_name: Firefox 22:51:54 INFO - mozversion application_remotingname: firefox 22:51:54 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 22:51:54 INFO - mozversion application_vendor: Mozilla 22:51:54 INFO - mozversion application_version: 48.0a1 22:51:54 INFO - mozversion platform_buildid: 20160319212638 22:51:54 INFO - mozversion platform_changeset: f14898695ee0dd14615914f3e1401f17df57fdd7 22:51:54 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 22:51:54 INFO - mozversion platform_version: 48.0a1 22:51:54 INFO - using testdate: 1458453114 22:51:54 INFO - actual date: 1458453114 22:51:54 INFO - starting webserver on 'localhost:42465' 22:51:54 INFO - SUITE-START | Running 2 tests 22:51:54 INFO - TEST-START | dromaeo_css 22:51:54 INFO - operating with platform_type : linux_ 22:51:54 INFO - Initialising browser for dromaeo_css test... 22:51:54 INFO - TEST-INFO | started process 20254 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdgL3PE/profile http://localhost:42465/getInfo.html) 22:51:58 INFO - PROCESS | 20254 | 22:51:58 INFO - PROCESS | 20254 | (process:20336): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 22:51:58 INFO - PROCESS | 20254 | 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] 22:51:59 INFO - PROCESS | 20254 | __metrics Screen width/height:1600/1200 22:51:59 INFO - PROCESS | 20254 | colorDepth:24 22:51:59 INFO - PROCESS | 20254 | Browser inner width/height: 1024/697 22:51:59 INFO - PROCESS | 20254 | __metrics 22:51:59 ERROR - PROCESS | 20254 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 22:52:00 INFO - TEST-INFO | 20254: exit 0 22:52:00 INFO - Browser initialized. 22:52:00 INFO - Running cycle 1/1 for dromaeo_css test... 22:52:00 INFO - TEST-INFO | started process 20387 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdgL3PE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 22:52:02 INFO - PROCESS | 20387 | 22:52:02 INFO - PROCESS | 20387 | (process:20447): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 22:52:12 INFO - PROCESS | 20387 | RSS: Main: 167530496 22:52:12 INFO - PROCESS | 20387 | 22:53:02 INFO - PROCESS | 20387 | 1458453182074 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] 22:55:13 INFO - PROCESS | 20387 | Cycle 1(1): loaded http://localhost:42465/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42465/tests/dromaeo/cssquery-ext.html) 22:55:15 INFO - PROCESS | 20387 | RSS: Main: 173367296 22:55:15 INFO - PROCESS | 20387 | 22:58:17 INFO - PROCESS | 20387 | Cycle 1(1): loaded http://localhost:42465/tests/dromaeo/cssquery-ext.html (next: http://localhost:42465/tests/dromaeo/cssquery-jquery.html) 22:58:17 INFO - PROCESS | 20387 | RSS: Main: 169111552 22:58:17 INFO - PROCESS | 20387 | 23:01:19 INFO - PROCESS | 20387 | Cycle 1(1): loaded http://localhost:42465/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42465/tests/dromaeo/cssquery-mootools.html) 23:01:20 INFO - PROCESS | 20387 | RSS: Main: 169648128 23:01:20 INFO - PROCESS | 20387 | 23:04:21 INFO - PROCESS | 20387 | Cycle 1(1): loaded http://localhost:42465/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42465/tests/dromaeo/cssquery-prototype.html) 23:04:22 INFO - PROCESS | 20387 | RSS: Main: 168116224 23:04:22 INFO - PROCESS | 20387 | 23:07:25 INFO - PROCESS | 20387 | Cycle 1(1): loaded http://localhost:42465/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42465/tests/dromaeo/cssquery-yui.html) 23:07:25 INFO - PROCESS | 20387 | RSS: Main: 168419328 23:07:25 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | Cycle 1(1): loaded http://localhost:42465/tests/dromaeo/cssquery-yui.html (next: http://localhost:42465/tests/dromaeo/cssquery-dojo.html) 23:10:28 INFO - PROCESS | 20387 | RSS: Main: 172183552 23:10:28 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | __start_tp_report 23:10:28 INFO - PROCESS | 20387 | _x_x_mozilla_page_load 23:10:28 INFO - PROCESS | 20387 | _x_x_mozilla_page_load_details 23:10:28 INFO - PROCESS | 20387 | |i|pagename|runs| 23:10:28 INFO - PROCESS | 20387 | |0;dojo.html;2643.2598872315752;2704.7430494103064;2715.511207982562;2721.7958653100995;2741.56135018397;4741.952580474199;4757.381540399748;4801.717038109268;4805.231163013918;4844.394450693663;4650.279206722963;4804.159272127373;4827.227643577028;4886.657933944625;4914.803407863681;4370.3007518797;4404.735715857043;4466.3300504924355;4492.168948744476;4565.041341318327;4388.056567837914;4408.933865992013;4439.356293337464;4446.71096378736;4503.279475283955;4369.847055353063;4430.446194225722;4449.822007119744;4457.977710111461;4490.034642551867;4418.050119224382;4422.027154026109;4422.447194100738;4446.421965144543;4497.168023915586;4320.567943205686;4383.123375324948;4411.338299255105;4413.962718761089;4445.777711114463;4724.976375118137;4727.763611819395;4758.78585463655;4769.213079841822;4785.617150627942;5105.872353191163;5145.099607568661;5148.922766158511;5151.896962060738;5207.1668533034535;5037.722925239111;5124.564412024983;5205.973970130163;5208.036513245024;5257.7896884124975;4831.0096430231715;4854.805807767721;4861.927071093901;4896.265560165933;4901.2158054711435;5276.604254680914;5278.340207474066;5301.1783173608155;5323.387810401776;5332.68003919766;4978.900421991612;5122.820701275437;5123.436421993578;5145.253938178943;5197.506236907563;4987.102321582078;5139.511746384088;5141.331626888481;5211.166213405837;5223.4776522347465;5128.051310507568;5137.845864624067;5139.177731562932;5161.045206636784;5216.243644671501;4984.40187177541;5062.417821950523;5124.718140502234;5131.640785145004;5210.218467229945;4415.09490554442;4421.845235416745;4429.357743127229;4456.554344565518;4463.509014008457;3836.9040773980314;3850.9037274068373;3874.2832575973534;3875.0699832040673;3915.5888631693833;4257.1698518788535;4461.107778444324;4480.596746292849;4509.751963641966;4543.068670922453;5173.586113111018;5182.378114626269;5191.558717509054;5204.42751297357;5235.136202526541;4465.040016396425;4467.441569803775;4486.461624605068;4494.775261236925;4514.164879497303;4543;4659.277811939087;4700.2009658358165;4712.575868171881;4740.431148262231;4859.684120532154;4861.80552777892;4869.829555965524;4877.609791216623;4939.629527785431;4992.700437973734;5210.1663733803925;5211.869703257297;5222.529972302511;5264.684118952875;4820.662553621213;4832.63755218353;4851.514848515261;4883.975580122076;4892.192788189909;5133.563647090039;5158.226266060121;5171;5171.9482805171465;5219;5100.38795344561;5137.434882163034;5207.270982062439;5211.843644690665;5222;4873.634477414137;4944.15949288629;4970.3290055842;5036.093503169464;5124.231365295235;4967.130752118437;4969.900601987868;4973.179425394769;4983.327250821093;5055.848324550269;4904.926426103682;4931.876703082452;4938.604911606991;4949.381327334083;4953.876153096201;4855.441624213261;4982.6512144149565;5031.874203144951;5059.645824792229;5065;4897.461279259207;4931.950680493149;4945.381827271591;4959.876003099951;4986.7257300848805 23:10:28 INFO - PROCESS | 20387 | |1;ext.html;514.3339375508716;528.1154066937878;528.6669398279083;548.9788992473998;572.081808697041;35976.64023359765;36569.90290291289;36814.63185368146;36863.44704829423;36927.815360923225;37724.43413348802;38345.424818627675;38392.80803595978;38418.615813841854;38476.230475390475;7583.620818959043;7753.767386978399;7796.064472263308;7824.100228473713;7830.412719046066;7648.196939321375;7759.88360174595;7776.911232427465;7794.3764498839955;7862;7798.2201779822135;7815.374770018385;7890.0531936167745;7943.324817390529;7956.403269754763;7827.6477558510005;7854.685812567547;7856.371490280764;7858.371330293563;7888.9605551972445;7800;7851.900733897259;7875.566843823587;7897.131315555284;7927.3658107351275;34420;34806.30387392238;34835.65164348375;34894.12764680878;34974.47538286928;3317.2204531934976;3430.262493563871;3591.892243232707;3730.291244663505;3744.9888530096996;27970.720292797014;28524.714752852415;28849;28877.42245155085;29406.558901616492;3243.2864769750618;3255.7395408367274;3290.555774970372;3300.8349582520777;3341.1313058604696;227004;228833;229713;230567;231000;42550;43399.132017360105;48434.75782621064;48666.75666621715;49312.260316095286;40521.79739101286;40700.796496017334;40780;40931;40995.59004409977;12301.446434910451;12319.876801231872;12425.813612795815;12497.875021249853;12515.624531264077;9472.715818525456;9639.084286992866;9642.903570964341;9647.372920760128;9695.836499619949;14025.509107181404;14314.284285785669;14472.927635361966;14634.780478292834;14646.487372941896;5973.462388385066;6022.969885150634;6078.331383547807;6111.877762444727;6142.969285153546;818.7257268814894;969.4425705219527;971.6599190283345;984.4487087231173;1048.4024106259512;26509;26835.194944151706;26938.812165721945;27386.45227095447;27434.176974690792;945.385499425379;1001.8397056471075;1010.9646162384429;1036.362636978253;1063.5426766490484;13884.305784710725;14078.859211407755;14162.36269367881;14564;14634.414623414945;279642;283584;284532;285199;287810;43700.78149609295;43712.3443148353;43973.78013109914;44062.457813976354;44639.77680111644;1189.4706855449242;1194.2416565480808;1228.969275768113;1237.07219585311;1237.5977807212512;25879.741202588488;26250.606240906785;26295.737042630095;26385.868070659522;26699;37784.24431511409;38093;38140.42789358217;38200.2359952805;38243.617563825115;265404;267250;268676;270972;271179;30921.226969325948;32146.19634509156;32368.35263294768;32473.512897306086;32594;40904.38643420291;47323.29015064708;49068.75465622649;49132.263016055505;49167.26249106195;34658.48012279868;35073;35646.82176589101;35783;35816;34436;34818.30363392668;34915.82542087273;35187.82406087953;35229.295414092085;34872.65127348694;35153.296934060665;36954.44568331531;38145.80927095347;38171.61828381681;29017.274568135967;31101.377972439972;31650.208744781565;31911.521327179646;31951.6804831958;24787.25638230856;24930.37674058163;24951.75048249567;25090;25171.622425663994 23:10:28 INFO - PROCESS | 20387 | |2;jquery.html;348.22867348822354;353.3145697347146;354.26313268401725;363.7308391790076;364.8267073140257;15485.070895746263;15829.366825326988;16143.354265829368;16505.33978640856;16568.668626627492;15577.922110389432;15774.290156942936;15825.366985320574;15914.363425462996;15936.681266374666;4877.26840973855;4899.43656479505;5063.291139240509;5100.056489549426;5116.8976620467565;4514.638828893697;5029.346184995946;5072.847814565569;5079.923801142986;5094.0830650483085;5025.296458495814;5055;5056.469070747574;5056.570191533724;5064.721440320799;4866.294387313837;5074.492550744914;5083.491650834924;5087.313212716292;5107.923381149286;4899.461059283476;4909.0672772173175;4916.06594746997;4973.378327709036;5326.307580014612;11708.356040417773;11787.17489775716;11815.88184118165;11905.642830715093;11918.523259069627;1938.7964263752244;2211.756706762255;2427;2484.8260621756485;2501.2746303571944;8904.777380565472;9077.727668169966;9285.53572321388;9412.811743765087;9495.240380769523;1734.6617409605133;1817.318505560415;1819.5996880686228;1837.8345948864533;1859.0425930645729;39063.8046809767;42798.57201428008;57225.42774572242;57990.420095799345;61873;9858.40849549015;10130.341527800669;10226.335288206243;10316.123129533924;10754.171790795583;13326.20042797416;13393.73212535744;13400.396982135828;13416.798748018788;13454.93272533631;6408.198975128109;6545.37818907203;6589.571677841021;6620.205575330991;6653.866922661519;5919.3192782829665;5951.553633477506;6019.127226552213;6030.547708921848;6037.818865434044;4434.84478043267;4491.685582009293;4509.977450112729;4510.819567217341;4556.863294101182;1822.82683145101;1837.6784062788959;1869.2336142181641;1872.419549939523;1874.3158747057225;916.6837441082815;919.8988111307751;939.8402271613842;948.0803620488116;956.297121615612;16042.197890105448;16109.355625775072;16427.178641067898;16601.750973735405;16704.248308826132;892.7991201979632;897.9146981036791;913.2328843771264;949.0414681172066;950.1733491861986;9111.362204645611;9397.624095036259;9569.569369378394;9617.51912404377;9773.120419162167;302180;307724;308129;397882;400444;50507.74746126246;52765.208521872206;66729;70739.64630176817;71685.2831471689;963.6386355116831;973.7711637765119;997.1823105053786;999.0758548342753;1006.0995409108807;14752.63118422048;14784.778228326799;15290.541283761506;15293.164820221644;15595.532134035997;32288.83855580707;32310.515342269413;32349.67650323561;32430.675693242767;32619.836900815342;42206.155876882905;45396;46179;46197.64172380905;46329.768351158025;7481.476296659399;7481.962590187014;7555.6977720890545;7591.240875912365;7622;10093.14208292274;10862.565497380332;10880.945595271973;11265.605703800327;11339.829902551302;9488.288378371511;9695.66065187715;9825.557849896915;10038.949805250926;10232.846507302247;9351.48566828831;9473.336866419284;9593.616255349707;9793.706188814347;9818.509074546102;9328.347015708836;9750.463724495221;9808.16630586408;9861.950690246504;10129.240306976859;7524.887126693214;7567.243275672388;7615.086189657055;7641.044869391326;7730.342920851565;8681.609327580149;9584.28117891147;9620.567074481525;9774.560144793359;9886.703398898044 23:10:28 INFO - PROCESS | 20387 | |3;mootools.html;1384.9515266965657;1392.081226390582;1496.3042185383795;1686.9662606747872;1710.7433884917268;5837.007708689523;6700.229473610536;6744;6932.514723969318;6965.094537710097;6855.760048398307;6897.551659142152;6945.305469453052;6959.234484206733;6979.89530157048;2118.523332250239;2127.7659457459704;2144.731908511436;2153.6984822124914;2155.041006751996;2064.194963964055;2074.3258441006656;2180;2180.8473406861526;2182.8362872784523;2172.228858755143;2177.314146043999;2184.137265780016;2201.2625770366944;2215.9113635454564;2189.79196976287;2199.0434161139956;2199.25225423356;2199.3621849663577;2202.317281642696;2084.593504266669;2108.3042595943302;2113.2709215320688;2123.9150433982622;2126.9361919142452;7025.367716905503;7065.788026359218;7069.929300706978;7071.36357727807;7074.823129421754;4219.683523735702;4301.741895486281;4332.653387728974;4335.436393268887;4348.717333373321;2824.322162680942;2873.913782586526;2917.7519910807605;2928.253295409657;2932.4135172965493;885.5978530961086;899.2985471332371;901.4185850126697;907.8865141857268;926.2034650200821;9230.076992300783;9239.122283383067;9247.39891907024;9272.258219342437;9277.907220927771;3833.5974722654278;3952.505936757905;3955;3997.960020399817;4010.578889216649;7973.681052757941;8010.359171266285;8016.879746803803;8020.919790802134;8047.155048719917;4235.4917409911;4242.936355954663;4247.277962746341;4268.914621707549;4270.167317373144;3354.6142193648043;3748.2316125194816;3789.109559253573;3821.7706937583835;3839.9808000959815;3451.930961380758;3465.8093804840473;3526.365254254259;3527.6472352764517;3537.6108628050893;1123.7359220583157;1134.1040577943331;1145.8968692817687;1147.839302497651;1153.5443499817525;1020.0462567499412;1025.2208321675432;1039.6205385034407;1127.5264388956657;1237.2823762217893;6575.638339891352;6616.569922954993;6658.500612454085;6659.633720145439;6681.799546013627;434.38534473719966;453.93417954397086;455.6537031855813;455.9521250268674;456.51837311635876;5204;5204.115300398866;5233.921491177635;5247.816326428557;5253.789848406097;8134.715284964997;8388.748337549883;8416.452930559493;8428.536430496382;8460.407771456063;8188.7952801180445;8248.422610417214;8284.544350060683;8289.4197406181;8301.335893128535;6302.180716506825;6430.549861509743;6432.324605916311;6487.481001519867;6505.0567667688865;6519.4132528072705;6625.304343044104;6632.734690612515;6674.332566743286;6702.329767023259;7255.637218139177;7507.798752199622;7531.397488201041;7579.886301705589;7659.272369124924;7482.551046937201;7636.389088872766;7734.381249499914;7773.883391749241;7789.532628042336;5295.364556253275;5971.552133589911;6128.4790792783115;6180.6600636965395;6348.079528468438;6694.564853284521;6702.698378572878;6708.42978346846;6717.697703603252;6734.326567343226;6069.726862291119;6216.44052035319;6234.438900498795;6238.376162383725;6307.716152773228;5915.142304365929;6047.334793172659;6056.242969628796;6058.787942421994;6128.111423843428;6315;6316.84207894788;6330.3669633036325;6361.777337793155;6363.3636636336;5761.596688231783;5801.477866991822;5805.071188609802;5808.30300363959;5826.155207494974;5818.389069147678;5895.233619629421;5922.763089476372;5942.10868369748;5947.702614869326 23:10:28 INFO - PROCESS | 20387 | |4;prototype.html;299.6538997457937;300.69629674029227;308.50946994279104;311.19866344163785;312.4298155865546;5606.775728970836;5688.516476099531;5696.515796157327;5790.131480277961;5806.245188125537;5647.8588035299135;5673.517750991171;5693.487586117249;5697.230873832032;5745.138229265613;4059.9594004060023;4168.1038576706005;4209.410682504452;4299.484061912567;4309.482862056558;4264.8507302244425;4266.957330426702;4282.122164956177;4283.550227226143;4289.892752681177;4216.957830421703;4224.450821393215;4228.238916994939;4233.005243767712;4239.59723826236;4232.153569286124;4234.3860140279485;4237.788110594473;4242.554531774181;4247.8300867965245;3634.0914771307175;3651.014226158949;3660.194757153422;3663.505426767379;3675.7059435245383;5395.082835917903;5400.540954018913;5403.918941215885;5404.135338345845;5408.648437851566;4759.547842954914;4883.316335713003;4885.2427873679635;4889.09551732927;4912.70523768575;5955.076963070731;5963;5969.791057313017;5972.641641501524;5987.1019347097845;4062.6546743526837;4067.7966101694797;4069.755814651101;4076.0217547788616;4081.08175660477;6263.6241825490615;6332.145160403379;6340.556161068727;6348.682565871688;6364.268109167412;4161.271777438936;4166.791660416967;4167.97916010418;4171.749695018309;4172.7913604319665;4181.372794080851;4205.17998990194;4206.684498662551;4213.220554197484;4218.746875187438;4782.593479554277;4908.901821963541;4911.533404326583;4913.213885778258;4929;5973.1936188614845;5991.9700401498585;5994.640321580632;6009.218801555857;6012.609180403348;1484.5101116631486;1496.2369191712087;1497.0568541818584;1497.9251037448084;1498.7676910078956;967.8354679704468;968.9127978481971;988.8665030220972;992.8262554053011;1011.4790882695418;5214.32213812202;5245.186996015624;5248.186531087687;5250.527452529214;5251.658642188246;6242.438180563771;6263.655498947511;6267.467265282502;6274.309825919146;6281.466075383643;5071.822486212965;5226.477352264743;5231.189165679326;5238.371395432497;5238.790448382022;3322.767406281537;3386.8983930482127;3390.6609339065894;3398.439257522481;3403.4384326586332;5818.5345172386105;5834.445727655951;5840.707964601838;5851.444112809277;5864.648121112747;6423.164988551458;6432.9678351607945;6452.774152904626;6472.385123413268;6476.125723027425;5787.131930210502;5812.680302583399;5838.999999999915;5854.941450585439;5856.736446859816;6093.421124993119;6281.780137695158;6300.432961033529;6316.14732011191;6319;6160.691965401622;6166.1983942087245;6166.876662466815;6172.4136207060255;6182.227221597301;5839.5912286141265;5840.561957853093;5849.678267695147;5852.97572924745;5869.941300586939;4206.81069351886;4209.284421648266;4209.6000879916355;4210.431591735077;4221.598948099926;6282.717277722605;6283.497320214463;6293.181886354744;6293.811185664437;6300.59046161998;5820.94179058204;6055.485283750754;6078.240219972504;6090.147379366981;6099.176611157614;6088.4215999479975;6101.145839582373;6114.48026917717;6143.354947730602;6143.6928153593035;5798.362180160095;5841.094630332305;5889.293284805851;5904.468597826216;5921.644701317935;6052;6093.299270583762;6099.786507472217;6119.816405507842;6121.081837724377;5806.709664516842;5918.940810591839;5937.554683398849;5971.58198926071;5972.13404056418 23:10:28 INFO - PROCESS | 20387 | |5;yui.html;664.2493981800565;698.1203683358967;707.4693979515364;723.2694978072147;745.443130063881;10867.945660271687;10893.455327233636;10895.400752958583;11023.338599684024;11287.830682539769;12152.878471215285;12319.260844349345;12347.444365003574;12351;12404.565840195595;641.1152609399023;801.69535576481;810.0643756461296;813.979650508739;814.5397850214639;780.4692808889953;794.0868001797921;801.8596745569531;802.8675268580677;805.8348038652092;846.4751853850621;850.0267194062794;854.2482615298528;854.6666799948025;858.1118542308711;837.1461109668165;842.5534466732611;845.298402326074;845.4335595151233;847.7117779954814;609.7591451376682;614.2475467552257;615.7260019291417;616.3589866538795;618.3013195089565;13419.664508387368;13452.260125693083;13486.460541578324;13491;13533.255670938095;12257.877421225763;12372.44324005422;12542.498300068077;12706.491740330375;12845.486180552767;10013.949930250375;10201.897981020169;10240.078392944672;10363.63727269542;10544.947275263652;3242.8702851885896;3283;3295.3244584860045;3314.784539004981;3399.9660003399895;44449.33326000145;44726.77636611828;45180.54819451796;45449.772751136035;45752.771236143606;9582.952085239529;9613.279004074722;9630.807383852283;9686.225101991824;9747.707568772948;17142.314307427812;17145.22846471912;17154.571135721457;17163.399281025104;17185.39851105205;6697.296783837627;6894.482913781386;6898.103246577913;6933.79198624032;6982.581045137308;3643.653852883972;3688.0595448160548;3722.664960153599;3738.8504459821847;3751.2122454284904;2953.881844726187;2963.03701297075;2970.4801659709465;2987.985060074686;2996.2060054085687;525.976331065103;532.0290469892461;541.339565729809;544.7249139184686;556.3157316500645;608.9921180446369;613.5091926458904;635.4249404289126;638.6040654794058;641.3298103481873;8205.71280005197;8535.786605334792;8598.914010859937;8611.784705382415;8645.783855403539;577.4964587481227;595.4164918380012;616.9938300617026;618.038949433635;619.9690015499207;3684.4784731025934;3804.391297392404;3853.8265778040054;3873.4189871519498;3981.5819338969573;48840;49871.50128498741;49999.25001124986;50294;50350.49649503458;44380;45163.096738065055;45609;46257.537424625996;46375.44935028538;42467.15065698669;42521.57478425238;42730.57269427266;42824.57175428268;43024.56975430206;7423.463820162161;7662.777794439773;7711.26742959418;7721.884171737316;7762.340201082971;32521.34957300888;33424;34542.65457345495;34704.479432808024;37806.62193378141;40473.595264046984;41342.58657413387;41521;42109;43247.78376108225;11115.277506962022;11439.485223164811;11644.53421863116;11809.763804723685;12128.75742485163;12170.75658486843;12315.322657253937;12361.876381236432;12573.371331433575;12652.430640621378;10994.34033957933;11069.667909962714;11182.217244792786;11221.495032723711;11245.381504017358;11592;11713.824292635787;12003;12314.81527777102;12525.874741252472;11486.36824974601;11691.590794322497;11812.82280765772;11868.82196767032;12151.878481215075;9984.850227246452;10133.594656213669;10479.738006549896;10615.787684246427;10632.52153653072;10047.196224302184;10086.193104551472;10194.43930583825;10209.285350025428;10219.233557483367 23:10:28 INFO - PROCESS | 20387 | __end_tp_report 23:10:28 INFO - PROCESS | 20387 | __start_cc_report 23:10:28 INFO - PROCESS | 20387 | _x_x_mozilla_cycle_collect,355 23:10:28 INFO - PROCESS | 20387 | __end_cc_report 23:10:28 INFO - PROCESS | 20387 | __startTimestamp1458454228359__endTimestamp 23:10:28 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | ------- Summary: start ------- 23:10:28 INFO - PROCESS | 20387 | Number of tests: 6 23:10:28 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | [#0] dojo.html Cycles:165 Average:4772.03 Median:4892.19 stddev:495.51 (10.1%) stddev-sans-first:468.04 23:10:28 INFO - PROCESS | 20387 | Values: 2643.3 2704.7 2715.5 2721.8 2741.6 4742.0 4757.4 4801.7 4805.2 4844.4 4650.3 4804.2 4827.2 4886.7 4914.8 4370.3 4404.7 4466.3 4492.2 4565.0 4388.1 4408.9 4439.4 4446.7 4503.3 4369.8 4430.4 4449.8 4458.0 4490.0 4418.1 4422.0 4422.4 4446.4 4497.2 4320.6 4383.1 4411.3 4414.0 4445.8 4725.0 4727.8 4758.8 4769.2 4785.6 5105.9 5145.1 5148.9 5151.9 5207.2 5037.7 5124.6 5206.0 5208.0 5257.8 4831.0 4854.8 4861.9 4896.3 4901.2 5276.6 5278.3 5301.2 5323.4 5332.7 4978.9 5122.8 5123.4 5145.3 5197.5 4987.1 5139.5 5141.3 5211.2 5223.5 5128.1 5137.8 5139.2 5161.0 5216.2 4984.4 5062.4 5124.7 5131.6 5210.2 4415.1 4421.8 4429.4 4456.6 4463.5 3836.9 3850.9 3874.3 3875.1 3915.6 4257.2 4461.1 4480.6 4509.8 4543.1 5173.6 5182.4 5191.6 5204.4 5235.1 4465.0 4467.4 4486.5 4494.8 4514.2 4543.0 4659.3 4700.2 4712.6 4740.4 4859.7 4861.8 4869.8 4877.6 4939.6 4992.7 5210.2 5211.9 5222.5 5264.7 4820.7 4832.6 4851.5 4884.0 4892.2 5133.6 5158.2 5171.0 5171.9 5219.0 5100.4 5137.4 5207.3 5211.8 5222.0 4873.6 4944.2 4970.3 5036.1 5124.2 4967.1 4969.9 4973.2 4983.3 5055.8 4904.9 4931.9 4938.6 4949.4 4953.9 4855.4 4982.7 5031.9 5059.6 5065.0 4897.5 4932.0 4945.4 4959.9 4986.7 23:10:28 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | [#1] ext.html Cycles:180 Average:41449.27 Median:35438.06 stddev:68284.49 (192.7%) stddev-sans-first:68406.88 23:10:28 INFO - PROCESS | 20387 | Values: 514.3 528.1 528.7 549.0 572.1 35976.6 36569.9 36814.6 36863.4 36927.8 37724.4 38345.4 38392.8 38418.6 38476.2 7583.6 7753.8 7796.1 7824.1 7830.4 7648.2 7759.9 7776.9 7794.4 7862.0 7798.2 7815.4 7890.1 7943.3 7956.4 7827.6 7854.7 7856.4 7858.4 7889.0 7800.0 7851.9 7875.6 7897.1 7927.4 34420.0 34806.3 34835.7 34894.1 34974.5 3317.2 3430.3 3591.9 3730.3 3745.0 27970.7 28524.7 28849.0 28877.4 29406.6 3243.3 3255.7 3290.6 3300.8 3341.1 227004.0 228833.0 229713.0 230567.0 231000.0 42550.0 43399.1 48434.8 48666.8 49312.3 40521.8 40700.8 40780.0 40931.0 40995.6 12301.4 12319.9 12425.8 12497.9 12515.6 9472.7 9639.1 9642.9 9647.4 9695.8 14025.5 14314.3 14472.9 14634.8 14646.5 5973.5 6023.0 6078.3 6111.9 6143.0 818.7 969.4 971.7 984.4 1048.4 26509.0 26835.2 26938.8 27386.5 27434.2 945.4 1001.8 1011.0 1036.4 1063.5 13884.3 14078.9 14162.4 14564.0 14634.4 279642.0 283584.0 284532.0 285199.0 287810.0 43700.8 43712.3 43973.8 44062.5 44639.8 1189.5 1194.2 1229.0 1237.1 1237.6 25879.7 26250.6 26295.7 26385.9 26699.0 37784.2 38093.0 38140.4 38200.2 38243.6 265404.0 267250.0 268676.0 270972.0 271179.0 30921.2 32146.2 32368.4 32473.5 32594.0 40904.4 47323.3 49068.8 49132.3 49167.3 34658.5 35073.0 35646.8 35783.0 35816.0 34436.0 34818.3 34915.8 35187.8 35229.3 34872.7 35153.3 36954.4 38145.8 38171.6 29017.3 31101.4 31650.2 31911.5 31951.7 24787.3 24930.4 24951.8 25090.0 25171.6 23:10:28 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | [#2] jquery.html Cycles:180 Average:21360.01 Median:4912.57 stddev:56875.51 (1157.8%) stddev-sans-first:57013.18 23:10:28 INFO - PROCESS | 20387 | Values: 348.2 353.3 354.3 363.7 364.8 15485.1 15829.4 16143.4 16505.3 16568.7 15577.9 15774.3 15825.4 15914.4 15936.7 4877.3 4899.4 5063.3 5100.1 5116.9 4514.6 5029.3 5072.8 5079.9 5094.1 5025.3 5055.0 5056.5 5056.6 5064.7 4866.3 5074.5 5083.5 5087.3 5107.9 4899.5 4909.1 4916.1 4973.4 5326.3 11708.4 11787.2 11815.9 11905.6 11918.5 1938.8 2211.8 2427.0 2484.8 2501.3 8904.8 9077.7 9285.5 9412.8 9495.2 1734.7 1817.3 1819.6 1837.8 1859.0 39063.8 42798.6 57225.4 57990.4 61873.0 9858.4 10130.3 10226.3 10316.1 10754.2 13326.2 13393.7 13400.4 13416.8 13454.9 6408.2 6545.4 6589.6 6620.2 6653.9 5919.3 5951.6 6019.1 6030.5 6037.8 4434.8 4491.7 4510.0 4510.8 4556.9 1822.8 1837.7 1869.2 1872.4 1874.3 916.7 919.9 939.8 948.1 956.3 16042.2 16109.4 16427.2 16601.8 16704.2 892.8 897.9 913.2 949.0 950.2 9111.4 9397.6 9569.6 9617.5 9773.1 302180.0 307724.0 308129.0 397882.0 400444.0 50507.7 52765.2 66729.0 70739.6 71685.3 963.6 973.8 997.2 999.1 1006.1 14752.6 14784.8 15290.5 15293.2 15595.5 32288.8 32310.5 32349.7 32430.7 32619.8 42206.2 45396.0 46179.0 46197.6 46329.8 7481.5 7482.0 7555.7 7591.2 7622.0 10093.1 10862.6 10880.9 11265.6 11339.8 9488.3 9695.7 9825.6 10038.9 10232.8 9351.5 9473.3 9593.6 9793.7 9818.5 9328.3 9750.5 9808.2 9862.0 10129.2 7524.9 7567.2 7615.1 7641.0 7730.3 8681.6 9584.3 9620.6 9774.6 9886.7 23:10:28 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | [#3] mootools.html Cycles:180 Average:4893.02 Median:5932.44 stddev:2484.97 (41.9%) stddev-sans-first:2477.95 23:10:28 INFO - PROCESS | 20387 | Values: 1385.0 1392.1 1496.3 1687.0 1710.7 5837.0 6700.2 6744.0 6932.5 6965.1 6855.8 6897.6 6945.3 6959.2 6979.9 2118.5 2127.8 2144.7 2153.7 2155.0 2064.2 2074.3 2180.0 2180.8 2182.8 2172.2 2177.3 2184.1 2201.3 2215.9 2189.8 2199.0 2199.3 2199.4 2202.3 2084.6 2108.3 2113.3 2123.9 2126.9 7025.4 7065.8 7069.9 7071.4 7074.8 4219.7 4301.7 4332.7 4335.4 4348.7 2824.3 2873.9 2917.8 2928.3 2932.4 885.6 899.3 901.4 907.9 926.2 9230.1 9239.1 9247.4 9272.3 9277.9 3833.6 3952.5 3955.0 3998.0 4010.6 7973.7 8010.4 8016.9 8020.9 8047.2 4235.5 4242.9 4247.3 4268.9 4270.2 3354.6 3748.2 3789.1 3821.8 3840.0 3451.9 3465.8 3526.4 3527.6 3537.6 1123.7 1134.1 1145.9 1147.8 1153.5 1020.0 1025.2 1039.6 1127.5 1237.3 6575.6 6616.6 6658.5 6659.6 6681.8 434.4 453.9 455.7 456.0 456.5 5204.0 5204.1 5233.9 5247.8 5253.8 8134.7 8388.7 8416.5 8428.5 8460.4 8188.8 8248.4 8284.5 8289.4 8301.3 6302.2 6430.5 6432.3 6487.5 6505.1 6519.4 6625.3 6632.7 6674.3 6702.3 7255.6 7507.8 7531.4 7579.9 7659.3 7482.6 7636.4 7734.4 7773.9 7789.5 5295.4 5971.6 6128.5 6180.7 6348.1 6694.6 6702.7 6708.4 6717.7 6734.3 6069.7 6216.4 6234.4 6238.4 6307.7 5915.1 6047.3 6056.2 6058.8 6128.1 6315.0 6316.8 6330.4 6361.8 6363.4 5761.6 5801.5 5805.1 5808.3 5826.2 5818.4 5895.2 5922.8 5942.1 5947.7 23:10:28 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | [#4] prototype.html Cycles:180 Average:4937.22 Median:5695.00 stddev:1499.17 (26.3%) stddev-sans-first:1462.41 23:10:28 INFO - PROCESS | 20387 | Values: 299.7 300.7 308.5 311.2 312.4 5606.8 5688.5 5696.5 5790.1 5806.2 5647.9 5673.5 5693.5 5697.2 5745.1 4060.0 4168.1 4209.4 4299.5 4309.5 4264.9 4267.0 4282.1 4283.6 4289.9 4217.0 4224.5 4228.2 4233.0 4239.6 4232.2 4234.4 4237.8 4242.6 4247.8 3634.1 3651.0 3660.2 3663.5 3675.7 5395.1 5400.5 5403.9 5404.1 5408.6 4759.5 4883.3 4885.2 4889.1 4912.7 5955.1 5963.0 5969.8 5972.6 5987.1 4062.7 4067.8 4069.8 4076.0 4081.1 6263.6 6332.1 6340.6 6348.7 6364.3 4161.3 4166.8 4168.0 4171.7 4172.8 4181.4 4205.2 4206.7 4213.2 4218.7 4782.6 4908.9 4911.5 4913.2 4929.0 5973.2 5992.0 5994.6 6009.2 6012.6 1484.5 1496.2 1497.1 1497.9 1498.8 967.8 968.9 988.9 992.8 1011.5 5214.3 5245.2 5248.2 5250.5 5251.7 6242.4 6263.7 6267.5 6274.3 6281.5 5071.8 5226.5 5231.2 5238.4 5238.8 3322.8 3386.9 3390.7 3398.4 3403.4 5818.5 5834.4 5840.7 5851.4 5864.6 6423.2 6433.0 6452.8 6472.4 6476.1 5787.1 5812.7 5839.0 5854.9 5856.7 6093.4 6281.8 6300.4 6316.1 6319.0 6160.7 6166.2 6166.9 6172.4 6182.2 5839.6 5840.6 5849.7 5853.0 5869.9 4206.8 4209.3 4209.6 4210.4 4221.6 6282.7 6283.5 6293.2 6293.8 6300.6 5820.9 6055.5 6078.2 6090.1 6099.2 6088.4 6101.1 6114.5 6143.4 6143.7 5798.4 5841.1 5889.3 5904.5 5921.6 6052.0 6093.3 6099.8 6119.8 6121.1 5806.7 5918.9 5937.6 5971.6 5972.1 23:10:28 INFO - PROCESS | 20387 | 23:10:28 INFO - PROCESS | 20387 | [#5] yui.html Cycles:180 Average:13022.11 Median:41431.79 stddev:14480.31 (34.9%) stddev-sans-first:14491.19 23:10:28 INFO - PROCESS | 20387 | Values: 664.2 698.1 707.5 723.3 745.4 10867.9 10893.5 10895.4 11023.3 11287.8 12152.9 12319.3 12347.4 12351.0 12404.6 641.1 801.7 810.1 814.0 814.5 780.5 794.1 801.9 802.9 805.8 846.5 850.0 854.2 854.7 858.1 837.1 842.6 845.3 845.4 847.7 609.8 614.2 615.7 616.4 618.3 13419.7 13452.3 13486.5 13491.0 13533.3 12257.9 12372.4 12542.5 12706.5 12845.5 10013.9 10201.9 10240.1 10363.6 10544.9 3242.9 3283.0 3295.3 3314.8 3400.0 44449.3 44726.8 45180.5 45449.8 45752.8 9583.0 9613.3 9630.8 9686.2 9747.7 17142.3 17145.2 17154.6 17163.4 17185.4 6697.3 6894.5 6898.1 6933.8 6982.6 3643.7 3688.1 3722.7 3738.9 3751.2 2953.9 2963.0 2970.5 2988.0 2996.2 526.0 532.0 541.3 544.7 556.3 609.0 613.5 635.4 638.6 641.3 8205.7 8535.8 8598.9 8611.8 8645.8 577.5 595.4 617.0 618.0 620.0 3684.5 3804.4 3853.8 3873.4 3981.6 48840.0 49871.5 49999.3 50294.0 50350.5 44380.0 45163.1 45609.0 46257.5 46375.4 42467.2 42521.6 42730.6 42824.6 43024.6 7423.5 7662.8 7711.3 7721.9 7762.3 32521.3 33424.0 34542.7 34704.5 37806.6 40473.6 41342.6 41521.0 42109.0 43247.8 11115.3 11439.5 11644.5 11809.8 12128.8 12170.8 12315.3 12361.9 12573.4 12652.4 10994.3 11069.7 11182.2 11221.5 11245.4 11592.0 11713.8 12003.0 12314.8 12525.9 11486.4 11691.6 11812.8 11868.8 12151.9 9984.9 10133.6 10479.7 10615.8 10632.5 10047.2 10086.2 10194.4 10209.3 10219.2 23:10:28 INFO - PROCESS | 20387 | -------- Summary: end -------- 23:10:28 INFO - PROCESS | 20387 | 23:10:29 INFO - TEST-INFO | 20387: exit 0 23:10:29 INFO - TEST-OK | dromaeo_css | took 1114895ms 23:10:29 INFO - TEST-START | kraken 23:10:29 INFO - operating with platform_type : linux_ 23:10:29 INFO - Initialising browser for kraken test... 23:10:29 INFO - TEST-INFO | started process 20621 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKU8AuT/profile http://localhost:42465/getInfo.html) 23:10:32 INFO - PROCESS | 20621 | 23:10:32 INFO - PROCESS | 20621 | (process:20691): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 23:10:33 INFO - PROCESS | 20621 | 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] 23:10:33 INFO - PROCESS | 20621 | __metrics Screen width/height:1600/1200 23:10:33 INFO - PROCESS | 20621 | colorDepth:24 23:10:33 INFO - PROCESS | 20621 | Browser inner width/height: 1024/697 23:10:33 INFO - PROCESS | 20621 | __metrics 23:10:34 ERROR - PROCESS | 20621 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2864: TypeError: this.tabs is undefined 23:10:35 INFO - TEST-INFO | 20621: exit 0 23:10:35 INFO - Browser initialized. 23:10:35 INFO - Running cycle 1/1 for kraken test... 23:10:35 INFO - TEST-INFO | started process 20742 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKU8AuT/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 23:10:37 INFO - PROCESS | 20742 | 23:10:37 INFO - PROCESS | 20742 | (process:20802): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 23:10:47 INFO - PROCESS | 20742 | RSS: Main: 167514112 23:10:47 INFO - PROCESS | 20742 | 23:10:49 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42465/tests/kraken/driver.html?testName=audio-beat-detection) 23:10:50 INFO - PROCESS | 20742 | RSS: Main: 172797952 23:10:50 INFO - PROCESS | 20742 | 23:10:53 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42465/tests/kraken/driver.html?testName=audio-dft) 23:10:53 INFO - PROCESS | 20742 | RSS: Main: 175177728 23:10:53 INFO - PROCESS | 20742 | 23:10:56 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42465/tests/kraken/driver.html?testName=audio-fft) 23:10:57 INFO - PROCESS | 20742 | RSS: Main: 167915520 23:10:57 INFO - PROCESS | 20742 | 23:10:59 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42465/tests/kraken/driver.html?testName=audio-oscillator) 23:11:00 INFO - PROCESS | 20742 | RSS: Main: 167919616 23:11:00 INFO - PROCESS | 20742 | 23:11:02 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42465/tests/kraken/driver.html?testName=imaging-gaussian-blur) 23:11:02 INFO - PROCESS | 20742 | RSS: Main: 168337408 23:11:02 INFO - PROCESS | 20742 | 23:11:06 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42465/tests/kraken/driver.html?testName=imaging-darkroom) 23:11:06 INFO - PROCESS | 20742 | RSS: Main: 169316352 23:11:06 INFO - PROCESS | 20742 | 23:11:10 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42465/tests/kraken/driver.html?testName=imaging-desaturate) 23:11:10 INFO - PROCESS | 20742 | RSS: Main: 169037824 23:11:10 INFO - PROCESS | 20742 | 23:11:13 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42465/tests/kraken/driver.html?testName=json-parse-financial) 23:11:14 INFO - PROCESS | 20742 | RSS: Main: 170250240 23:11:14 INFO - PROCESS | 20742 | 23:11:16 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42465/tests/kraken/driver.html?testName=json-stringify-tinderbox) 23:11:16 INFO - PROCESS | 20742 | RSS: Main: 169533440 23:11:16 INFO - PROCESS | 20742 | 23:11:18 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42465/tests/kraken/driver.html?testName=stanford-crypto-aes) 23:11:19 INFO - PROCESS | 20742 | RSS: Main: 169664512 23:11:19 INFO - PROCESS | 20742 | 23:11:21 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42465/tests/kraken/driver.html?testName=stanford-crypto-ccm) 23:11:21 INFO - PROCESS | 20742 | RSS: Main: 169095168 23:11:21 INFO - PROCESS | 20742 | 23:11:24 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42465/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 23:11:25 INFO - PROCESS | 20742 | RSS: Main: 170434560 23:11:25 INFO - PROCESS | 20742 | 23:11:27 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42465/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 23:11:28 INFO - PROCESS | 20742 | RSS: Main: 168828928 23:11:28 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | Cycle 1(1): loaded http://localhost:42465/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42465/tests/kraken/driver.html?testName=ai-astar) 23:11:30 INFO - PROCESS | 20742 | RSS: Main: 170672128 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | __start_tp_report 23:11:30 INFO - PROCESS | 20742 | _x_x_mozilla_page_load 23:11:30 INFO - PROCESS | 20742 | _x_x_mozilla_page_load_details 23:11:30 INFO - PROCESS | 20742 | |i|pagename|runs| 23:11:30 INFO - PROCESS | 20742 | |0;ai-astar;115;108;114;116;115;127;113;113;112;113 23:11:30 INFO - PROCESS | 20742 | |1;audio-beat-detection;152;129;157;174;130;156;154;133;174;130 23:11:30 INFO - PROCESS | 20742 | |2;audio-dft;164;163;163;164;163;167;169;164;164;161 23:11:30 INFO - PROCESS | 20742 | |3;audio-fft;75;74;74;78;77;75;73;74;134;73 23:11:30 INFO - PROCESS | 20742 | |4;audio-oscillator;101;94;140;94;94;94;142;93;94;131 23:11:30 INFO - PROCESS | 20742 | |5;imaging-gaussian-blur;120;119;118;117;118;117;117;117;118;118 23:11:30 INFO - PROCESS | 20742 | |6;imaging-darkroom;147;147;147;147;146;148;149;147;146;148 23:11:30 INFO - PROCESS | 20742 | |7;imaging-desaturate;97;97;97;96;96;96;97;96;96;96 23:11:30 INFO - PROCESS | 20742 | |8;json-parse-financial;71;71;69;71;70;70;69;70;68;67 23:11:30 INFO - PROCESS | 20742 | |9;json-stringify-tinderbox;64;64;65;65;65;70;64;64;64;64 23:11:30 INFO - PROCESS | 20742 | |10;stanford-crypto-aes;81;91;82;92;82;82;85;89;83;81 23:11:30 INFO - PROCESS | 20742 | |11;stanford-crypto-ccm;128;116;120;122;120;133;118;130;122;128 23:11:30 INFO - PROCESS | 20742 | |12;stanford-crypto-pbkdf2;132;150;139;143;155;143;141;152;145;132 23:11:30 INFO - PROCESS | 20742 | |13;stanford-crypto-sha256-iterative;69;68;69;68;67;70;67;66;66;67 23:11:30 INFO - PROCESS | 20742 | __end_tp_report 23:11:30 INFO - PROCESS | 20742 | __start_cc_report 23:11:30 INFO - PROCESS | 20742 | _x_x_mozilla_cycle_collect,913 23:11:30 INFO - PROCESS | 20742 | __end_cc_report 23:11:30 INFO - PROCESS | 20742 | __startTimestamp1458454290367__endTimestamp 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | ------- Summary: start ------- 23:11:30 INFO - PROCESS | 20742 | Number of tests: 14 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#0] ai-astar Cycles:10 Average:114.60 Median:114.50 stddev:4.88 (4.3%) stddev-sans-first:5.17 23:11:30 INFO - PROCESS | 20742 | Values: 115.0 108.0 114.0 116.0 115.0 127.0 113.0 113.0 112.0 113.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#1] audio-beat-detection Cycles:10 Average:148.90 Median:155.00 stddev:17.56 (11.3%) stddev-sans-first:18.59 23:11:30 INFO - PROCESS | 20742 | Values: 152.0 129.0 157.0 174.0 130.0 156.0 154.0 133.0 174.0 130.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#2] audio-dft Cycles:10 Average:164.20 Median:164.00 stddev:2.25 (1.4%) stddev-sans-first:2.39 23:11:30 INFO - PROCESS | 20742 | Values: 164.0 163.0 163.0 164.0 163.0 167.0 169.0 164.0 164.0 161.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#3] audio-fft Cycles:10 Average:80.70 Median:74.50 stddev:18.80 (25.2%) stddev-sans-first:19.82 23:11:30 INFO - PROCESS | 20742 | Values: 75.0 74.0 74.0 78.0 77.0 75.0 73.0 74.0 134.0 73.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#4] audio-oscillator Cycles:10 Average:107.70 Median:94.00 stddev:20.98 (22.3%) stddev-sans-first:22.11 23:11:30 INFO - PROCESS | 20742 | Values: 101.0 94.0 140.0 94.0 94.0 94.0 142.0 93.0 94.0 131.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#5] imaging-gaussian-blur Cycles:10 Average:117.90 Median:118.00 stddev:0.99 (0.8%) stddev-sans-first:0.71 23:11:30 INFO - PROCESS | 20742 | Values: 120.0 119.0 118.0 117.0 118.0 117.0 117.0 117.0 118.0 118.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#6] imaging-darkroom Cycles:10 Average:147.20 Median:147.00 stddev:0.92 (0.6%) stddev-sans-first:0.97 23:11:30 INFO - PROCESS | 20742 | Values: 147.0 147.0 147.0 147.0 146.0 148.0 149.0 147.0 146.0 148.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.50 stddev:0.52 (0.5%) stddev-sans-first:0.50 23:11:30 INFO - PROCESS | 20742 | Values: 97.0 97.0 97.0 96.0 96.0 96.0 97.0 96.0 96.0 96.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#8] json-parse-financial Cycles:10 Average:69.60 Median:70.00 stddev:1.35 (1.9%) stddev-sans-first:1.33 23:11:30 INFO - PROCESS | 20742 | Values: 71.0 71.0 69.0 71.0 70.0 70.0 69.0 70.0 68.0 67.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#9] json-stringify-tinderbox Cycles:10 Average:64.90 Median:64.50 stddev:1.85 (2.9%) stddev-sans-first:1.94 23:11:30 INFO - PROCESS | 20742 | Values: 64.0 64.0 65.0 65.0 65.0 70.0 64.0 64.0 64.0 64.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#10] stanford-crypto-aes Cycles:10 Average:84.80 Median:84.00 stddev:4.26 (5.1%) stddev-sans-first:4.29 23:11:30 INFO - PROCESS | 20742 | Values: 81.0 91.0 82.0 92.0 82.0 82.0 85.0 89.0 83.0 81.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#11] stanford-crypto-ccm Cycles:10 Average:123.70 Median:125.00 stddev:5.66 (4.5%) stddev-sans-first:5.78 23:11:30 INFO - PROCESS | 20742 | Values: 128.0 116.0 120.0 122.0 120.0 133.0 118.0 130.0 122.0 128.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.20 Median:144.00 stddev:7.74 (5.4%) stddev-sans-first:7.07 23:11:30 INFO - PROCESS | 20742 | Values: 132.0 150.0 139.0 143.0 155.0 143.0 141.0 152.0 145.0 132.0 23:11:30 INFO - PROCESS | 20742 | 23:11:30 INFO - PROCESS | 20742 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.70 Median:68.00 stddev:1.34 (2.0%) stddev-sans-first:1.33 23:11:30 INFO - PROCESS | 20742 | Values: 69.0 68.0 69.0 68.0 67.0 70.0 67.0 66.0 66.0 67.0 23:11:30 INFO - PROCESS | 20742 | -------- Summary: end -------- 23:11:30 INFO - PROCESS | 20742 | 23:11:31 INFO - TEST-INFO | 20742: exit 0 23:11:31 INFO - TEST-OK | kraken | took 62277ms 23:11:31 INFO - SUITE-END | took 1177s 23:11:31 INFO - Completed test suite (00:19:37) 23:11:31 INFO - javascript benchmark 23:11:31 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2643.2598872315752, 2704.7430494103064, 2715.511207982562, 2721.7958653100995, 2741.56135018397, 4741.952580474199, 4757.381540399748, 4801.717038109268, 4805.231163013918, 4844.394450693663, 4650.279206722963, 4804.159272127373, 4827.227643577028, 4886.657933944625, 4914.803407863681, 4370.3007518797, 4404.735715857043, 4466.3300504924355, 4492.168948744476, 4565.041341318327, 4388.056567837914, 4408.933865992013, 4439.356293337464, 4446.71096378736, 4503.279475283955, 4369.847055353063, 4430.446194225722, 4449.822007119744, 4457.977710111461, 4490.034642551867, 4418.050119224382, 4422.027154026109, 4422.447194100738, 4446.421965144543, 4497.168023915586, 4320.567943205686, 4383.123375324948, 4411.338299255105, 4413.962718761089, 4445.777711114463, 4724.976375118137, 4727.763611819395, 4758.78585463655, 4769.213079841822, 4785.617150627942, 5105.872353191163, 5145.099607568661, 5148.922766158511, 5151.896962060738, 5207.1668533034535, 5037.722925239111, 5124.564412024983, 5205.973970130163, 5208.036513245024, 5257.7896884124975, 4831.0096430231715, 4854.805807767721, 4861.927071093901, 4896.265560165933, 4901.2158054711435, 5276.604254680914, 5278.340207474066, 5301.1783173608155, 5323.387810401776, 5332.68003919766, 4978.900421991612, 5122.820701275437, 5123.436421993578, 5145.253938178943, 5197.506236907563, 4987.102321582078, 5139.511746384088, 5141.331626888481, 5211.166213405837, 5223.4776522347465, 5128.051310507568, 5137.845864624067, 5139.177731562932, 5161.045206636784, 5216.243644671501, 4984.40187177541, 5062.417821950523, 5124.718140502234, 5131.640785145004, 5210.218467229945, 4415.09490554442, 4421.845235416745, 4429.357743127229, 4456.554344565518, 4463.509014008457, 3836.9040773980314, 3850.9037274068373, 3874.2832575973534, 3875.0699832040673, 3915.5888631693833, 4257.1698518788535, 4461.107778444324, 4480.596746292849, 4509.751963641966, 4543.068670922453, 5173.586113111018, 5182.378114626269, 5191.558717509054, 5204.42751297357, 5235.136202526541, 4465.040016396425, 4467.441569803775, 4486.461624605068, 4494.775261236925, 4514.164879497303, 4543.0, 4659.277811939087, 4700.2009658358165, 4712.575868171881, 4740.431148262231, 4859.684120532154, 4861.80552777892, 4869.829555965524, 4877.609791216623, 4939.629527785431, 4992.700437973734, 5210.1663733803925, 5211.869703257297, 5222.529972302511, 5264.684118952875, 4820.662553621213, 4832.63755218353, 4851.514848515261, 4883.975580122076, 4892.192788189909, 5133.563647090039, 5158.226266060121, 5171.0, 5171.9482805171465, 5219.0, 5100.38795344561, 5137.434882163034, 5207.270982062439, 5211.843644690665, 5222.0, 4873.634477414137, 4944.15949288629, 4970.3290055842, 5036.093503169464, 5124.231365295235, 4967.130752118437, 4969.900601987868, 4973.179425394769, 4983.327250821093, 5055.848324550269, 4904.926426103682, 4931.876703082452, 4938.604911606991, 4949.381327334083, 4953.876153096201, 4855.441624213261, 4982.6512144149565, 5031.874203144951, 5059.645824792229, 5065.0, 4897.461279259207, 4931.950680493149, 4945.381827271591, 4959.876003099951, 4986.7257300848805], "unit": "score", "name": "dojo.html", "value": 4740.801290178585}, {"lowerIsBetter": false, "replicates": [514.3339375508716, 528.1154066937878, 528.6669398279083, 548.9788992473998, 572.081808697041, 35976.64023359765, 36569.90290291289, 36814.63185368146, 36863.44704829423, 36927.815360923225, 37724.43413348802, 38345.424818627675, 38392.80803595978, 38418.615813841854, 38476.230475390475, 7583.620818959043, 7753.767386978399, 7796.064472263308, 7824.100228473713, 7830.412719046066, 7648.196939321375, 7759.88360174595, 7776.911232427465, 7794.3764498839955, 7862.0, 7798.2201779822135, 7815.374770018385, 7890.0531936167745, 7943.324817390529, 7956.403269754763, 7827.6477558510005, 7854.685812567547, 7856.371490280764, 7858.371330293563, 7888.9605551972445, 7800.0, 7851.900733897259, 7875.566843823587, 7897.131315555284, 7927.3658107351275, 34420.0, 34806.30387392238, 34835.65164348375, 34894.12764680878, 34974.47538286928, 3317.2204531934976, 3430.262493563871, 3591.892243232707, 3730.291244663505, 3744.9888530096996, 27970.720292797014, 28524.714752852415, 28849.0, 28877.42245155085, 29406.558901616492, 3243.2864769750618, 3255.7395408367274, 3290.555774970372, 3300.8349582520777, 3341.1313058604696, 227004.0, 228833.0, 229713.0, 230567.0, 231000.0, 42550.0, 43399.132017360105, 48434.75782621064, 48666.75666621715, 49312.260316095286, 40521.79739101286, 40700.796496017334, 40780.0, 40931.0, 40995.59004409977, 12301.446434910451, 12319.876801231872, 12425.813612795815, 12497.875021249853, 12515.624531264077, 9472.715818525456, 9639.084286992866, 9642.903570964341, 9647.372920760128, 9695.836499619949, 14025.509107181404, 14314.284285785669, 14472.927635361966, 14634.780478292834, 14646.487372941896, 5973.462388385066, 6022.969885150634, 6078.331383547807, 6111.877762444727, 6142.969285153546, 818.7257268814894, 969.4425705219527, 971.6599190283345, 984.4487087231173, 1048.4024106259512, 26509.0, 26835.194944151706, 26938.812165721945, 27386.45227095447, 27434.176974690792, 945.385499425379, 1001.8397056471075, 1010.9646162384429, 1036.362636978253, 1063.5426766490484, 13884.305784710725, 14078.859211407755, 14162.36269367881, 14564.0, 14634.414623414945, 279642.0, 283584.0, 284532.0, 285199.0, 287810.0, 43700.78149609295, 43712.3443148353, 43973.78013109914, 44062.457813976354, 44639.77680111644, 1189.4706855449242, 1194.2416565480808, 1228.969275768113, 1237.07219585311, 1237.5977807212512, 25879.741202588488, 26250.606240906785, 26295.737042630095, 26385.868070659522, 26699.0, 37784.24431511409, 38093.0, 38140.42789358217, 38200.2359952805, 38243.617563825115, 265404.0, 267250.0, 268676.0, 270972.0, 271179.0, 30921.226969325948, 32146.19634509156, 32368.35263294768, 32473.512897306086, 32594.0, 40904.38643420291, 47323.29015064708, 49068.75465622649, 49132.263016055505, 49167.26249106195, 34658.48012279868, 35073.0, 35646.82176589101, 35783.0, 35816.0, 34436.0, 34818.30363392668, 34915.82542087273, 35187.82406087953, 35229.295414092085, 34872.65127348694, 35153.296934060665, 36954.44568331531, 38145.80927095347, 38171.61828381681, 29017.274568135967, 31101.377972439972, 31650.208744781565, 31911.521327179646, 31951.6804831958, 24787.25638230856, 24930.37674058163, 24951.75048249567, 25090.0, 25171.622425663994], "unit": "score", "name": "ext.html", "value": 16665.225228812185}, {"lowerIsBetter": false, "replicates": [348.22867348822354, 353.3145697347146, 354.26313268401725, 363.7308391790076, 364.8267073140257, 15485.070895746263, 15829.366825326988, 16143.354265829368, 16505.33978640856, 16568.668626627492, 15577.922110389432, 15774.290156942936, 15825.366985320574, 15914.363425462996, 15936.681266374666, 4877.26840973855, 4899.43656479505, 5063.291139240509, 5100.056489549426, 5116.8976620467565, 4514.638828893697, 5029.346184995946, 5072.847814565569, 5079.923801142986, 5094.0830650483085, 5025.296458495814, 5055.0, 5056.469070747574, 5056.570191533724, 5064.721440320799, 4866.294387313837, 5074.492550744914, 5083.491650834924, 5087.313212716292, 5107.923381149286, 4899.461059283476, 4909.0672772173175, 4916.06594746997, 4973.378327709036, 5326.307580014612, 11708.356040417773, 11787.17489775716, 11815.88184118165, 11905.642830715093, 11918.523259069627, 1938.7964263752244, 2211.756706762255, 2427.0, 2484.8260621756485, 2501.2746303571944, 8904.777380565472, 9077.727668169966, 9285.53572321388, 9412.811743765087, 9495.240380769523, 1734.6617409605133, 1817.318505560415, 1819.5996880686228, 1837.8345948864533, 1859.0425930645729, 39063.8046809767, 42798.57201428008, 57225.42774572242, 57990.420095799345, 61873.0, 9858.40849549015, 10130.341527800669, 10226.335288206243, 10316.123129533924, 10754.171790795583, 13326.20042797416, 13393.73212535744, 13400.396982135828, 13416.798748018788, 13454.93272533631, 6408.198975128109, 6545.37818907203, 6589.571677841021, 6620.205575330991, 6653.866922661519, 5919.3192782829665, 5951.553633477506, 6019.127226552213, 6030.547708921848, 6037.818865434044, 4434.84478043267, 4491.685582009293, 4509.977450112729, 4510.819567217341, 4556.863294101182, 1822.82683145101, 1837.6784062788959, 1869.2336142181641, 1872.419549939523, 1874.3158747057225, 916.6837441082815, 919.8988111307751, 939.8402271613842, 948.0803620488116, 956.297121615612, 16042.197890105448, 16109.355625775072, 16427.178641067898, 16601.750973735405, 16704.248308826132, 892.7991201979632, 897.9146981036791, 913.2328843771264, 949.0414681172066, 950.1733491861986, 9111.362204645611, 9397.624095036259, 9569.569369378394, 9617.51912404377, 9773.120419162167, 302180.0, 307724.0, 308129.0, 397882.0, 400444.0, 50507.74746126246, 52765.208521872206, 66729.0, 70739.64630176817, 71685.2831471689, 963.6386355116831, 973.7711637765119, 997.1823105053786, 999.0758548342753, 1006.0995409108807, 14752.63118422048, 14784.778228326799, 15290.541283761506, 15293.164820221644, 15595.532134035997, 32288.83855580707, 32310.515342269413, 32349.67650323561, 32430.675693242767, 32619.836900815342, 42206.155876882905, 45396.0, 46179.0, 46197.64172380905, 46329.768351158025, 7481.476296659399, 7481.962590187014, 7555.6977720890545, 7591.240875912365, 7622.0, 10093.14208292274, 10862.565497380332, 10880.945595271973, 11265.605703800327, 11339.829902551302, 9488.288378371511, 9695.66065187715, 9825.557849896915, 10038.949805250926, 10232.846507302247, 9351.48566828831, 9473.336866419284, 9593.616255349707, 9793.706188814347, 9818.509074546102, 9328.347015708836, 9750.463724495221, 9808.16630586408, 9861.950690246504, 10129.240306976859, 7524.887126693214, 7567.243275672388, 7615.086189657055, 7641.044869391326, 7730.342920851565, 8681.609327580149, 9584.28117891147, 9620.567074481525, 9774.560144793359, 9886.703398898044], "unit": "score", "name": "jquery.html", "value": 7758.627024741029}, {"lowerIsBetter": false, "replicates": [1384.9515266965657, 1392.081226390582, 1496.3042185383795, 1686.9662606747872, 1710.7433884917268, 5837.007708689523, 6700.229473610536, 6744.0, 6932.514723969318, 6965.094537710097, 6855.760048398307, 6897.551659142152, 6945.305469453052, 6959.234484206733, 6979.89530157048, 2118.523332250239, 2127.7659457459704, 2144.731908511436, 2153.6984822124914, 2155.041006751996, 2064.194963964055, 2074.3258441006656, 2180.0, 2180.8473406861526, 2182.8362872784523, 2172.228858755143, 2177.314146043999, 2184.137265780016, 2201.2625770366944, 2215.9113635454564, 2189.79196976287, 2199.0434161139956, 2199.25225423356, 2199.3621849663577, 2202.317281642696, 2084.593504266669, 2108.3042595943302, 2113.2709215320688, 2123.9150433982622, 2126.9361919142452, 7025.367716905503, 7065.788026359218, 7069.929300706978, 7071.36357727807, 7074.823129421754, 4219.683523735702, 4301.741895486281, 4332.653387728974, 4335.436393268887, 4348.717333373321, 2824.322162680942, 2873.913782586526, 2917.7519910807605, 2928.253295409657, 2932.4135172965493, 885.5978530961086, 899.2985471332371, 901.4185850126697, 907.8865141857268, 926.2034650200821, 9230.076992300783, 9239.122283383067, 9247.39891907024, 9272.258219342437, 9277.907220927771, 3833.5974722654278, 3952.505936757905, 3955.0, 3997.960020399817, 4010.578889216649, 7973.681052757941, 8010.359171266285, 8016.879746803803, 8020.919790802134, 8047.155048719917, 4235.4917409911, 4242.936355954663, 4247.277962746341, 4268.914621707549, 4270.167317373144, 3354.6142193648043, 3748.2316125194816, 3789.109559253573, 3821.7706937583835, 3839.9808000959815, 3451.930961380758, 3465.8093804840473, 3526.365254254259, 3527.6472352764517, 3537.6108628050893, 1123.7359220583157, 1134.1040577943331, 1145.8968692817687, 1147.839302497651, 1153.5443499817525, 1020.0462567499412, 1025.2208321675432, 1039.6205385034407, 1127.5264388956657, 1237.2823762217893, 6575.638339891352, 6616.569922954993, 6658.500612454085, 6659.633720145439, 6681.799546013627, 434.38534473719966, 453.93417954397086, 455.6537031855813, 455.9521250268674, 456.51837311635876, 5204.0, 5204.115300398866, 5233.921491177635, 5247.816326428557, 5253.789848406097, 8134.715284964997, 8388.748337549883, 8416.452930559493, 8428.536430496382, 8460.407771456063, 8188.7952801180445, 8248.422610417214, 8284.544350060683, 8289.4197406181, 8301.335893128535, 6302.180716506825, 6430.549861509743, 6432.324605916311, 6487.481001519867, 6505.0567667688865, 6519.4132528072705, 6625.304343044104, 6632.734690612515, 6674.332566743286, 6702.329767023259, 7255.637218139177, 7507.798752199622, 7531.397488201041, 7579.886301705589, 7659.272369124924, 7482.551046937201, 7636.389088872766, 7734.381249499914, 7773.883391749241, 7789.532628042336, 5295.364556253275, 5971.552133589911, 6128.4790792783115, 6180.6600636965395, 6348.079528468438, 6694.564853284521, 6702.698378572878, 6708.42978346846, 6717.697703603252, 6734.326567343226, 6069.726862291119, 6216.44052035319, 6234.438900498795, 6238.376162383725, 6307.716152773228, 5915.142304365929, 6047.334793172659, 6056.242969628796, 6058.787942421994, 6128.111423843428, 6315.0, 6316.84207894788, 6330.3669633036325, 6361.777337793155, 6363.3636636336, 5761.596688231783, 5801.477866991822, 5805.071188609802, 5808.30300363959, 5826.155207494974, 5818.389069147678, 5895.233619629421, 5922.763089476372, 5942.10868369748, 5947.702614869326], "unit": "score", "name": "mootools.html", "value": 3996.9877737344573}, {"lowerIsBetter": false, "replicates": [299.6538997457937, 300.69629674029227, 308.50946994279104, 311.19866344163785, 312.4298155865546, 5606.775728970836, 5688.516476099531, 5696.515796157327, 5790.131480277961, 5806.245188125537, 5647.8588035299135, 5673.517750991171, 5693.487586117249, 5697.230873832032, 5745.138229265613, 4059.9594004060023, 4168.1038576706005, 4209.410682504452, 4299.484061912567, 4309.482862056558, 4264.8507302244425, 4266.957330426702, 4282.122164956177, 4283.550227226143, 4289.892752681177, 4216.957830421703, 4224.450821393215, 4228.238916994939, 4233.005243767712, 4239.59723826236, 4232.153569286124, 4234.3860140279485, 4237.788110594473, 4242.554531774181, 4247.8300867965245, 3634.0914771307175, 3651.014226158949, 3660.194757153422, 3663.505426767379, 3675.7059435245383, 5395.082835917903, 5400.540954018913, 5403.918941215885, 5404.135338345845, 5408.648437851566, 4759.547842954914, 4883.316335713003, 4885.2427873679635, 4889.09551732927, 4912.70523768575, 5955.076963070731, 5963.0, 5969.791057313017, 5972.641641501524, 5987.1019347097845, 4062.6546743526837, 4067.7966101694797, 4069.755814651101, 4076.0217547788616, 4081.08175660477, 6263.6241825490615, 6332.145160403379, 6340.556161068727, 6348.682565871688, 6364.268109167412, 4161.271777438936, 4166.791660416967, 4167.97916010418, 4171.749695018309, 4172.7913604319665, 4181.372794080851, 4205.17998990194, 4206.684498662551, 4213.220554197484, 4218.746875187438, 4782.593479554277, 4908.901821963541, 4911.533404326583, 4913.213885778258, 4929.0, 5973.1936188614845, 5991.9700401498585, 5994.640321580632, 6009.218801555857, 6012.609180403348, 1484.5101116631486, 1496.2369191712087, 1497.0568541818584, 1497.9251037448084, 1498.7676910078956, 967.8354679704468, 968.9127978481971, 988.8665030220972, 992.8262554053011, 1011.4790882695418, 5214.32213812202, 5245.186996015624, 5248.186531087687, 5250.527452529214, 5251.658642188246, 6242.438180563771, 6263.655498947511, 6267.467265282502, 6274.309825919146, 6281.466075383643, 5071.822486212965, 5226.477352264743, 5231.189165679326, 5238.371395432497, 5238.790448382022, 3322.767406281537, 3386.8983930482127, 3390.6609339065894, 3398.439257522481, 3403.4384326586332, 5818.5345172386105, 5834.445727655951, 5840.707964601838, 5851.444112809277, 5864.648121112747, 6423.164988551458, 6432.9678351607945, 6452.774152904626, 6472.385123413268, 6476.125723027425, 5787.131930210502, 5812.680302583399, 5838.999999999915, 5854.941450585439, 5856.736446859816, 6093.421124993119, 6281.780137695158, 6300.432961033529, 6316.14732011191, 6319.0, 6160.691965401622, 6166.1983942087245, 6166.876662466815, 6172.4136207060255, 6182.227221597301, 5839.5912286141265, 5840.561957853093, 5849.678267695147, 5852.97572924745, 5869.941300586939, 4206.81069351886, 4209.284421648266, 4209.6000879916355, 4210.431591735077, 4221.598948099926, 6282.717277722605, 6283.497320214463, 6293.181886354744, 6293.811185664437, 6300.59046161998, 5820.94179058204, 6055.485283750754, 6078.240219972504, 6090.147379366981, 6099.176611157614, 6088.4215999479975, 6101.145839582373, 6114.48026917717, 6143.354947730602, 6143.6928153593035, 5798.362180160095, 5841.094630332305, 5889.293284805851, 5904.468597826216, 5921.644701317935, 6052.0, 6093.299270583762, 6099.786507472217, 6119.816405507842, 6121.081837724377, 5806.709664516842, 5918.940810591839, 5937.554683398849, 5971.58198926071, 5972.13404056418], "unit": "score", "name": "prototype.html", "value": 4447.533607214005}, {"lowerIsBetter": false, "replicates": [664.2493981800565, 698.1203683358967, 707.4693979515364, 723.2694978072147, 745.443130063881, 10867.945660271687, 10893.455327233636, 10895.400752958583, 11023.338599684024, 11287.830682539769, 12152.878471215285, 12319.260844349345, 12347.444365003574, 12351.0, 12404.565840195595, 641.1152609399023, 801.69535576481, 810.0643756461296, 813.979650508739, 814.5397850214639, 780.4692808889953, 794.0868001797921, 801.8596745569531, 802.8675268580677, 805.8348038652092, 846.4751853850621, 850.0267194062794, 854.2482615298528, 854.6666799948025, 858.1118542308711, 837.1461109668165, 842.5534466732611, 845.298402326074, 845.4335595151233, 847.7117779954814, 609.7591451376682, 614.2475467552257, 615.7260019291417, 616.3589866538795, 618.3013195089565, 13419.664508387368, 13452.260125693083, 13486.460541578324, 13491.0, 13533.255670938095, 12257.877421225763, 12372.44324005422, 12542.498300068077, 12706.491740330375, 12845.486180552767, 10013.949930250375, 10201.897981020169, 10240.078392944672, 10363.63727269542, 10544.947275263652, 3242.8702851885896, 3283.0, 3295.3244584860045, 3314.784539004981, 3399.9660003399895, 44449.33326000145, 44726.77636611828, 45180.54819451796, 45449.772751136035, 45752.771236143606, 9582.952085239529, 9613.279004074722, 9630.807383852283, 9686.225101991824, 9747.707568772948, 17142.314307427812, 17145.22846471912, 17154.571135721457, 17163.399281025104, 17185.39851105205, 6697.296783837627, 6894.482913781386, 6898.103246577913, 6933.79198624032, 6982.581045137308, 3643.653852883972, 3688.0595448160548, 3722.664960153599, 3738.8504459821847, 3751.2122454284904, 2953.881844726187, 2963.03701297075, 2970.4801659709465, 2987.985060074686, 2996.2060054085687, 525.976331065103, 532.0290469892461, 541.339565729809, 544.7249139184686, 556.3157316500645, 608.9921180446369, 613.5091926458904, 635.4249404289126, 638.6040654794058, 641.3298103481873, 8205.71280005197, 8535.786605334792, 8598.914010859937, 8611.784705382415, 8645.783855403539, 577.4964587481227, 595.4164918380012, 616.9938300617026, 618.038949433635, 619.9690015499207, 3684.4784731025934, 3804.391297392404, 3853.8265778040054, 3873.4189871519498, 3981.5819338969573, 48840.0, 49871.50128498741, 49999.25001124986, 50294.0, 50350.49649503458, 44380.0, 45163.096738065055, 45609.0, 46257.537424625996, 46375.44935028538, 42467.15065698669, 42521.57478425238, 42730.57269427266, 42824.57175428268, 43024.56975430206, 7423.463820162161, 7662.777794439773, 7711.26742959418, 7721.884171737316, 7762.340201082971, 32521.34957300888, 33424.0, 34542.65457345495, 34704.479432808024, 37806.62193378141, 40473.595264046984, 41342.58657413387, 41521.0, 42109.0, 43247.78376108225, 11115.277506962022, 11439.485223164811, 11644.53421863116, 11809.763804723685, 12128.75742485163, 12170.75658486843, 12315.322657253937, 12361.876381236432, 12573.371331433575, 12652.430640621378, 10994.34033957933, 11069.667909962714, 11182.217244792786, 11221.495032723711, 11245.381504017358, 11592.0, 11713.824292635787, 12003.0, 12314.81527777102, 12525.874741252472, 11486.36824974601, 11691.590794322497, 11812.82280765772, 11868.82196767032, 12151.878481215075, 9984.850227246452, 10133.594656213669, 10479.738006549896, 10615.787684246427, 10632.52153653072, 10047.196224302184, 10086.193104551472, 10194.43930583825, 10209.285350025428, 10219.233557483367], "unit": "score", "name": "yui.html", "value": 6062.0863441557485}], "name": "dromaeo_css", "value": 6358.099041897164}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [115.0, 108.0, 114.0, 116.0, 115.0, 127.0, 113.0, 113.0, 112.0, 113.0], "unit": "score", "name": "ai-astar", "value": 114.6}, {"lowerIsBetter": true, "replicates": [152.0, 129.0, 157.0, 174.0, 130.0, 156.0, 154.0, 133.0, 174.0, 130.0], "unit": "score", "name": "audio-beat-detection", "value": 148.9}, {"lowerIsBetter": true, "replicates": [164.0, 163.0, 163.0, 164.0, 163.0, 167.0, 169.0, 164.0, 164.0, 161.0], "unit": "score", "name": "audio-dft", "value": 164.2}, {"lowerIsBetter": true, "replicates": [75.0, 74.0, 74.0, 78.0, 77.0, 75.0, 73.0, 74.0, 134.0, 73.0], "unit": "score", "name": "audio-fft", "value": 80.7}, {"lowerIsBetter": true, "replicates": [101.0, 94.0, 140.0, 94.0, 94.0, 94.0, 142.0, 93.0, 94.0, 131.0], "unit": "score", "name": "audio-oscillator", "value": 107.7}, {"lowerIsBetter": true, "replicates": [120.0, 119.0, 118.0, 117.0, 118.0, 117.0, 117.0, 117.0, 118.0, 118.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.9}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 147.0, 147.0, 146.0, 148.0, 149.0, 147.0, 146.0, 148.0], "unit": "score", "name": "imaging-darkroom", "value": 147.2}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 97.0, 96.0, 96.0, 96.0, 97.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.4}, {"lowerIsBetter": true, "replicates": [71.0, 71.0, 69.0, 71.0, 70.0, 70.0, 69.0, 70.0, 68.0, 67.0], "unit": "score", "name": "json-parse-financial", "value": 69.6}, {"lowerIsBetter": true, "replicates": [64.0, 64.0, 65.0, 65.0, 65.0, 70.0, 64.0, 64.0, 64.0, 64.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.9}, {"lowerIsBetter": true, "replicates": [81.0, 91.0, 82.0, 92.0, 82.0, 82.0, 85.0, 89.0, 83.0, 81.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.8}, {"lowerIsBetter": true, "replicates": [128.0, 116.0, 120.0, 122.0, 120.0, 133.0, 118.0, 130.0, 122.0, 128.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.7}, {"lowerIsBetter": true, "replicates": [132.0, 150.0, 139.0, 143.0, 155.0, 143.0, 141.0, 152.0, 145.0, 132.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 143.2}, {"lowerIsBetter": true, "replicates": [69.0, 68.0, 69.0, 68.0, 67.0, 70.0, 67.0, 66.0, 66.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.7}], "name": "kraken", "value": 1531.5000000000002}]} 23:11:31 INFO - Return code: 0 23:11:31 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 23:11:31 ERROR - # TBPL SUCCESS # 23:11:31 INFO - Running post-action listener: _resource_record_post_action 23:11:31 INFO - Running post-run listener: _resource_record_post_run 23:11:32 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 4096; Write bytes: 520142848; Read time: 12; Write time: 530604 23:11:32 INFO - install - Wall time: 16s; CPU: 15.0%; Read bytes: 0; Write bytes: 211558400; Read time: 0; Write time: 255168 23:11:32 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 4096; Write bytes: 287653888; Read time: 12; Write time: 231612 23:11:32 INFO - Running post-run listener: _upload_blobber_files 23:11:32 INFO - Blob upload gear active. 23:11:32 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 23:11:32 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 23:11:32 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'] 23:11:32 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 23:11:33 INFO - (blobuploader) - INFO - Open directory for files ... 23:11:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 23:11:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:11:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:11:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 23:11:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:11:33 INFO - (blobuploader) - INFO - Done attempting. 23:11:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 23:11:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 23:11:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 23:11:35 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 23:11:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 23:11:35 INFO - (blobuploader) - INFO - Done attempting. 23:11:35 INFO - (blobuploader) - INFO - Iteration through files over. 23:11:35 INFO - Return code: 0 23:11:35 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 23:11:35 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 23:11:35 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/cfd1e5f9900aad552a345d398dded3c9926465e0ab290ad927aa2eaef8768be3e1c92927efda83ceade59734d688f74595ab1fb72abdb88134d22b1d902832e3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6c773d3b3cfe3be743dc7c329260990ac8e218c1004b3aad7749fc9f2aab60fea499cffa53f7a6a9b5f559d46a8be87968e9284e97f19ab360855e8cc96f4c31"} 23:11:35 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 23:11:35 INFO - Writing to file /builds/slave/test/properties/blobber_files 23:11:35 INFO - Contents: 23:11:35 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/cfd1e5f9900aad552a345d398dded3c9926465e0ab290ad927aa2eaef8768be3e1c92927efda83ceade59734d688f74595ab1fb72abdb88134d22b1d902832e3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6c773d3b3cfe3be743dc7c329260990ac8e218c1004b3aad7749fc9f2aab60fea499cffa53f7a6a9b5f559d46a8be87968e9284e97f19ab360855e8cc96f4c31"} 23:11:35 INFO - Running post-run listener: copy_logs_to_upload_dir 23:11:35 INFO - Copying logs to upload dir... 23:11:35 INFO - mkdir: /builds/slave/test/build/upload/logs 23:11:35 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1251.714758 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2016-03-19 23:11:33.755785) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-19 23:11:33.760101) ========= 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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 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/cfd1e5f9900aad552a345d398dded3c9926465e0ab290ad927aa2eaef8768be3e1c92927efda83ceade59734d688f74595ab1fb72abdb88134d22b1d902832e3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6c773d3b3cfe3be743dc7c329260990ac8e218c1004b3aad7749fc9f2aab60fea499cffa53f7a6a9b5f559d46a8be87968e9284e97f19ab360855e8cc96f4c31"} build_url:https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011080 build_url: 'https://queue.taskcluster.net/v1/task/KNKzkNBzQciSMaHO0AQL2g/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/cfd1e5f9900aad552a345d398dded3c9926465e0ab290ad927aa2eaef8768be3e1c92927efda83ceade59734d688f74595ab1fb72abdb88134d22b1d902832e3", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6c773d3b3cfe3be743dc7c329260990ac8e218c1004b3aad7749fc9f2aab60fea499cffa53f7a6a9b5f559d46a8be87968e9284e97f19ab360855e8cc96f4c31"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-19 23:11:33.788539) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 23:11:33.788905) ========= 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=574dc5aafe09851ec43d388c000001b6-1458452531.430440-1443293852 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004754 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-19 23:11:33.842698) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-19 23:11:33.843063) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-19 23:11:33.843403) ========= ========= Total master_lag: 0.26 =========