builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-007 starttime: 1458601156.03 results: success (0) buildid: 20160321152532 builduid: 7b271af6732d489d98feb124665bc526 revision: 4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.025686) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.042317) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.042719) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006356 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.068900) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.069258) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.082511) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.082815) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004680 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.141316) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.141667) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.142146) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.142447) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-21 15:59:16-- 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% 36.8M=0s 2016-03-21 15:59:16 (36.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.166181 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.331986) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.332306) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017825 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:16.387583) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-21 15:59:16.387910) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32 --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 4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32 --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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-21 15:59:16,849 truncating revision to first 12 chars 2016-03-21 15:59:16,849 Setting DEBUG logging. 2016-03-21 15:59:16,849 attempt 1/10 2016-03-21 15:59:16,850 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/4ad5b5dfe6e9?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-21 15:59:17,698 unpacking tar archive at: fx-team-4ad5b5dfe6e9/testing/mozharness/ program finished with exit code 0 elapsedTime=1.112700 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-21 15:59:17.514098) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:17.514459) ========= echo 4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32 in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32'] 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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32 program finished with exit code 0 elapsedTime=0.004919 script_repo_revision: '4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:17.566184) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:17.566495) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-21 15:59:17.576688) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-03-21 15:59:17.577118) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:59:18 INFO - MultiFileLogger online at 20160321 15:59:18 in /builds/slave/test 15:59:18 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --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 15:59:18 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:59:18 INFO - {'append_to_log': False, 15:59:18 INFO - 'base_work_dir': '/builds/slave/test', 15:59:18 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 15:59:18 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:59:18 INFO - 'branch': 'Fx-Team-Non-PGO', 15:59:18 INFO - 'buildbot_json_path': 'buildprops.json', 15:59:18 INFO - 'config_files': ('talos/linux_config.py',), 15:59:18 INFO - 'default_actions': ('clobber', 15:59:18 INFO - 'read-buildbot-config', 15:59:18 INFO - 'download-and-extract', 15:59:18 INFO - 'populate-webroot', 15:59:18 INFO - 'create-virtualenv', 15:59:18 INFO - 'install', 15:59:18 INFO - 'run-tests'), 15:59:18 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:59:18 INFO - 'download_minidump_stackwalk': True, 15:59:18 INFO - 'download_symbols': 'ondemand', 15:59:18 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:59:18 INFO - 'tooltool.py': '/tools/tooltool.py', 15:59:18 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:59:18 INFO - '/tools/misc-python/virtualenv.py')}, 15:59:18 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:59:18 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:59:18 INFO - 'installer_path': 'installer.exe', 15:59:18 INFO - 'log_level': 'info', 15:59:18 INFO - 'log_name': 'talos', 15:59:18 INFO - 'log_to_console': True, 15:59:18 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:59:18 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:59:18 INFO - 'opt_config_files': (), 15:59:18 INFO - 'pip_index': False, 15:59:18 INFO - 'sps_profile': False, 15:59:18 INFO - 'sps_profile_interval': 0, 15:59:18 INFO - 'suite': 'dromaeojs', 15:59:18 INFO - 'system_bits': '32', 15:59:18 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:59:18 INFO - 'title': 'talos-linux64-ix-007', 15:59:18 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:59:18 INFO - 'use_talos_json': True, 15:59:18 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:59:18 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:59:18 INFO - 'work_dir': 'build'} 15:59:18 INFO - ##### 15:59:18 INFO - ##### Running clobber step. 15:59:18 INFO - ##### 15:59:18 INFO - Running pre-action listener: _resource_record_pre_action 15:59:18 INFO - Running main action method: clobber 15:59:18 INFO - rmtree: /builds/slave/test/build 15:59:18 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:59:19 INFO - Running post-action listener: _resource_record_post_action 15:59:19 INFO - ##### 15:59:19 INFO - ##### Running read-buildbot-config step. 15:59:19 INFO - ##### 15:59:19 INFO - Running pre-action listener: _resource_record_pre_action 15:59:19 INFO - Running main action method: read_buildbot_config 15:59:19 INFO - Using buildbot properties: 15:59:19 INFO - { 15:59:19 INFO - "project": "", 15:59:19 INFO - "product": "firefox", 15:59:19 INFO - "script_repo_revision": "production", 15:59:19 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 15:59:19 INFO - "repository": "", 15:59:19 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 15:59:19 INFO - "buildid": "20160321152532", 15:59:19 INFO - "pgo_build": "False", 15:59:19 INFO - "basedir": "/builds/slave/test", 15:59:19 INFO - "buildnumber": 1486, 15:59:19 INFO - "slavename": "talos-linux64-ix-007", 15:59:19 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 15:59:19 INFO - "platform": "ubuntu64_hw", 15:59:19 INFO - "scheduler": "tests-fx-team-linux64-talos", 15:59:19 INFO - "branch": "fx-team", 15:59:19 INFO - "repo_path": "integration/fx-team", 15:59:19 INFO - "revision": "4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32", 15:59:19 INFO - "stage_platform": "linux64", 15:59:19 INFO - "builduid": "7b271af6732d489d98feb124665bc526", 15:59:19 INFO - "slavebuilddir": "test" 15:59:19 INFO - } 15:59:19 INFO - Found installer url https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 15:59:19 INFO - Running post-action listener: _resource_record_post_action 15:59:19 INFO - ##### 15:59:19 INFO - ##### Running download-and-extract step. 15:59:19 INFO - ##### 15:59:19 INFO - Running pre-action listener: _resource_record_pre_action 15:59:19 INFO - Running main action method: download_and_extract 15:59:19 INFO - mkdir: /builds/slave/test/build/tests 15:59:19 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')]} 15:59:19 INFO - https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 15:59:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 15:59:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 15:59:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:21 INFO - Downloaded 1361 bytes. 15:59:21 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 15:59:21 INFO - Using the following test package requirements: 15:59:21 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 15:59:21 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 15:59:21 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 15:59:21 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 15:59:21 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 15:59:21 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 15:59:21 INFO - u'jsshell-linux-x86_64.zip'], 15:59:21 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 15:59:21 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 15:59:21 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 15:59:21 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 15:59:21 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 15:59:21 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 15:59:21 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 15:59:21 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 15:59:21 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 15:59:21 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 15:59:21 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 15:59:21 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 15:59:21 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')]} 15:59:21 INFO - https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:59:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 15:59:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 15:59:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:22 INFO - Downloaded 22000154 bytes. 15:59:22 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'] 15:59:22 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 15:59:24 INFO - Return code: 0 15:59:24 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 15:59: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')]} 15:59:24 INFO - https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:59:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 15:59:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 15:59:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:25 INFO - Downloaded 22000154 bytes. 15:59:25 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'] 15:59:25 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 15:59:27 INFO - Return code: 0 15:59: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')]} 15:59:27 INFO - https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 15:59:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 15:59:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 15:59:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:28 INFO - Downloaded 10847637 bytes. 15:59:28 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'] 15:59:28 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 15:59:28 INFO - Return code: 0 15:59:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:59:28 INFO - https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 15:59:28 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 15:59:28 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 15:59:28 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:28 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/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 15:59:30 INFO - Downloaded 54166481 bytes. 15:59:30 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 15:59:30 INFO - mkdir: /builds/slave/test/properties 15:59:30 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:59:30 INFO - Writing to file /builds/slave/test/properties/build_url 15:59:30 INFO - Contents: 15:59:30 INFO - build_url:https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 15:59:30 INFO - Running post-action listener: _resource_record_post_action 15:59:30 INFO - Running post-action listener: set_extra_try_arguments 15:59:30 INFO - ##### 15:59:30 INFO - ##### Running populate-webroot step. 15:59:30 INFO - ##### 15:59:30 INFO - Running pre-action listener: _resource_record_pre_action 15:59:30 INFO - Running main action method: populate_webroot 15:59:30 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:59:30 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:59:30 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:59:30 INFO - '--tppagecycles', 15:59:30 INFO - '7'], 15:59:30 INFO - 'tests': ['tsvgm']}}, 15:59:30 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 15:59:30 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:59:30 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 15:59:30 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['dromaeo_css', 'kraken']}, 15:59:30 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:59:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:59:30 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:59:30 INFO - 'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:59:30 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:59:30 INFO - 'tests': ['damp', 'tps']}, 15:59:30 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:59:30 INFO - 'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['damp', 'tps']}, 15:59:30 INFO - 'g3': {'tests': ['dromaeo_dom']}, 15:59:30 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:59:30 INFO - 'other': {'tests': ['a11yr', 15:59:30 INFO - 'ts_paint', 15:59:30 INFO - 'tpaint', 15:59:30 INFO - 'sessionrestore', 15:59:30 INFO - 'sessionrestore_no_auto_restore', 15:59:30 INFO - 'tabpaint']}, 15:59:30 INFO - 'other-e10s': {'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['a11yr', 15:59:30 INFO - 'ts_paint', 15:59:30 INFO - 'tpaint', 15:59:30 INFO - 'sessionrestore', 15:59:30 INFO - 'sessionrestore_no_auto_restore', 15:59:30 INFO - 'tabpaint']}, 15:59:30 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['a11yr', 15:59:30 INFO - 'ts_paint', 15:59:30 INFO - 'tpaint', 15:59:30 INFO - 'sessionrestore', 15:59:30 INFO - 'sessionrestore_no_auto_restore', 15:59:30 INFO - 'tabpaint']}, 15:59:30 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['a11yr', 15:59:30 INFO - 'ts_paint', 15:59:30 INFO - 'tpaint', 15:59:30 INFO - 'sessionrestore', 15:59:30 INFO - 'sessionrestore_no_auto_restore', 15:59:30 INFO - 'tabpaint']}, 15:59:30 INFO - 'other_l64': {'tests': ['a11yr', 15:59:30 INFO - 'ts_paint', 15:59:30 INFO - 'tpaint', 15:59:30 INFO - 'sessionrestore', 15:59:30 INFO - 'sessionrestore_no_auto_restore', 15:59:30 INFO - 'tabpaint']}, 15:59:30 INFO - 'other_nol64': {'tests': ['a11yr', 15:59:30 INFO - 'ts_paint', 15:59:30 INFO - 'tpaint', 15:59:30 INFO - 'sessionrestore', 15:59:30 INFO - 'sessionrestore_no_auto_restore', 15:59:30 INFO - 'tabpaint']}, 15:59:30 INFO - 'svgr': {'tests': ['tsvgx', 15:59:30 INFO - 'tsvgr_opacity', 15:59:30 INFO - 'tart', 15:59:30 INFO - 'tscrollx', 15:59:30 INFO - 'cart']}, 15:59:30 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['tsvgx', 15:59:30 INFO - 'tsvgr_opacity', 15:59:30 INFO - 'tart', 15:59:30 INFO - 'tscrollx', 15:59:30 INFO - 'cart']}, 15:59:30 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:59:30 INFO - 'tests': ['tp5o']}, 15:59:30 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:59:30 INFO - 'talos_options': ['--e10s'], 15:59:30 INFO - 'tests': ['tp5o']}, 15:59:30 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:59:30 INFO - 'talos_options': ['--xperf_path', 15:59:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:59:30 INFO - 'tests': ['tp5n']}, 15:59:30 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:59:30 INFO - 'talos_options': ['--e10s', 15:59:30 INFO - '--xperf_path', 15:59:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:59:30 INFO - 'tests': ['tp5n']}}, 15:59:30 INFO - 'talos.zip': {'path': '', 15:59:30 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:59:30 INFO - Running post-action listener: _resource_record_post_action 15:59:30 INFO - ##### 15:59:30 INFO - ##### Running create-virtualenv step. 15:59:30 INFO - ##### 15:59:30 INFO - Running pre-action listener: _resource_record_pre_action 15:59:30 INFO - Running main action method: create_virtualenv 15:59:30 INFO - Creating virtualenv /builds/slave/test/build/venv 15:59:30 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 15:59:30 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:59:30 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:59:30 INFO - Using real prefix '/usr' 15:59:30 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:59:31 INFO - Installing distribute.............................................................................................................................................................................................done. 15:59:33 INFO - Installing pip.................done. 15:59:33 INFO - Return code: 0 15:59:33 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:59: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')]} 15:59:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59: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')]} 15:59:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59: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', 'pip>=1.5'] in /builds/slave/test/build 15:59: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 pip>=1.5 15:59:33 INFO - Using env: {'DISPLAY': ':0', 15:59:33 INFO - 'HOME': '/home/cltbld', 15:59:33 INFO - 'LANG': 'en_US.UTF-8', 15:59:33 INFO - 'LANGUAGE': 'en_US:en', 15:59:33 INFO - 'LOGNAME': 'cltbld', 15:59:33 INFO - 'MAIL': '/var/mail/cltbld', 15:59:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:33 INFO - 'MOZ_NO_REMOTE': '1', 15:59:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:33 INFO - 'NO_EM_RESTART': '1', 15:59:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:33 INFO - 'PWD': '/builds/slave/test', 15:59:33 INFO - 'SHELL': '/bin/bash', 15:59:33 INFO - 'SHLVL': '1', 15:59:33 INFO - 'TERM': 'linux', 15:59:33 INFO - 'TMOUT': '86400', 15:59:33 INFO - 'USER': 'cltbld', 15:59:33 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:33 INFO - '_': '/tools/buildbot/bin/python'} 15:59:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:33 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 15:59:33 INFO - Cleaning up... 15:59:33 INFO - Return code: 0 15:59:33 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 15:59: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')]} 15:59:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59: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')]} 15:59:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59: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', '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 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59: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', 'psutil>=0.7.1'] in /builds/slave/test/build 15:59: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 psutil>=0.7.1 15:59:33 INFO - Using env: {'DISPLAY': ':0', 15:59:33 INFO - 'HOME': '/home/cltbld', 15:59:33 INFO - 'LANG': 'en_US.UTF-8', 15:59:33 INFO - 'LANGUAGE': 'en_US:en', 15:59:33 INFO - 'LOGNAME': 'cltbld', 15:59:33 INFO - 'MAIL': '/var/mail/cltbld', 15:59:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:33 INFO - 'MOZ_NO_REMOTE': '1', 15:59:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:33 INFO - 'NO_EM_RESTART': '1', 15:59:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:33 INFO - 'PWD': '/builds/slave/test', 15:59:33 INFO - 'SHELL': '/bin/bash', 15:59:33 INFO - 'SHLVL': '1', 15:59:33 INFO - 'TERM': 'linux', 15:59:33 INFO - 'TMOUT': '86400', 15:59:33 INFO - 'USER': 'cltbld', 15:59:33 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:33 INFO - '_': '/tools/buildbot/bin/python'} 15:59:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:33 INFO - Downloading/unpacking psutil>=0.7.1 15:59: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 15:59: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 15:59: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 15:59: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 15:59: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 15:59: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 15:59:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:59:35 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:59:35 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:59:35 INFO - Installing collected packages: psutil 15:59:35 INFO - Running setup.py install for psutil 15:59:35 INFO - building 'psutil._psutil_linux' extension 15:59:35 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 15:59:36 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 15:59:36 INFO - building 'psutil._psutil_posix' extension 15:59:36 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 15:59:36 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 15:59:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:59:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:59:36 INFO - Successfully installed psutil 15:59:36 INFO - Cleaning up... 15:59:36 INFO - Return code: 0 15:59:36 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 15:59:36 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')]} 15:59:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:36 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')]} 15:59:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:36 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 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59:36 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 15:59:36 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 15:59:36 INFO - Using env: {'DISPLAY': ':0', 15:59:36 INFO - 'HOME': '/home/cltbld', 15:59:36 INFO - 'LANG': 'en_US.UTF-8', 15:59:36 INFO - 'LANGUAGE': 'en_US:en', 15:59:36 INFO - 'LOGNAME': 'cltbld', 15:59:36 INFO - 'MAIL': '/var/mail/cltbld', 15:59:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:36 INFO - 'MOZ_NO_REMOTE': '1', 15:59:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:36 INFO - 'NO_EM_RESTART': '1', 15:59:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:36 INFO - 'PWD': '/builds/slave/test', 15:59:36 INFO - 'SHELL': '/bin/bash', 15:59:36 INFO - 'SHLVL': '1', 15:59:36 INFO - 'TERM': 'linux', 15:59:36 INFO - 'TMOUT': '86400', 15:59:36 INFO - 'USER': 'cltbld', 15:59:36 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:36 INFO - '_': '/tools/buildbot/bin/python'} 15:59:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:36 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 15:59: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 15:59: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 15:59: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 15:59: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 15:59: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 15:59: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 15:59:38 INFO - Downloading mozsystemmonitor-0.0.tar.gz 15:59:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:59:38 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 15:59:38 INFO - Installing collected packages: mozsystemmonitor 15:59:38 INFO - Running setup.py install for mozsystemmonitor 15:59:38 INFO - Successfully installed mozsystemmonitor 15:59:38 INFO - Cleaning up... 15:59:38 INFO - Return code: 0 15:59:38 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:59:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:59:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:59:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:38 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 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59:38 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 15:59:38 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 15:59:38 INFO - Using env: {'DISPLAY': ':0', 15:59:38 INFO - 'HOME': '/home/cltbld', 15:59:38 INFO - 'LANG': 'en_US.UTF-8', 15:59:38 INFO - 'LANGUAGE': 'en_US:en', 15:59:38 INFO - 'LOGNAME': 'cltbld', 15:59:38 INFO - 'MAIL': '/var/mail/cltbld', 15:59:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:38 INFO - 'MOZ_NO_REMOTE': '1', 15:59:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:38 INFO - 'NO_EM_RESTART': '1', 15:59:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:38 INFO - 'PWD': '/builds/slave/test', 15:59:38 INFO - 'SHELL': '/bin/bash', 15:59:38 INFO - 'SHLVL': '1', 15:59:38 INFO - 'TERM': 'linux', 15:59:38 INFO - 'TMOUT': '86400', 15:59:38 INFO - 'USER': 'cltbld', 15:59:38 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:38 INFO - '_': '/tools/buildbot/bin/python'} 15:59:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:38 INFO - Downloading/unpacking blobuploader==1.2.4 15:59:38 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 15:59:38 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 15:59:38 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 15:59:38 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 15:59:38 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 15:59:38 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 15:59:40 INFO - Downloading blobuploader-1.2.4.tar.gz 15:59:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:59:40 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:59:40 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 15:59:40 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 15:59:40 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 15:59:40 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 15:59:40 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 15:59:40 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 15:59:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:59:41 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:59:41 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 15:59:41 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 15:59:41 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 15:59:41 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 15:59:41 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 15:59:41 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 15:59:41 INFO - Downloading docopt-0.6.1.tar.gz 15:59:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:59:41 INFO - Installing collected packages: blobuploader, requests, docopt 15:59:41 INFO - Running setup.py install for blobuploader 15:59:41 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:59:41 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:59:41 INFO - Running setup.py install for requests 15:59:41 INFO - Running setup.py install for docopt 15:59:41 INFO - Successfully installed blobuploader requests docopt 15:59:41 INFO - Cleaning up... 15:59:42 INFO - Return code: 0 15:59:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:59:42 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')]} 15:59:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:42 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')]} 15:59:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:42 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 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59:42 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 15:59:42 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 15:59:42 INFO - Using env: {'DISPLAY': ':0', 15:59:42 INFO - 'HOME': '/home/cltbld', 15:59:42 INFO - 'LANG': 'en_US.UTF-8', 15:59:42 INFO - 'LANGUAGE': 'en_US:en', 15:59:42 INFO - 'LOGNAME': 'cltbld', 15:59:42 INFO - 'MAIL': '/var/mail/cltbld', 15:59:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:42 INFO - 'MOZ_NO_REMOTE': '1', 15:59:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:42 INFO - 'NO_EM_RESTART': '1', 15:59:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:42 INFO - 'PWD': '/builds/slave/test', 15:59:42 INFO - 'SHELL': '/bin/bash', 15:59:42 INFO - 'SHLVL': '1', 15:59:42 INFO - 'TERM': 'linux', 15:59:42 INFO - 'TMOUT': '86400', 15:59:42 INFO - 'USER': 'cltbld', 15:59:42 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:42 INFO - '_': '/tools/buildbot/bin/python'} 15:59:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:59:42 INFO - Running setup.py (path:/tmp/pip-7s85gu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:59:42 INFO - Running setup.py (path:/tmp/pip-YK2Y0j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:59:42 INFO - Running setup.py (path:/tmp/pip-GGA1LJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:59:42 INFO - Running setup.py (path:/tmp/pip-i_bHiQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:59:42 INFO - Running setup.py (path:/tmp/pip-VtrxkT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:59:42 INFO - Running setup.py (path:/tmp/pip-75hpjp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:59:42 INFO - Running setup.py (path:/tmp/pip-I3lRmP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:59:42 INFO - Running setup.py (path:/tmp/pip-_HWqyj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:59:42 INFO - Running setup.py (path:/tmp/pip-V4rIaq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:59:42 INFO - Running setup.py (path:/tmp/pip-FKszBm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:59:42 INFO - Running setup.py (path:/tmp/pip-G2uS5q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:59:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:59:43 INFO - Running setup.py (path:/tmp/pip-JvL8rb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:59:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:59:43 INFO - Running setup.py (path:/tmp/pip-9_6ZN7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:59:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:59:43 INFO - Running setup.py (path:/tmp/pip-JtcKOE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:59:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:59:43 INFO - Running setup.py (path:/tmp/pip-ah_hlf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:59:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:59:43 INFO - Running setup.py (path:/tmp/pip-TPCasr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:59:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:59:43 INFO - Running setup.py (path:/tmp/pip-7p9WPI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:59:43 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:59:43 INFO - Running setup.py install for manifestparser 15:59:43 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:59:43 INFO - Running setup.py install for mozcrash 15:59:43 INFO - Running setup.py install for mozdebug 15:59:43 INFO - Running setup.py install for mozdevice 15:59:43 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:59:43 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:59:43 INFO - Running setup.py install for mozfile 15:59:43 INFO - Running setup.py install for mozhttpd 15:59:44 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Running setup.py install for mozinfo 15:59:44 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Running setup.py install for mozInstall 15:59:44 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Running setup.py install for mozleak 15:59:44 INFO - Running setup.py install for mozlog 15:59:44 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Running setup.py install for moznetwork 15:59:44 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Running setup.py install for mozprocess 15:59:44 INFO - Running setup.py install for mozprofile 15:59:44 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Running setup.py install for mozrunner 15:59:44 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:59:44 INFO - Running setup.py install for mozscreenshot 15:59:44 INFO - Running setup.py install for moztest 15:59:45 INFO - Running setup.py install for mozversion 15:59:45 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:59:45 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:59:45 INFO - Cleaning up... 15:59:45 INFO - Return code: 0 15:59:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:59: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')]} 15:59:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59: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')]} 15:59:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:45 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 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59:45 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 15:59:45 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 15:59:45 INFO - Using env: {'DISPLAY': ':0', 15:59:45 INFO - 'HOME': '/home/cltbld', 15:59:45 INFO - 'LANG': 'en_US.UTF-8', 15:59:45 INFO - 'LANGUAGE': 'en_US:en', 15:59:45 INFO - 'LOGNAME': 'cltbld', 15:59:45 INFO - 'MAIL': '/var/mail/cltbld', 15:59:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:45 INFO - 'MOZ_NO_REMOTE': '1', 15:59:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:45 INFO - 'NO_EM_RESTART': '1', 15:59:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:45 INFO - 'PWD': '/builds/slave/test', 15:59:45 INFO - 'SHELL': '/bin/bash', 15:59:45 INFO - 'SHLVL': '1', 15:59:45 INFO - 'TERM': 'linux', 15:59:45 INFO - 'TMOUT': '86400', 15:59:45 INFO - 'USER': 'cltbld', 15:59:45 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:45 INFO - '_': '/tools/buildbot/bin/python'} 15:59:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:59:45 INFO - Running setup.py (path:/tmp/pip-ujAl68-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:59:45 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)) 15:59:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:59:45 INFO - Running setup.py (path:/tmp/pip-wbqKtr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:59:45 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)) 15:59:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:59:45 INFO - Running setup.py (path:/tmp/pip-FOe5M0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:59:45 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)) 15:59:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:59:45 INFO - Running setup.py (path:/tmp/pip-OsTJ0y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:59:45 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)) 15:59:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:59:45 INFO - Running setup.py (path:/tmp/pip-d6mGIM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:59:45 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)) 15:59:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:59:45 INFO - Running setup.py (path:/tmp/pip-CjYfuG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:59:45 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)) 15:59:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:59:45 INFO - Running setup.py (path:/tmp/pip-Atzd4k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:59:45 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)) 15:59:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:59:45 INFO - Running setup.py (path:/tmp/pip-xJD4Ku-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:59:46 INFO - Running setup.py (path:/tmp/pip-UVwsXT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:59:46 INFO - Running setup.py (path:/tmp/pip-l5L3lP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:59:46 INFO - Running setup.py (path:/tmp/pip-5ZYhko-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:59:46 INFO - Running setup.py (path:/tmp/pip-IQIexG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:59:46 INFO - Running setup.py (path:/tmp/pip-MllMrM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:59:46 INFO - Running setup.py (path:/tmp/pip-rdzQcD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:59:46 INFO - Running setup.py (path:/tmp/pip-rMRADV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:59:46 INFO - Running setup.py (path:/tmp/pip-uzUoGs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:59:46 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)) 15:59:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:59:46 INFO - Running setup.py (path:/tmp/pip-bsKFcN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:59:46 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)) 15:59:46 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)) 15:59:46 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)) 15:59:46 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)) 15:59:46 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)) 15:59:46 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)) 15:59:46 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:59:46 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 15:59:46 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 15:59:46 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 15:59:46 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 15:59:46 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 15:59:46 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 15:59:48 INFO - Downloading blessings-1.6.tar.gz 15:59:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:59:48 INFO - Installing collected packages: blessings 15:59:48 INFO - Running setup.py install for blessings 15:59:48 INFO - Successfully installed blessings 15:59:48 INFO - Cleaning up... 15:59:48 INFO - Return code: 0 15:59:48 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:59:48 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:59:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:59:48 INFO - Reading from file tmpfile_stdout 15:59:48 INFO - Current package versions: 15:59:48 INFO - argparse == 1.2.1 15:59:48 INFO - blessings == 1.6 15:59:48 INFO - blobuploader == 1.2.4 15:59:48 INFO - docopt == 0.6.1 15:59:48 INFO - manifestparser == 1.1 15:59:48 INFO - mozInstall == 1.12 15:59:48 INFO - mozcrash == 0.17 15:59:48 INFO - mozdebug == 0.1 15:59:48 INFO - mozdevice == 0.48 15:59:48 INFO - mozfile == 1.2 15:59:48 INFO - mozhttpd == 0.7 15:59:48 INFO - mozinfo == 0.9 15:59:48 INFO - mozleak == 0.1 15:59:48 INFO - mozlog == 3.1 15:59:48 INFO - moznetwork == 0.27 15:59:48 INFO - mozprocess == 0.22 15:59:48 INFO - mozprofile == 0.28 15:59:48 INFO - mozrunner == 6.11 15:59:48 INFO - mozscreenshot == 0.1 15:59:48 INFO - mozsystemmonitor == 0.0 15:59:48 INFO - moztest == 0.7 15:59:48 INFO - mozversion == 1.4 15:59:48 INFO - psutil == 3.1.1 15:59:48 INFO - requests == 1.2.3 15:59:48 INFO - wsgiref == 0.1.2 15:59:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:59: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')]} 15:59:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59: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')]} 15:59:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:48 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 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59:48 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 15:59:48 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 15:59:48 INFO - Using env: {'DISPLAY': ':0', 15:59:48 INFO - 'HOME': '/home/cltbld', 15:59:48 INFO - 'LANG': 'en_US.UTF-8', 15:59:48 INFO - 'LANGUAGE': 'en_US:en', 15:59:48 INFO - 'LOGNAME': 'cltbld', 15:59:48 INFO - 'MAIL': '/var/mail/cltbld', 15:59:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:48 INFO - 'MOZ_NO_REMOTE': '1', 15:59:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:48 INFO - 'NO_EM_RESTART': '1', 15:59:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:48 INFO - 'PWD': '/builds/slave/test', 15:59:48 INFO - 'SHELL': '/bin/bash', 15:59:48 INFO - 'SHLVL': '1', 15:59:48 INFO - 'TERM': 'linux', 15:59:48 INFO - 'TMOUT': '86400', 15:59:48 INFO - 'USER': 'cltbld', 15:59:48 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:48 INFO - '_': '/tools/buildbot/bin/python'} 15:59:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 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)) 15:59:49 INFO - Cleaning up... 15:59:49 INFO - Return code: 0 15:59:49 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:59:49 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')]} 15:59:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:49 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')]} 15:59:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:49 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 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59:49 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 15:59:49 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 15:59:49 INFO - Using env: {'DISPLAY': ':0', 15:59:49 INFO - 'HOME': '/home/cltbld', 15:59:49 INFO - 'LANG': 'en_US.UTF-8', 15:59:49 INFO - 'LANGUAGE': 'en_US:en', 15:59:49 INFO - 'LOGNAME': 'cltbld', 15:59:49 INFO - 'MAIL': '/var/mail/cltbld', 15:59:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:49 INFO - 'MOZ_NO_REMOTE': '1', 15:59:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:49 INFO - 'NO_EM_RESTART': '1', 15:59:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:49 INFO - 'PWD': '/builds/slave/test', 15:59:49 INFO - 'SHELL': '/bin/bash', 15:59:49 INFO - 'SHLVL': '1', 15:59:49 INFO - 'TERM': 'linux', 15:59:49 INFO - 'TMOUT': '86400', 15:59:49 INFO - 'USER': 'cltbld', 15:59:49 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:49 INFO - '_': '/tools/buildbot/bin/python'} 15:59:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:49 INFO - Downloading/unpacking jsonschema 15:59:49 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 15:59:49 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 15:59:49 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 15:59:49 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 15:59:49 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 15:59:49 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 15:59:51 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:59:51 INFO - Downloading/unpacking functools32 (from jsonschema) 15:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:51 INFO - Downloading functools32-3.2.3-2.tar.gz 15:59:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:59:51 INFO - warning: no files found matching '*.txt' 15:59:51 INFO - no previously-included directories found matching 'build' 15:59:51 INFO - no previously-included directories found matching 'dist' 15:59:51 INFO - no previously-included directories found matching '.git*' 15:59:51 INFO - Installing collected packages: jsonschema, functools32 15:59:51 INFO - Running setup.py install for functools32 15:59:51 INFO - warning: no files found matching '*.txt' 15:59:51 INFO - no previously-included directories found matching 'build' 15:59:51 INFO - no previously-included directories found matching 'dist' 15:59:51 INFO - no previously-included directories found matching '.git*' 15:59:51 INFO - Successfully installed jsonschema functools32 15:59:51 INFO - Cleaning up... 15:59:51 INFO - Return code: 0 15:59:51 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 15:59:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:59:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:59:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:59:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:59:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f4903a9df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b0d8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bd85a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, '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': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', '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 15:59:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 15:59:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 15:59:51 INFO - Using env: {'DISPLAY': ':0', 15:59:51 INFO - 'HOME': '/home/cltbld', 15:59:51 INFO - 'LANG': 'en_US.UTF-8', 15:59:51 INFO - 'LANGUAGE': 'en_US:en', 15:59:51 INFO - 'LOGNAME': 'cltbld', 15:59:51 INFO - 'MAIL': '/var/mail/cltbld', 15:59:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:59:51 INFO - 'MOZ_NO_REMOTE': '1', 15:59:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:59:51 INFO - 'NO_EM_RESTART': '1', 15:59:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:59:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:59:51 INFO - 'PWD': '/builds/slave/test', 15:59:51 INFO - 'SHELL': '/bin/bash', 15:59:51 INFO - 'SHLVL': '1', 15:59:51 INFO - 'TERM': 'linux', 15:59:51 INFO - 'TMOUT': '86400', 15:59:51 INFO - 'USER': 'cltbld', 15:59:51 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 15:59:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:59:51 INFO - '_': '/tools/buildbot/bin/python'} 15:59:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:59:51 INFO - Downloading/unpacking flake8 15:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:53 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 15:59:53 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 15:59:53 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 15:59:53 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 15:59:53 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 15:59:53 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 15:59:53 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 15:59:53 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 15:59:53 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 15:59:53 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 15:59:53 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 15:59:53 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 15:59:53 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 15:59:53 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 15:59:53 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 15:59:53 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 15:59:54 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 15:59:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:59:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:59:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:59:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 15:59:54 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 15:59:54 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 15:59:54 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 15:59:54 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 15:59:54 INFO - no previously-included directories found matching 'docs/_build' 15:59:54 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 15:59:54 INFO - Running setup.py install for pep8 15:59:54 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 15:59:54 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 15:59:54 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 15:59:54 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 15:59:54 INFO - no previously-included directories found matching 'docs/_build' 15:59:54 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 15:59:54 INFO - Successfully installed flake8 mccabe pyflakes pep8 15:59:54 INFO - Cleaning up... 15:59:54 INFO - Return code: 0 15:59:54 INFO - Running post-action listener: _resource_record_post_action 15:59:54 INFO - Running post-action listener: _start_resource_monitoring 15:59:54 INFO - Starting resource monitoring. 15:59:54 INFO - ##### 15:59:54 INFO - ##### Running install step. 15:59:54 INFO - ##### 15:59:54 INFO - Running pre-action listener: _resource_record_pre_action 15:59:54 INFO - Running main action method: install 15:59:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:59:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:59:54 INFO - Reading from file tmpfile_stdout 15:59:54 INFO - Detecting whether we're running mozinstall >=1.0... 15:59:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:59:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:59:55 INFO - Reading from file tmpfile_stdout 15:59:55 INFO - Output received: 15:59:55 INFO - Usage: mozinstall [options] installer 15:59:55 INFO - Options: 15:59:55 INFO - -h, --help show this help message and exit 15:59:55 INFO - -d DEST, --destination=DEST 15:59:55 INFO - Directory to install application into. [default: 15:59:55 INFO - "/builds/slave/test"] 15:59:55 INFO - --app=APP Application being installed. [default: firefox] 15:59:55 INFO - mkdir: /builds/slave/test/build/application 15:59:55 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'] 15:59:55 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 16:00:10 INFO - Reading from file tmpfile_stdout 16:00:10 INFO - Output received: 16:00:10 INFO - /builds/slave/test/build/application/firefox/firefox 16:00:10 INFO - Running post-action listener: _resource_record_post_action 16:00:10 INFO - ##### 16:00:10 INFO - ##### Running run-tests step. 16:00:10 INFO - ##### 16:00:10 INFO - Running pre-action listener: _resource_record_pre_action 16:00:10 INFO - Running main action method: run_tests 16:00:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:00:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:00:10 INFO - Python 2.7.3 16:00:10 INFO - Return code: 0 16:00:10 INFO - grabbing minidump binary from tooltool 16:00: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')]} 16:00:10 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 0x1c67410>, '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 0x1c68310>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c687a0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:00:10 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 16:00:10 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 16:00:10 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:00:10 INFO - Return code: 0 16:00:10 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:00:10 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:00:10 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:00:10 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:00:10 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:00:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 16:00:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 16:00:11 INFO - Return code: 0 16:00:11 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', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-007', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 16:00:11 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 --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-007 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 16:00:11 INFO - Using env: {'DISPLAY': ':0', 16:00:11 INFO - 'HOME': '/home/cltbld', 16:00:11 INFO - 'LANG': 'en_US.UTF-8', 16:00:11 INFO - 'LANGUAGE': 'en_US:en', 16:00:11 INFO - 'LOGNAME': 'cltbld', 16:00:11 INFO - 'MAIL': '/var/mail/cltbld', 16:00:11 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:00:11 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:00:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:00:11 INFO - 'MOZ_NO_REMOTE': '1', 16:00:11 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:00:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:00:11 INFO - 'NO_EM_RESTART': '1', 16:00:11 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:00:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:00:11 INFO - 'PWD': '/builds/slave/test', 16:00:11 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:00:11 INFO - 'SHELL': '/bin/bash', 16:00:11 INFO - 'SHLVL': '1', 16:00:11 INFO - 'TERM': 'linux', 16:00:11 INFO - 'TMOUT': '86400', 16:00:11 INFO - 'USER': 'cltbld', 16:00:11 INFO - 'XDG_SESSION_COOKIE': 'b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341', 16:00:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:00:11 INFO - '_': '/tools/buildbot/bin/python'} 16:00:11 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', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-007', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 16:00:11 INFO - mozversion application_buildid: 20160321152532 16:00:11 INFO - mozversion application_changeset: 4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32 16:00:11 INFO - mozversion application_display_name: Nightly 16:00:11 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:00:11 INFO - mozversion application_name: Firefox 16:00:11 INFO - mozversion application_remotingname: firefox 16:00:11 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 16:00:11 INFO - mozversion application_vendor: Mozilla 16:00:11 INFO - mozversion application_version: 48.0a1 16:00:11 INFO - mozversion platform_buildid: 20160321152532 16:00:11 INFO - mozversion platform_changeset: 4ad5b5dfe6e9da11d1d51d54cd6206bdf2fb5d32 16:00:11 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 16:00:11 INFO - mozversion platform_version: 48.0a1 16:00:11 INFO - using testdate: 1458601211 16:00:11 INFO - actual date: 1458601211 16:00:11 INFO - starting webserver on 'localhost:35222' 16:00:11 INFO - SUITE-START | Running 2 tests 16:00:11 INFO - TEST-START | dromaeo_css 16:00:11 INFO - operating with platform_type : linux_ 16:00:11 INFO - Initialising browser for dromaeo_css test... 16:00:11 INFO - TEST-INFO | started process 17112 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpH0cEm6/profile http://localhost:35222/getInfo.html) 16:00:16 INFO - PROCESS | 17112 | __metrics Screen width/height:1600/1200 16:00:16 INFO - PROCESS | 17112 | colorDepth:24 16:00:16 INFO - PROCESS | 17112 | Browser inner width/height: 1024/697 16:00:16 INFO - PROCESS | 17112 | __metrics 16:00:17 ERROR - PROCESS | 17112 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 16:00:17 INFO - PROCESS | 17112 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 16:00:18 INFO - TEST-INFO | 17112: exit 0 16:00:18 INFO - Browser initialized. 16:00:18 INFO - Running cycle 1/1 for dromaeo_css test... 16:00:18 INFO - TEST-INFO | started process 17210 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpH0cEm6/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:00:30 INFO - PROCESS | 17210 | RSS: Main: 158093312 16:00:30 INFO - PROCESS | 17210 | 16:01:21 INFO - PROCESS | 17210 | 1458601281463 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] 16:03:33 INFO - PROCESS | 17210 | Cycle 1(1): loaded http://localhost:35222/tests/dromaeo/cssquery-dojo.html (next: http://localhost:35222/tests/dromaeo/cssquery-ext.html) 16:03:34 INFO - PROCESS | 17210 | RSS: Main: 260337664 16:03:34 INFO - PROCESS | 17210 | 16:06:36 INFO - PROCESS | 17210 | Cycle 1(1): loaded http://localhost:35222/tests/dromaeo/cssquery-ext.html (next: http://localhost:35222/tests/dromaeo/cssquery-jquery.html) 16:06:37 INFO - PROCESS | 17210 | RSS: Main: 237813760 16:06:37 INFO - PROCESS | 17210 | 16:09:38 INFO - PROCESS | 17210 | Cycle 1(1): loaded http://localhost:35222/tests/dromaeo/cssquery-jquery.html (next: http://localhost:35222/tests/dromaeo/cssquery-mootools.html) 16:09:39 INFO - PROCESS | 17210 | RSS: Main: 251842560 16:09:39 INFO - PROCESS | 17210 | 16:12:41 INFO - PROCESS | 17210 | Cycle 1(1): loaded http://localhost:35222/tests/dromaeo/cssquery-mootools.html (next: http://localhost:35222/tests/dromaeo/cssquery-prototype.html) 16:12:41 INFO - PROCESS | 17210 | RSS: Main: 225996800 16:12:41 INFO - PROCESS | 17210 | 16:15:44 INFO - PROCESS | 17210 | Cycle 1(1): loaded http://localhost:35222/tests/dromaeo/cssquery-prototype.html (next: http://localhost:35222/tests/dromaeo/cssquery-yui.html) 16:15:45 INFO - PROCESS | 17210 | RSS: Main: 229588992 16:15:45 INFO - PROCESS | 17210 | 16:18:47 INFO - PROCESS | 17210 | Cycle 1(1): loaded http://localhost:35222/tests/dromaeo/cssquery-yui.html (next: http://localhost:35222/tests/dromaeo/cssquery-dojo.html) 16:18:48 INFO - PROCESS | 17210 | RSS: Main: 305672192 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - PROCESS | 17210 | __start_tp_report 16:18:48 INFO - PROCESS | 17210 | _x_x_mozilla_page_load 16:18:48 INFO - PROCESS | 17210 | _x_x_mozilla_page_load_details 16:18:48 INFO - PROCESS | 17210 | |i|pagename|runs| 16:18:48 INFO - PROCESS | 17210 | |0;dojo.html;2600.1419531554584;2647.5896236083404;2674.1175412114003;2678.491086693528;2702.9324266893327;4539.614132798716;4617.653675974307;4639.4432668079835;4642.187617166999;4670.906581868365;4636.721796692201;4684.672072954894;4690.601298889598;4713.222318317474;4781.330613714074;4313.547077556843;4322.654187664995;4329.134173165364;4348.108637729274;4487.842925497608;4219.177260434217;4390.319500477431;4410.095930334273;4449.710768800018;4473.2395492766145;4258.595433433834;4274.187904298205;4297.333913243452;4355.84754533593;4360.585744354281;4272.252355837747;4275.315949448104;4289.806958686867;4313.072689371768;4317.69776115672;4200.7479551227025;4247.447831781879;4267.997020700164;4300.827966881321;4315.978420107911;4594.770261486912;4613;4667.486576476585;4674.228752255874;4674.368960190399;4933.876653083702;4943.332650092228;4946.356973593446;4999.775010124553;5001.724905130216;4905.3132561441425;4974.577160941324;4980.203167493184;4983.401991761012;4984.601231901439;4637.652176086807;4651.790669419885;4687.929681054787;4734.360861283752;4734.479207287196;5067.670601410897;5077;5079.771410286546;5081.441041485434;5136.4606716295;4777.95222047782;4854.927176092361;4859.319695242669;4860.1251774680895;4873.390826146731;4926.113299606033;4939.160342741742;4947.455779864212;4968.776405061781;4983.6760610560195;4888.26675998596;4898.926516102261;4899.2896030075435;4905.9264111038365;4950.529699678525;4784.617230621542;4820.855374338776;4875.24433712775;4887.853364399074;4948.38145231846;4216.599423054805;4220.6412454941055;4221.78891055446;4245.724027938174;4265.722728022669;3691.53855768029;3697.186618943828;3707.2214834884976;3733.0667333166707;3744.494493243432;4243.893902652459;4316.352547117957;4334.609885110355;4345.630621397217;4419;5027.673201241908;5046.924296135561;5048.167052436307;5049.520295571915;5063.0380227756605;4371.169477799208;4375.212461756851;4378.562143785596;4379;4412.933805992912;4385.561443855653;4462.419885414875;4470.575295346936;4470.888227794266;4524.773761311922;4654.790534425959;4688.624910007123;4702.929456058162;4710.505396933409;4713.269443236304;4990.3762029746285;5030;5072.416672082758;5075.898482030412;5080.390353157644;4732.621390288699;4736.73947932867;4740.1230772307235;4745.928811067768;4790.664653474223;4833.226683730586;4901.191303434894;4905.705657660552;4922.064807686528;4961.404631444249;4932.506749325039;4982.875428114181;4985.501449854985;5009.849704508871;5024.070546948826;4858.708477491362;4873.634477414279;4881.950380668173;4882.218844984785;4935.6051515877925;4772.7136371817805;4804.615630749462;4832.299316599144;4877.341558889504;4881.422040028581;4784.928226076542;4790.592799612072;4807.543283388072;4823.204171311694;4849.811796109976;4874.293227481924;4882.633802464758;4892.339534162842;4906.705597664151;4909.656324057281;4695.483496815279;4774.522547745337;4796.832110876103;4859.246816743411;4859.854204373874 16:18:48 INFO - PROCESS | 17210 | |1;ext.html;512.6616433154119;538.5072658517457;557.5762420560372;559.5355854640648;570.8030729398358;26575;27065.188044358678;37536.436953445686;38134;38212.23575528488;42414;43034.56965430345;43106.784466077705;43116;43132.56867431325;7875.8031049223655;8060.476069055492;8063.314618257456;8064.395170362217;8070.192980701912;7894.7236846710375;8011.399145064143;8028;8029.437939344249;8035.357171426301;8002.159773223786;8024.879626805603;8067.677292908276;8070.192980701941;8076.4750291230885;7954.761357159295;7970.4819186752675;8017.158198389202;8024.478408903403;8027.839443211103;7914.089879663855;8037.35701143907;8045.517268963822;8045.839083218361;8051.838963220703;37948.43077353842;38390.23219535621;38461.23077538462;38466.23067538634;38551.807240963615;3147.2603938074535;3184.379046086014;3243.562119113913;3324.850381732828;3524.1718196223865;29292;29648.555271670943;30188.54717179244;30475.08574742739;30576.08271751851;3450.1547120955274;3492.4237500812337;3576.2847430514003;3670.6696397324367;3678.981605091984;187545;188560;188688;188689.0565547177;188735.05632471887;43053.78473107614;43444.56555434405;54274.45725542694;54655.72672136614;54818.451815482134;41676.791616042334;41691.1661766763;41783;41801.163976720294;41814.79092604518;11614.535418583331;11655.184137110491;11664.6500604982;11712;11715.824262636068;9217.032211617683;9256.676016339396;9265.166135047743;9267.536623168815;9272.675456358995;14380.640483987774;14399.280035998157;14962.551123466095;14982.101073935599;15120.470783522524;5832.24180856486;5912.733926973297;5927.911081333784;5966.85082872923;6014.398560143951;867.7310033889514;926.4163576946615;929.772205809581;948.1987720376271;976.3507267666922;26793.598096028574;27934.720652793618;28385.43229135447;28477.71522284792;28494.145175644764;863.6070587882498;986.3292960786733;1020.8723909511311;1023.1763430438419;1089.3355053417408;12590.307533085585;13081.607551773463;13225.338733063309;13325.866741332657;13335.799963000563;215867;218821;218968;219124;219400;43941.12117757627;44689.77655111704;44690.10619787586;44818.77590612026;44860.77569612131;1195.1096433157354;1220.9145359824904;1222.407132540717;1243.1360204657676;1247.1768632702374;24575;25031.74968250294;25441.74558254394;25572.10497632574;26338;38525.6147438522;44588.55411445844;45552.316715248635;45692.31461528146;45748.771256143504;266773;271328;273775;274927;276051;33683;39650.801745991084;40189.59810401976;40287.79856100818;41132.47542770233;38734.2253154941;39801.40297895476;40197.79901100476;40216.1956760869;40669.389959150045;34233.432492563654;34961.82519087388;35602.82198589094;35617.46573801447;36208;34806;34879.47680784841;35114.824425877705;35230;35391.46912796362;34392.31215375729;34792;35110.473342899364;35135;35196.47205291872;31250.531242030935;31913.20216994501;31932.680673192972;32072.198195045312;32262.516062259554;23968.64047039261;24550.50898982046;24760.628590571516;25023.12419065324;25134 16:18:48 INFO - PROCESS | 17210 | |2;jquery.html;330.1712701120188;342.90912908079366;343.8280859570215;347.9704225140863;353.4786190369204;14835.851641483581;15130.697386052287;15733.370665173394;15831.208439578033;15844.683106337867;15803.288852001659;15943;16175.919120404411;16216.83783162171;16221.675566488662;4926.408830940283;5075.553467261831;5168.095583272931;5173.508516690908;5179.818706345279;4882;5082.898342033157;5094.77073531692;5094.898102037957;5096.184610462326;4982.57648099912;5011.398632164127;5023.372078490189;5043.96598697268;5044.82343117991;4861.222204447289;5019.297298378212;5114.181730923072;5115.360579927509;5116.692998420107;4547.340635607851;4562.771861406916;4567.794449249792;4569.840055598038;4583.9083218335445;10831.891681083167;11313.35956286334;11320.377379244139;11328.150388720796;18651.06744662775;1867.0478056191305;1895.1377123408815;1930.8358789502909;1949.87325823821;2000.29989503674;8640.524771137585;9054.86417703735;10051.497425128715;10112.696619101438;12320;1751.2557163205713;1755.806861245262;1762.4448298785842;1779.359430604981;1800.5138612574663;55546;56671;56730;57375.71312143496;60862.695686521285;9716.659916903016;9911;9973.950130249303;10029.949850250701;10155.898441015495;12809.103362764703;12880.613581592379;12885.098043137077;12937.288449135387;12949.741005180033;6519.967400163064;6520.315366886409;6603;6730.427913627299;6806.8298292542095;6027.186329845415;6063.211782468251;6163.137160797492;6187.690615469209;6218.160548325918;4287.678424118204;4354.303311470149;4365.1051534436;4378.934315985262;4463.7991290391365;1776.4049043570549;1776.5203395083256;1785.526940274279;1792.4712209898112;1835.8347748702681;838.3215626074633;846.3821410370464;859.6819176904586;862.969796057135;893.6336102198068;15253.771193432107;15708;15812.130332831575;15881;15955.20223988796;873.5850471026339;876.4565969099071;887.9600417981206;894.3650008493912;959.6833045095102;6437.420632143129;9082.954585227031;9125.45247285165;9145;9268.073192680678;429899;432156;436414;439898;448992;67180.32819671839;68994.65502672555;68996;70844.2915570848;71104;879.7800549862534;889.301898010059;905.8731777551149;911.098012967171;938.6996161228342;13981.300934953008;14190.219537925514;14209.644758881112;14292.142471451747;14571.781423278871;31922.36155276928;32362;32615.347693045533;32951.67048329486;33608;45734.771326143156;45920.770396147804;45954.54045459636;45976.540234597225;46079.53920460887;6937.410320122644;6995.230524642387;7033.366996970092;7038.788836334918;7079.575225486487;9510.904890951002;10835.729106772395;11070.612528561784;11269.323840569592;11276.154288428237;4223.260929337415;9086.954565227132;9576.425414475154;9750.21998240125;10096.627292586383;9285.117913798178;9441.52792360393;9533.618655253713;9724.854127187957;9816.214702823614;9473.905260947302;9745.12293893553;9937.850932235877;10068.748281293027;10191.439470829175;7118.216996130318;7155.570665760071;7180.461465390221;7320.341169294789;7412.96293518529;10041.799164016533;10090.545925433225;10128.79742405133;10136.18910487174;10162.644307449204 16:18:48 INFO - PROCESS | 17210 | |3;mootools.html;1069.433200403786;1082.5128692088563;1186.715188354795;1280.8911242544384;1545.5440645009721;6205.968970155149;6761.2900645432255;6895.138107736533;6911.550749201311;6923.342282483169;6809.863802723942;6973.721051157948;6978.0928479297745;6979.895301570467;6982.650867456619;2182.8144607708364;2202.7797220278003;2212.0156530343925;2213.4134454369523;2213.9335819925427;2110.9366718998454;2139.967900481486;2149.6453085240914;2165.9133634654595;2172.283146561631;2123.883186424746;2131.2007997001124;2154.041451554059;2162.945926351846;2249.4263962689574;2236.865788052714;2242.831787615927;2244.371575958734;2245.214175038723;2245.2927327891744;2160.5786871560053;2204.382772823612;2204.5921504521552;2205.856619319739;2209.723784526934;7133.251008644122;7165.068541089677;7174.784756457315;7180.964095179491;7181.066461360042;4360.062586543908;4456.286994080931;4458.264386376277;4462.419885414908;4484.148011877733;2882.1641723900043;2925.9853700731574;2969.4803409403266;2972.1083674897445;3004.669486356499;899.1503029636996;929.9863149167372;943.1652987106391;956.7464621875208;958.8945216026232;9443.763905902339;9444.669436569688;9444.669436569688;9455.669051583161;9463.195628371597;4036.6972477064337;4076.429299897957;4080.693947953856;4081.4898137732785;4083.387491876183;8170.959145204236;8218;8224.794380140425;8231.46495477792;8249.505029698237;4386.1008493258805;4389.29771236607;4404.6035856772405;4406.184855801687;4407.074514351958;3479.408500554861;3906.2187562487616;3983.143624120828;4027;4028.6575641070835;3458.8270586470576;3507.4212754895666;3532.6643968822923;3554.306910152495;3555.235624340779;1140.5722853929776;1141.1612464838338;1147.6614398752222;1153.3195414705365;1162.2096974057554;997.8253805583994;1018.4551265073151;1019.9643012494527;1094.5020015892749;1227.3433712963522;6630.1049358336;6651.63416012124;6655.600663960178;6667.233268174125;6668.466522678174;452.7147896824979;460.8502236773062;462.45199438665287;464.2224274340466;464.7954899844058;5251.369835619674;5258.2638430619745;5270.130428479258;5270.262163297141;5285.07511185541;8323.750287491384;8568.400211985101;8584.227419532272;8589.26991205742;8606.397552171287;8377.120402357787;8377.246047855722;8419;8435.95782021086;8447.619857106445;6567.277599464055;6713.597184168868;6751.358620931003;6774.762883299061;6781.152355955505;6419.197600299963;6448.387403196689;6448.903266450913;6449.871002580016;6483.837904052436;7316.853662926818;7521.699132034876;7609.961950190213;7625.8856117157175;7697.498987697345;7677.8464430709955;7995.040595128622;7998.080220774453;8020.318272946864;8024.9598752008205;5429.864253393696;5585.944140558542;5910.852228694317;6093.238345206849;6162.352952940056;6603.174603174603;6614.900776488453;6653.135092438146;6655.900161497679;6663.666816659244;5875.6474611523445;6019.067044608093;6020.1270815730595;6025.457708806229;6038.094285856981;5891.351951285269;6020.548458865515;6058.454739073504;6101.450869421773;6136.478399336106;6270.341614130633;6321.683915804099;6328.525360597881;6337.493000560036;6338.049292606146;5805.883882322414;5868.295804503487;5868.94131058684;5876.647401155944;5878.735456904535;5893.322267939242;5941.1088336749835;6065.484433823174;6087.269527656709;6132.9080063799975 16:18:48 INFO - PROCESS | 17210 | |4;prototype.html;295.3885457103795;299.7931427315152;299.8365890589628;301.5311191097842;303.39775545542096;5258.342707161605;5268.288781014562;5271.65734227275;5295.655782374143;5298.390685071218;5223.112070947938;5229.849433124716;5232.92150617741;5235.79056837727;5237.5548078413285;3889.2804831106264;3969.2260009298197;4045.312296909518;4085.9387109193385;4086.83652653895;4062.7608579383277;4084.060666046811;4087.8569250076253;4090.1615168890307;4096.037431203665;3860.112174199936;4051.3922911563354;4051.7366371185926;4053.9797301013455;4056.7363121397016;3950.249452603996;4037.394390841368;4041.4341992121126;4048.6153815387343;4051.0480037191237;3533.293341331744;3536.0099172231817;3542.4332106863035;3549.236914063463;3554.5556805399324;4965.776540055706;5000.374953130859;5002.224655178453;5006.849794506171;5010.674306170124;4658.767061646938;4660.720356778605;4662.184117779409;4666.043461090469;4668.346431499593;5428.348598168245;5447.863803404907;5470.91793623096;5489.64317319373;5490.478404551562;3896.5908579599018;3899.220155968789;3901.2782635212293;3903.33643280643;3905.3946638271113;5549.833504994856;5726.68503232322;5732.856678583027;5736.8852622947725;5739.196512488255;3807.6192380762254;3867.651911327994;3867.9749866285456;3871.399933010388;3872.1094148346037;3931.351327031065;3970.5433875104154;3972.0467087899274;3974.3839704845795;3978.522577290744;4540.228161212602;4567.725936443824;4567.748773817472;4578.267477203632;4578.2903649934315;5495.670259784426;5505.064139096363;5505.421930697299;5508.724563771795;5512.834614961557;1378.30395650198;1405.2411697683342;1406.339020660288;1406.5920882944035;1408.0214251095595;908.2597682888425;942.1050002497518;946.3186505716011;960.6109525642127;969.4231932000448;4842.58837998767;4847.418309802846;4857.9028419432125;4864.051509955525;4873.171560834667;5661.065924122556;5661.207430959669;5664.150377443334;5665.773369065274;5671.1493276008105;4848.151573474628;4857.489963553847;4857.587105096107;4860.927086093711;4864.173090574611;3011.864466099031;3039.498482750366;3044.4367791958557;3046.2688954650725;3047.405755877627;5361.731913404392;5393.056215162409;5395.865103372447;5396.4603539646505;5400.486953739389;5617.269754931833;5788.82633520995;5797.4782269595935;5798.88402231953;5806.44838740319;5350.250964864922;5369.543588794996;5380;5382.434844341366;5382.4886635769535;5662.150677398258;5667.20659107717;5668.121441176624;5675.460831221028;5676.68778217202;5539.390667026704;5544.251526043932;5544.500994910478;5545.972270138624;5549.750261238173;5360.758765855468;5368.7852485901685;5369.140937449989;5373.301470808769;5384.730763461889;3822.9235415292096;3916.4908561886773;3925.313070212644;3933.8033098344395;3933.9606603933594;5465.371482279589;5574.86062848432;5601.859953501195;5632.464915833153;5638.23883775685;5548.722563871871;5550.306211723535;5553.416891226363;5554.694491802989;5566.582506311962;5531.695756733418;5541.889162216652;5543.584231182596;5546.528545073714;5554.944450555605;5459.754311056092;5460.972695136657;5466.535344495604;5466.808661696821;5467.699276539669;5566.415526369673;5574.832755017356;5583.860403489945;5588.497035266845;5595.916061259003;5279.894402112013;5447.673139611636;5448.891022179455;5455.918161227505;5458.072127738374 16:18:48 INFO - PROCESS | 17210 | |5;yui.html;684.8390628202374;748.7080038784878;764.7629234937172;764.9426293028024;777.4130531448759;12260.509579616804;12393.946514546253;12464.25214487129;12483.5006599736;12513.687157821036;11709.70725731857;12804.871951280484;12818;12818.038647101457;12828.358582070905;638.9073584330292;771.5717776633966;782.3037496628006;792.6155814429997;805.4764403137949;807.1605530248535;809.0978558906835;812.5003123079293;812.585581353511;812.6424373275739;847.3941132090554;849.0193826130798;849.5285116760195;849.9787505312386;849.9927585810834;658.9670516474181;832.0597724571256;842.7429633961639;845.6913226672282;847.2798121596655;616.0512810272176;617.7127635649445;619.0343064818896;619.4610688700814;620.5811077522654;12928.28894410807;13002.804957925639;13034.608961731163;13035.86964130356;13059.085863989525;11903;12007.57973470933;12088.456019479145;12389.876101238962;12554;10628.14974802014;10807.081398081173;10810.891532679529;10838.67483975482;11249.100071994302;3319.5020746887917;3355.1612096975755;3365.7307415406954;3378.2567835076243;3438.7420943429343;40707.592924070974;41193.58806411928;41375.1724965502;41479.1704165918;41615.583844161476;9676.758081047888;9725.221982241404;9812.90187098134;9840.311178217598;9895.505224738734;16642.3343066276;16647.91676041612;16650.666986660442;16654.83345166557;16660.6667866642;6587.538872278895;6615.4046135848;6660.800175994631;6690.933090669031;6908.723651054002;3751.718621103428;3853.2678791029616;3869.380899056194;3893.5717071122153;3978.8209530571194;2853.429314137181;2860.4708128996203;2861.484932712132;2863.7565806906227;2882.956755648667;500.7352064539184;508.6261597725669;522.0498692379832;524.8346770767196;541;458.63767623577667;475.4413564062213;488.8899997500534;577.9133130030445;585.7071464267866;7461.291177338144;7490.1386340571535;7873.645685944146;7881.211878812188;8019.39854510914;536.1154095741979;553.8947599955995;558.9469000444951;570.891530609183;577.413924866261;3363.428217203081;3554.4668299755244;3621.94567081494;3667.1198912261398;3713.721470889694;45975;50596.747016264686;50975.49024509782;51013.744931275105;51019.23471147936;40106.197876042315;40222.195556088715;40465.59534404618;40541.59458405437;40751.388729169084;37165.814170929516;37195.07012324713;37240.813795930844;37802;41356.37965430521;8430.15698430152;8477.660893564189;8496.915030849612;8585.8712119317;8675.219230269306;30443.39113217679;30714;31292;31345;31371.21571960628;35172.29655406826;36384.81807591051;38819.2236155281;39254.4111838317;39480.60519394769;10867.565297388015;10884.51019704131;10937;11063;11085.168612354268;11632.11312237469;11730.882691173321;11902.761944761229;11983.150095602252;12057.57798477049;10665.89334106649;10808.729781755519;10902;11101.666949991513;11396.94301528487;11258.549658013588;11648.941755291507;11650.417479125841;11668.766624667629;11678.591249306233;10144.746381340525;10268.897311026794;10361.11930485887;10478.37129772216;10719.839202411815;9076.228520575825;9115.635374584943;9198.908010920073;9269.860952085859;9651.71044868655;9306.767330816783;9629.903700962901;9666.468344241135;9700;9747.951260243653 16:18:48 INFO - PROCESS | 17210 | __end_tp_report 16:18:48 INFO - PROCESS | 17210 | __start_cc_report 16:18:48 INFO - PROCESS | 17210 | _x_x_mozilla_cycle_collect,899 16:18:48 INFO - PROCESS | 17210 | __end_cc_report 16:18:48 INFO - PROCESS | 17210 | __startTimestamp1458602328113__endTimestamp 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - PROCESS | 17210 | ------- Summary: start ------- 16:18:48 INFO - PROCESS | 17210 | Number of tests: 6 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - PROCESS | 17210 | [#0] dojo.html Cycles:165 Average:4615.33 Median:4740.12 stddev:465.51 (9.8%) stddev-sans-first:439.27 16:18:48 INFO - PROCESS | 17210 | Values: 2600.1 2647.6 2674.1 2678.5 2702.9 4539.6 4617.7 4639.4 4642.2 4670.9 4636.7 4684.7 4690.6 4713.2 4781.3 4313.5 4322.7 4329.1 4348.1 4487.8 4219.2 4390.3 4410.1 4449.7 4473.2 4258.6 4274.2 4297.3 4355.8 4360.6 4272.3 4275.3 4289.8 4313.1 4317.7 4200.7 4247.4 4268.0 4300.8 4316.0 4594.8 4613.0 4667.5 4674.2 4674.4 4933.9 4943.3 4946.4 4999.8 5001.7 4905.3 4974.6 4980.2 4983.4 4984.6 4637.7 4651.8 4687.9 4734.4 4734.5 5067.7 5077.0 5079.8 5081.4 5136.5 4778.0 4854.9 4859.3 4860.1 4873.4 4926.1 4939.2 4947.5 4968.8 4983.7 4888.3 4898.9 4899.3 4905.9 4950.5 4784.6 4820.9 4875.2 4887.9 4948.4 4216.6 4220.6 4221.8 4245.7 4265.7 3691.5 3697.2 3707.2 3733.1 3744.5 4243.9 4316.4 4334.6 4345.6 4419.0 5027.7 5046.9 5048.2 5049.5 5063.0 4371.2 4375.2 4378.6 4379.0 4412.9 4385.6 4462.4 4470.6 4470.9 4524.8 4654.8 4688.6 4702.9 4710.5 4713.3 4990.4 5030.0 5072.4 5075.9 5080.4 4732.6 4736.7 4740.1 4745.9 4790.7 4833.2 4901.2 4905.7 4922.1 4961.4 4932.5 4982.9 4985.5 5009.8 5024.1 4858.7 4873.6 4882.0 4882.2 4935.6 4772.7 4804.6 4832.3 4877.3 4881.4 4784.9 4790.6 4807.5 4823.2 4849.8 4874.3 4882.6 4892.3 4906.7 4909.7 4695.5 4774.5 4796.8 4859.2 4859.9 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - PROCESS | 17210 | [#1] ext.html Cycles:180 Average:39010.00 Median:20607.71 stddev:59609.76 (289.3%) stddev-sans-first:59706.89 16:18:48 INFO - PROCESS | 17210 | Values: 512.7 538.5 557.6 559.5 570.8 26575.0 27065.2 37536.4 38134.0 38212.2 42414.0 43034.6 43106.8 43116.0 43132.6 7875.8 8060.5 8063.3 8064.4 8070.2 7894.7 8011.4 8028.0 8029.4 8035.4 8002.2 8024.9 8067.7 8070.2 8076.5 7954.8 7970.5 8017.2 8024.5 8027.8 7914.1 8037.4 8045.5 8045.8 8051.8 37948.4 38390.2 38461.2 38466.2 38551.8 3147.3 3184.4 3243.6 3324.9 3524.2 29292.0 29648.6 30188.5 30475.1 30576.1 3450.2 3492.4 3576.3 3670.7 3679.0 187545.0 188560.0 188688.0 188689.1 188735.1 43053.8 43444.6 54274.5 54655.7 54818.5 41676.8 41691.2 41783.0 41801.2 41814.8 11614.5 11655.2 11664.7 11712.0 11715.8 9217.0 9256.7 9265.2 9267.5 9272.7 14380.6 14399.3 14962.6 14982.1 15120.5 5832.2 5912.7 5927.9 5966.9 6014.4 867.7 926.4 929.8 948.2 976.4 26793.6 27934.7 28385.4 28477.7 28494.1 863.6 986.3 1020.9 1023.2 1089.3 12590.3 13081.6 13225.3 13325.9 13335.8 215867.0 218821.0 218968.0 219124.0 219400.0 43941.1 44689.8 44690.1 44818.8 44860.8 1195.1 1220.9 1222.4 1243.1 1247.2 24575.0 25031.7 25441.7 25572.1 26338.0 38525.6 44588.6 45552.3 45692.3 45748.8 266773.0 271328.0 273775.0 274927.0 276051.0 33683.0 39650.8 40189.6 40287.8 41132.5 38734.2 39801.4 40197.8 40216.2 40669.4 34233.4 34961.8 35602.8 35617.5 36208.0 34806.0 34879.5 35114.8 35230.0 35391.5 34392.3 34792.0 35110.5 35135.0 35196.5 31250.5 31913.2 31932.7 32072.2 32262.5 23968.6 24550.5 24760.6 25023.1 25134.0 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - PROCESS | 17210 | [#2] jquery.html Cycles:180 Average:24228.80 Median:45965.54 stddev:71687.93 (156.0%) stddev-sans-first:71866.58 16:18:48 INFO - PROCESS | 17210 | Values: 330.2 342.9 343.8 348.0 353.5 14835.9 15130.7 15733.4 15831.2 15844.7 15803.3 15943.0 16175.9 16216.8 16221.7 4926.4 5075.6 5168.1 5173.5 5179.8 4882.0 5082.9 5094.8 5094.9 5096.2 4982.6 5011.4 5023.4 5044.0 5044.8 4861.2 5019.3 5114.2 5115.4 5116.7 4547.3 4562.8 4567.8 4569.8 4583.9 10831.9 11313.4 11320.4 11328.2 18651.1 1867.0 1895.1 1930.8 1949.9 2000.3 8640.5 9054.9 10051.5 10112.7 12320.0 1751.3 1755.8 1762.4 1779.4 1800.5 55546.0 56671.0 56730.0 57375.7 60862.7 9716.7 9911.0 9974.0 10029.9 10155.9 12809.1 12880.6 12885.1 12937.3 12949.7 6520.0 6520.3 6603.0 6730.4 6806.8 6027.2 6063.2 6163.1 6187.7 6218.2 4287.7 4354.3 4365.1 4378.9 4463.8 1776.4 1776.5 1785.5 1792.5 1835.8 838.3 846.4 859.7 863.0 893.6 15253.8 15708.0 15812.1 15881.0 15955.2 873.6 876.5 888.0 894.4 959.7 6437.4 9083.0 9125.5 9145.0 9268.1 429899.0 432156.0 436414.0 439898.0 448992.0 67180.3 68994.7 68996.0 70844.3 71104.0 879.8 889.3 905.9 911.1 938.7 13981.3 14190.2 14209.6 14292.1 14571.8 31922.4 32362.0 32615.3 32951.7 33608.0 45734.8 45920.8 45954.5 45976.5 46079.5 6937.4 6995.2 7033.4 7038.8 7079.6 9510.9 10835.7 11070.6 11269.3 11276.2 4223.3 9087.0 9576.4 9750.2 10096.6 9285.1 9441.5 9533.6 9724.9 9816.2 9473.9 9745.1 9937.9 10068.7 10191.4 7118.2 7155.6 7180.5 7320.3 7413.0 10041.8 10090.5 10128.8 10136.2 10162.6 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - PROCESS | 17210 | [#3] mootools.html Cycles:180 Average:4940.27 Median:5980.09 stddev:2524.74 (42.2%) stddev-sans-first:2515.05 16:18:48 INFO - PROCESS | 17210 | Values: 1069.4 1082.5 1186.7 1280.9 1545.5 6206.0 6761.3 6895.1 6911.6 6923.3 6809.9 6973.7 6978.1 6979.9 6982.7 2182.8 2202.8 2212.0 2213.4 2213.9 2110.9 2140.0 2149.6 2165.9 2172.3 2123.9 2131.2 2154.0 2162.9 2249.4 2236.9 2242.8 2244.4 2245.2 2245.3 2160.6 2204.4 2204.6 2205.9 2209.7 7133.3 7165.1 7174.8 7181.0 7181.1 4360.1 4456.3 4458.3 4462.4 4484.1 2882.2 2926.0 2969.5 2972.1 3004.7 899.2 930.0 943.2 956.7 958.9 9443.8 9444.7 9444.7 9455.7 9463.2 4036.7 4076.4 4080.7 4081.5 4083.4 8171.0 8218.0 8224.8 8231.5 8249.5 4386.1 4389.3 4404.6 4406.2 4407.1 3479.4 3906.2 3983.1 4027.0 4028.7 3458.8 3507.4 3532.7 3554.3 3555.2 1140.6 1141.2 1147.7 1153.3 1162.2 997.8 1018.5 1020.0 1094.5 1227.3 6630.1 6651.6 6655.6 6667.2 6668.5 452.7 460.9 462.5 464.2 464.8 5251.4 5258.3 5270.1 5270.3 5285.1 8323.8 8568.4 8584.2 8589.3 8606.4 8377.1 8377.2 8419.0 8436.0 8447.6 6567.3 6713.6 6751.4 6774.8 6781.2 6419.2 6448.4 6448.9 6449.9 6483.8 7316.9 7521.7 7610.0 7625.9 7697.5 7677.8 7995.0 7998.1 8020.3 8025.0 5429.9 5585.9 5910.9 6093.2 6162.4 6603.2 6614.9 6653.1 6655.9 6663.7 5875.6 6019.1 6020.1 6025.5 6038.1 5891.4 6020.5 6058.5 6101.5 6136.5 6270.3 6321.7 6328.5 6337.5 6338.0 5805.9 5868.3 5868.9 5876.6 5878.7 5893.3 5941.1 6065.5 6087.3 6132.9 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - PROCESS | 17210 | [#4] prototype.html Cycles:180 Average:4556.61 Median:5263.32 stddev:1339.40 (25.4%) stddev-sans-first:1304.41 16:18:48 INFO - PROCESS | 17210 | Values: 295.4 299.8 299.8 301.5 303.4 5258.3 5268.3 5271.7 5295.7 5298.4 5223.1 5229.8 5232.9 5235.8 5237.6 3889.3 3969.2 4045.3 4085.9 4086.8 4062.8 4084.1 4087.9 4090.2 4096.0 3860.1 4051.4 4051.7 4054.0 4056.7 3950.2 4037.4 4041.4 4048.6 4051.0 3533.3 3536.0 3542.4 3549.2 3554.6 4965.8 5000.4 5002.2 5006.8 5010.7 4658.8 4660.7 4662.2 4666.0 4668.3 5428.3 5447.9 5470.9 5489.6 5490.5 3896.6 3899.2 3901.3 3903.3 3905.4 5549.8 5726.7 5732.9 5736.9 5739.2 3807.6 3867.7 3868.0 3871.4 3872.1 3931.4 3970.5 3972.0 3974.4 3978.5 4540.2 4567.7 4567.7 4578.3 4578.3 5495.7 5505.1 5505.4 5508.7 5512.8 1378.3 1405.2 1406.3 1406.6 1408.0 908.3 942.1 946.3 960.6 969.4 4842.6 4847.4 4857.9 4864.1 4873.2 5661.1 5661.2 5664.2 5665.8 5671.1 4848.2 4857.5 4857.6 4860.9 4864.2 3011.9 3039.5 3044.4 3046.3 3047.4 5361.7 5393.1 5395.9 5396.5 5400.5 5617.3 5788.8 5797.5 5798.9 5806.4 5350.3 5369.5 5380.0 5382.4 5382.5 5662.2 5667.2 5668.1 5675.5 5676.7 5539.4 5544.3 5544.5 5546.0 5549.8 5360.8 5368.8 5369.1 5373.3 5384.7 3822.9 3916.5 3925.3 3933.8 3934.0 5465.4 5574.9 5601.9 5632.5 5638.2 5548.7 5550.3 5553.4 5554.7 5566.6 5531.7 5541.9 5543.6 5546.5 5554.9 5459.8 5461.0 5466.5 5466.8 5467.7 5566.4 5574.8 5583.9 5588.5 5595.9 5279.9 5447.7 5448.9 5455.9 5458.1 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - PROCESS | 17210 | [#5] yui.html Cycles:180 Average:12323.39 Median:40343.90 stddev:13343.72 (33.1%) stddev-sans-first:13352.53 16:18:48 INFO - PROCESS | 17210 | Values: 684.8 748.7 764.8 764.9 777.4 12260.5 12393.9 12464.3 12483.5 12513.7 11709.7 12804.9 12818.0 12818.0 12828.4 638.9 771.6 782.3 792.6 805.5 807.2 809.1 812.5 812.6 812.6 847.4 849.0 849.5 850.0 850.0 659.0 832.1 842.7 845.7 847.3 616.1 617.7 619.0 619.5 620.6 12928.3 13002.8 13034.6 13035.9 13059.1 11903.0 12007.6 12088.5 12389.9 12554.0 10628.1 10807.1 10810.9 10838.7 11249.1 3319.5 3355.2 3365.7 3378.3 3438.7 40707.6 41193.6 41375.2 41479.2 41615.6 9676.8 9725.2 9812.9 9840.3 9895.5 16642.3 16647.9 16650.7 16654.8 16660.7 6587.5 6615.4 6660.8 6690.9 6908.7 3751.7 3853.3 3869.4 3893.6 3978.8 2853.4 2860.5 2861.5 2863.8 2883.0 500.7 508.6 522.0 524.8 541.0 458.6 475.4 488.9 577.9 585.7 7461.3 7490.1 7873.6 7881.2 8019.4 536.1 553.9 558.9 570.9 577.4 3363.4 3554.5 3621.9 3667.1 3713.7 45975.0 50596.7 50975.5 51013.7 51019.2 40106.2 40222.2 40465.6 40541.6 40751.4 37165.8 37195.1 37240.8 37802.0 41356.4 8430.2 8477.7 8496.9 8585.9 8675.2 30443.4 30714.0 31292.0 31345.0 31371.2 35172.3 36384.8 38819.2 39254.4 39480.6 10867.6 10884.5 10937.0 11063.0 11085.2 11632.1 11730.9 11902.8 11983.2 12057.6 10665.9 10808.7 10902.0 11101.7 11396.9 11258.5 11648.9 11650.4 11668.8 11678.6 10144.7 10268.9 10361.1 10478.4 10719.8 9076.2 9115.6 9198.9 9269.9 9651.7 9306.8 9629.9 9666.5 9700.0 9748.0 16:18:48 INFO - PROCESS | 17210 | -------- Summary: end -------- 16:18:48 INFO - PROCESS | 17210 | 16:18:48 INFO - TEST-INFO | 17210: exit 0 16:18:48 INFO - TEST-OK | dromaeo_css | took 1116963ms 16:18:48 INFO - TEST-START | kraken 16:18:48 INFO - operating with platform_type : linux_ 16:18:48 INFO - Initialising browser for kraken test... 16:18:48 INFO - TEST-INFO | started process 17395 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpzwbbcp/profile http://localhost:35222/getInfo.html) 16:18:53 INFO - PROCESS | 17395 | __metrics Screen width/height:1600/1200 16:18:53 INFO - PROCESS | 17395 | colorDepth:24 16:18:53 INFO - PROCESS | 17395 | Browser inner width/height: 1024/697 16:18:53 INFO - PROCESS | 17395 | __metrics 16:18:54 ERROR - PROCESS | 17395 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 16:18:54 INFO - PROCESS | 17395 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 16:18:55 INFO - TEST-INFO | 17395: exit 0 16:18:55 INFO - Browser initialized. 16:18:55 INFO - Running cycle 1/1 for kraken test... 16:18:55 INFO - TEST-INFO | started process 17477 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpzwbbcp/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:19:07 INFO - PROCESS | 17477 | RSS: Main: 157589504 16:19:07 INFO - PROCESS | 17477 | 16:19:09 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:35222/tests/kraken/driver.html?testName=audio-beat-detection) 16:19:10 INFO - PROCESS | 17477 | RSS: Main: 198684672 16:19:10 INFO - PROCESS | 17477 | 16:19:13 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:35222/tests/kraken/driver.html?testName=audio-dft) 16:19:13 INFO - PROCESS | 17477 | RSS: Main: 188125184 16:19:13 INFO - PROCESS | 17477 | 16:19:16 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:35222/tests/kraken/driver.html?testName=audio-fft) 16:19:17 INFO - PROCESS | 17477 | RSS: Main: 173379584 16:19:17 INFO - PROCESS | 17477 | 16:19:19 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:35222/tests/kraken/driver.html?testName=audio-oscillator) 16:19:19 INFO - PROCESS | 17477 | RSS: Main: 175951872 16:19:19 INFO - PROCESS | 17477 | 16:19:22 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:35222/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:19:22 INFO - PROCESS | 17477 | RSS: Main: 176529408 16:19:22 INFO - PROCESS | 17477 | 16:19:25 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:35222/tests/kraken/driver.html?testName=imaging-darkroom) 16:19:26 INFO - PROCESS | 17477 | RSS: Main: 177356800 16:19:26 INFO - PROCESS | 17477 | 16:19:30 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:35222/tests/kraken/driver.html?testName=imaging-desaturate) 16:19:30 INFO - PROCESS | 17477 | RSS: Main: 177545216 16:19:30 INFO - PROCESS | 17477 | 16:19:33 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:35222/tests/kraken/driver.html?testName=json-parse-financial) 16:19:34 INFO - PROCESS | 17477 | RSS: Main: 178728960 16:19:34 INFO - PROCESS | 17477 | 16:19:35 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:35222/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:19:36 INFO - PROCESS | 17477 | RSS: Main: 190087168 16:19:36 INFO - PROCESS | 17477 | 16:19:38 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:35222/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:19:38 INFO - PROCESS | 17477 | RSS: Main: 186867712 16:19:38 INFO - PROCESS | 17477 | 16:19:40 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:35222/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:19:41 INFO - PROCESS | 17477 | RSS: Main: 197300224 16:19:41 INFO - PROCESS | 17477 | 16:19:44 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:35222/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:19:44 INFO - PROCESS | 17477 | RSS: Main: 202645504 16:19:44 INFO - PROCESS | 17477 | 16:19:47 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:35222/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:19:47 INFO - PROCESS | 17477 | RSS: Main: 201904128 16:19:47 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | Cycle 1(1): loaded http://localhost:35222/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:35222/tests/kraken/driver.html?testName=ai-astar) 16:19:49 INFO - PROCESS | 17477 | RSS: Main: 260988928 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | __start_tp_report 16:19:49 INFO - PROCESS | 17477 | _x_x_mozilla_page_load 16:19:49 INFO - PROCESS | 17477 | _x_x_mozilla_page_load_details 16:19:49 INFO - PROCESS | 17477 | |i|pagename|runs| 16:19:49 INFO - PROCESS | 17477 | |0;ai-astar;112;113;108;114;112;112;103;114;112;112 16:19:49 INFO - PROCESS | 17477 | |1;audio-beat-detection;156;129;153;161;131;152;162;132;175;130 16:19:49 INFO - PROCESS | 17477 | |2;audio-dft;162;164;162;163;162;161;163;164;161;161 16:19:49 INFO - PROCESS | 17477 | |3;audio-fft;77;72;94;92;73;73;73;109;97;73 16:19:49 INFO - PROCESS | 17477 | |4;audio-oscillator;94;96;142;93;93;96;143;93;93;136 16:19:49 INFO - PROCESS | 17477 | |5;imaging-gaussian-blur;117;117;116;117;117;118;117;118;117;117 16:19:49 INFO - PROCESS | 17477 | |6;imaging-darkroom;145;146;145;145;145;146;146;145;146;146 16:19:49 INFO - PROCESS | 17477 | |7;imaging-desaturate;95;95;96;95;95;96;95;96;96;95 16:19:49 INFO - PROCESS | 17477 | |8;json-parse-financial;69;70;71;69;69;70;69;78;67;66 16:19:49 INFO - PROCESS | 17477 | |9;json-stringify-tinderbox;64;65;64;64;65;64;64;64;65;70 16:19:49 INFO - PROCESS | 17477 | |10;stanford-crypto-aes;83;81;81;82;89;82;81;82;82;83 16:19:49 INFO - PROCESS | 17477 | |11;stanford-crypto-ccm;120;124;115;121;131;117;118;134;127;125 16:19:49 INFO - PROCESS | 17477 | |12;stanford-crypto-pbkdf2;139;129;138;143;139;128;132;142;138;133 16:19:49 INFO - PROCESS | 17477 | |13;stanford-crypto-sha256-iterative;68;67;66;67;68;66;65;67;68;66 16:19:49 INFO - PROCESS | 17477 | __end_tp_report 16:19:49 INFO - PROCESS | 17477 | __start_cc_report 16:19:49 INFO - PROCESS | 17477 | _x_x_mozilla_cycle_collect,1167 16:19:49 INFO - PROCESS | 17477 | __end_cc_report 16:19:49 INFO - PROCESS | 17477 | __startTimestamp1458602389660__endTimestamp 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | ------- Summary: start ------- 16:19:49 INFO - PROCESS | 17477 | Number of tests: 14 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#0] ai-astar Cycles:10 Average:111.20 Median:112.00 stddev:3.33 (3.0%) stddev-sans-first:3.52 16:19:49 INFO - PROCESS | 17477 | Values: 112.0 113.0 108.0 114.0 112.0 112.0 103.0 114.0 112.0 112.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#1] audio-beat-detection Cycles:10 Average:148.10 Median:154.50 stddev:16.43 (10.6%) stddev-sans-first:17.17 16:19:49 INFO - PROCESS | 17477 | Values: 156.0 129.0 153.0 161.0 131.0 152.0 162.0 132.0 175.0 130.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#2] audio-dft Cycles:10 Average:162.30 Median:162.50 stddev:1.16 (0.7%) stddev-sans-first:1.22 16:19:49 INFO - PROCESS | 17477 | Values: 162.0 164.0 162.0 163.0 162.0 161.0 163.0 164.0 161.0 161.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#3] audio-fft Cycles:10 Average:83.30 Median:75.00 stddev:13.46 (17.9%) stddev-sans-first:14.08 16:19:49 INFO - PROCESS | 17477 | Values: 77.0 72.0 94.0 92.0 73.0 73.0 73.0 109.0 97.0 73.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#4] audio-oscillator Cycles:10 Average:107.90 Median:93.00 stddev:22.48 (24.2%) stddev-sans-first:23.28 16:19:49 INFO - PROCESS | 17477 | Values: 94.0 96.0 142.0 93.0 93.0 96.0 143.0 93.0 93.0 136.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#5] imaging-gaussian-blur Cycles:10 Average:117.10 Median:117.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 16:19:49 INFO - PROCESS | 17477 | Values: 117.0 117.0 116.0 117.0 117.0 118.0 117.0 118.0 117.0 117.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#6] imaging-darkroom Cycles:10 Average:145.50 Median:146.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 16:19:49 INFO - PROCESS | 17477 | Values: 145.0 146.0 145.0 145.0 145.0 146.0 146.0 145.0 146.0 146.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#7] imaging-desaturate Cycles:10 Average:95.40 Median:95.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 16:19:49 INFO - PROCESS | 17477 | Values: 95.0 95.0 96.0 95.0 95.0 96.0 95.0 96.0 96.0 95.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#8] json-parse-financial Cycles:10 Average:69.80 Median:69.50 stddev:3.22 (4.6%) stddev-sans-first:3.41 16:19:49 INFO - PROCESS | 17477 | Values: 69.0 70.0 71.0 69.0 69.0 70.0 69.0 78.0 67.0 66.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#9] json-stringify-tinderbox Cycles:10 Average:64.90 Median:64.50 stddev:1.85 (2.9%) stddev-sans-first:1.94 16:19:49 INFO - PROCESS | 17477 | Values: 64.0 65.0 64.0 64.0 65.0 64.0 64.0 64.0 65.0 70.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#10] stanford-crypto-aes Cycles:10 Average:82.60 Median:82.00 stddev:2.37 (2.9%) stddev-sans-first:2.51 16:19:49 INFO - PROCESS | 17477 | Values: 83.0 81.0 81.0 82.0 89.0 82.0 81.0 82.0 82.0 83.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#11] stanford-crypto-ccm Cycles:10 Average:123.20 Median:124.50 stddev:6.18 (5.0%) stddev-sans-first:6.44 16:19:49 INFO - PROCESS | 17477 | Values: 120.0 124.0 115.0 121.0 131.0 117.0 118.0 134.0 127.0 125.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:136.10 Median:138.50 stddev:5.26 (3.8%) stddev-sans-first:5.47 16:19:49 INFO - PROCESS | 17477 | Values: 139.0 129.0 138.0 143.0 139.0 128.0 132.0 142.0 138.0 133.0 16:19:49 INFO - PROCESS | 17477 | 16:19:49 INFO - PROCESS | 17477 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.80 Median:67.00 stddev:1.03 (1.5%) stddev-sans-first:1.00 16:19:49 INFO - PROCESS | 17477 | Values: 68.0 67.0 66.0 67.0 68.0 66.0 65.0 67.0 68.0 66.0 16:19:49 INFO - PROCESS | 17477 | -------- Summary: end -------- 16:19:49 INFO - PROCESS | 17477 | 16:19:50 INFO - TEST-INFO | 17477: exit 0 16:19:50 INFO - TEST-OK | kraken | took 61729ms 16:19:50 INFO - SUITE-END | took 1178s 16:19:50 INFO - Completed test suite (00:19:38) 16:19:50 INFO - javascript benchmark 16:19:50 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2600.1419531554584, 2647.5896236083404, 2674.1175412114003, 2678.491086693528, 2702.9324266893327, 4539.614132798716, 4617.653675974307, 4639.4432668079835, 4642.187617166999, 4670.906581868365, 4636.721796692201, 4684.672072954894, 4690.601298889598, 4713.222318317474, 4781.330613714074, 4313.547077556843, 4322.654187664995, 4329.134173165364, 4348.108637729274, 4487.842925497608, 4219.177260434217, 4390.319500477431, 4410.095930334273, 4449.710768800018, 4473.2395492766145, 4258.595433433834, 4274.187904298205, 4297.333913243452, 4355.84754533593, 4360.585744354281, 4272.252355837747, 4275.315949448104, 4289.806958686867, 4313.072689371768, 4317.69776115672, 4200.7479551227025, 4247.447831781879, 4267.997020700164, 4300.827966881321, 4315.978420107911, 4594.770261486912, 4613.0, 4667.486576476585, 4674.228752255874, 4674.368960190399, 4933.876653083702, 4943.332650092228, 4946.356973593446, 4999.775010124553, 5001.724905130216, 4905.3132561441425, 4974.577160941324, 4980.203167493184, 4983.401991761012, 4984.601231901439, 4637.652176086807, 4651.790669419885, 4687.929681054787, 4734.360861283752, 4734.479207287196, 5067.670601410897, 5077.0, 5079.771410286546, 5081.441041485434, 5136.4606716295, 4777.95222047782, 4854.927176092361, 4859.319695242669, 4860.1251774680895, 4873.390826146731, 4926.113299606033, 4939.160342741742, 4947.455779864212, 4968.776405061781, 4983.6760610560195, 4888.26675998596, 4898.926516102261, 4899.2896030075435, 4905.9264111038365, 4950.529699678525, 4784.617230621542, 4820.855374338776, 4875.24433712775, 4887.853364399074, 4948.38145231846, 4216.599423054805, 4220.6412454941055, 4221.78891055446, 4245.724027938174, 4265.722728022669, 3691.53855768029, 3697.186618943828, 3707.2214834884976, 3733.0667333166707, 3744.494493243432, 4243.893902652459, 4316.352547117957, 4334.609885110355, 4345.630621397217, 4419.0, 5027.673201241908, 5046.924296135561, 5048.167052436307, 5049.520295571915, 5063.0380227756605, 4371.169477799208, 4375.212461756851, 4378.562143785596, 4379.0, 4412.933805992912, 4385.561443855653, 4462.419885414875, 4470.575295346936, 4470.888227794266, 4524.773761311922, 4654.790534425959, 4688.624910007123, 4702.929456058162, 4710.505396933409, 4713.269443236304, 4990.3762029746285, 5030.0, 5072.416672082758, 5075.898482030412, 5080.390353157644, 4732.621390288699, 4736.73947932867, 4740.1230772307235, 4745.928811067768, 4790.664653474223, 4833.226683730586, 4901.191303434894, 4905.705657660552, 4922.064807686528, 4961.404631444249, 4932.506749325039, 4982.875428114181, 4985.501449854985, 5009.849704508871, 5024.070546948826, 4858.708477491362, 4873.634477414279, 4881.950380668173, 4882.218844984785, 4935.6051515877925, 4772.7136371817805, 4804.615630749462, 4832.299316599144, 4877.341558889504, 4881.422040028581, 4784.928226076542, 4790.592799612072, 4807.543283388072, 4823.204171311694, 4849.811796109976, 4874.293227481924, 4882.633802464758, 4892.339534162842, 4906.705597664151, 4909.656324057281, 4695.483496815279, 4774.522547745337, 4796.832110876103, 4859.246816743411, 4859.854204373874], "unit": "score", "name": "dojo.html", "value": 4586.739662783638}, {"lowerIsBetter": false, "replicates": [512.6616433154119, 538.5072658517457, 557.5762420560372, 559.5355854640648, 570.8030729398358, 26575.0, 27065.188044358678, 37536.436953445686, 38134.0, 38212.23575528488, 42414.0, 43034.56965430345, 43106.784466077705, 43116.0, 43132.56867431325, 7875.8031049223655, 8060.476069055492, 8063.314618257456, 8064.395170362217, 8070.192980701912, 7894.7236846710375, 8011.399145064143, 8028.0, 8029.437939344249, 8035.357171426301, 8002.159773223786, 8024.879626805603, 8067.677292908276, 8070.192980701941, 8076.4750291230885, 7954.761357159295, 7970.4819186752675, 8017.158198389202, 8024.478408903403, 8027.839443211103, 7914.089879663855, 8037.35701143907, 8045.517268963822, 8045.839083218361, 8051.838963220703, 37948.43077353842, 38390.23219535621, 38461.23077538462, 38466.23067538634, 38551.807240963615, 3147.2603938074535, 3184.379046086014, 3243.562119113913, 3324.850381732828, 3524.1718196223865, 29292.0, 29648.555271670943, 30188.54717179244, 30475.08574742739, 30576.08271751851, 3450.1547120955274, 3492.4237500812337, 3576.2847430514003, 3670.6696397324367, 3678.981605091984, 187545.0, 188560.0, 188688.0, 188689.0565547177, 188735.05632471887, 43053.78473107614, 43444.56555434405, 54274.45725542694, 54655.72672136614, 54818.451815482134, 41676.791616042334, 41691.1661766763, 41783.0, 41801.163976720294, 41814.79092604518, 11614.535418583331, 11655.184137110491, 11664.6500604982, 11712.0, 11715.824262636068, 9217.032211617683, 9256.676016339396, 9265.166135047743, 9267.536623168815, 9272.675456358995, 14380.640483987774, 14399.280035998157, 14962.551123466095, 14982.101073935599, 15120.470783522524, 5832.24180856486, 5912.733926973297, 5927.911081333784, 5966.85082872923, 6014.398560143951, 867.7310033889514, 926.4163576946615, 929.772205809581, 948.1987720376271, 976.3507267666922, 26793.598096028574, 27934.720652793618, 28385.43229135447, 28477.71522284792, 28494.145175644764, 863.6070587882498, 986.3292960786733, 1020.8723909511311, 1023.1763430438419, 1089.3355053417408, 12590.307533085585, 13081.607551773463, 13225.338733063309, 13325.866741332657, 13335.799963000563, 215867.0, 218821.0, 218968.0, 219124.0, 219400.0, 43941.12117757627, 44689.77655111704, 44690.10619787586, 44818.77590612026, 44860.77569612131, 1195.1096433157354, 1220.9145359824904, 1222.407132540717, 1243.1360204657676, 1247.1768632702374, 24575.0, 25031.74968250294, 25441.74558254394, 25572.10497632574, 26338.0, 38525.6147438522, 44588.55411445844, 45552.316715248635, 45692.31461528146, 45748.771256143504, 266773.0, 271328.0, 273775.0, 274927.0, 276051.0, 33683.0, 39650.801745991084, 40189.59810401976, 40287.79856100818, 41132.47542770233, 38734.2253154941, 39801.40297895476, 40197.79901100476, 40216.1956760869, 40669.389959150045, 34233.432492563654, 34961.82519087388, 35602.82198589094, 35617.46573801447, 36208.0, 34806.0, 34879.47680784841, 35114.824425877705, 35230.0, 35391.46912796362, 34392.31215375729, 34792.0, 35110.473342899364, 35135.0, 35196.47205291872, 31250.531242030935, 31913.20216994501, 31932.680673192972, 32072.198195045312, 32262.516062259554, 23968.64047039261, 24550.50898982046, 24760.628590571516, 25023.12419065324, 25134.0], "unit": "score", "name": "ext.html", "value": 16616.386864282755}, {"lowerIsBetter": false, "replicates": [330.1712701120188, 342.90912908079366, 343.8280859570215, 347.9704225140863, 353.4786190369204, 14835.851641483581, 15130.697386052287, 15733.370665173394, 15831.208439578033, 15844.683106337867, 15803.288852001659, 15943.0, 16175.919120404411, 16216.83783162171, 16221.675566488662, 4926.408830940283, 5075.553467261831, 5168.095583272931, 5173.508516690908, 5179.818706345279, 4882.0, 5082.898342033157, 5094.77073531692, 5094.898102037957, 5096.184610462326, 4982.57648099912, 5011.398632164127, 5023.372078490189, 5043.96598697268, 5044.82343117991, 4861.222204447289, 5019.297298378212, 5114.181730923072, 5115.360579927509, 5116.692998420107, 4547.340635607851, 4562.771861406916, 4567.794449249792, 4569.840055598038, 4583.9083218335445, 10831.891681083167, 11313.35956286334, 11320.377379244139, 11328.150388720796, 18651.06744662775, 1867.0478056191305, 1895.1377123408815, 1930.8358789502909, 1949.87325823821, 2000.29989503674, 8640.524771137585, 9054.86417703735, 10051.497425128715, 10112.696619101438, 12320.0, 1751.2557163205713, 1755.806861245262, 1762.4448298785842, 1779.359430604981, 1800.5138612574663, 55546.0, 56671.0, 56730.0, 57375.71312143496, 60862.695686521285, 9716.659916903016, 9911.0, 9973.950130249303, 10029.949850250701, 10155.898441015495, 12809.103362764703, 12880.613581592379, 12885.098043137077, 12937.288449135387, 12949.741005180033, 6519.967400163064, 6520.315366886409, 6603.0, 6730.427913627299, 6806.8298292542095, 6027.186329845415, 6063.211782468251, 6163.137160797492, 6187.690615469209, 6218.160548325918, 4287.678424118204, 4354.303311470149, 4365.1051534436, 4378.934315985262, 4463.7991290391365, 1776.4049043570549, 1776.5203395083256, 1785.526940274279, 1792.4712209898112, 1835.8347748702681, 838.3215626074633, 846.3821410370464, 859.6819176904586, 862.969796057135, 893.6336102198068, 15253.771193432107, 15708.0, 15812.130332831575, 15881.0, 15955.20223988796, 873.5850471026339, 876.4565969099071, 887.9600417981206, 894.3650008493912, 959.6833045095102, 6437.420632143129, 9082.954585227031, 9125.45247285165, 9145.0, 9268.073192680678, 429899.0, 432156.0, 436414.0, 439898.0, 448992.0, 67180.32819671839, 68994.65502672555, 68996.0, 70844.2915570848, 71104.0, 879.7800549862534, 889.301898010059, 905.8731777551149, 911.098012967171, 938.6996161228342, 13981.300934953008, 14190.219537925514, 14209.644758881112, 14292.142471451747, 14571.781423278871, 31922.36155276928, 32362.0, 32615.347693045533, 32951.67048329486, 33608.0, 45734.771326143156, 45920.770396147804, 45954.54045459636, 45976.540234597225, 46079.53920460887, 6937.410320122644, 6995.230524642387, 7033.366996970092, 7038.788836334918, 7079.575225486487, 9510.904890951002, 10835.729106772395, 11070.612528561784, 11269.323840569592, 11276.154288428237, 4223.260929337415, 9086.954565227132, 9576.425414475154, 9750.21998240125, 10096.627292586383, 9285.117913798178, 9441.52792360393, 9533.618655253713, 9724.854127187957, 9816.214702823614, 9473.905260947302, 9745.12293893553, 9937.850932235877, 10068.748281293027, 10191.439470829175, 7118.216996130318, 7155.570665760071, 7180.461465390221, 7320.341169294789, 7412.96293518529, 10041.799164016533, 10090.545925433225, 10128.79742405133, 10136.18910487174, 10162.644307449204], "unit": "score", "name": "jquery.html", "value": 7672.954599966092}, {"lowerIsBetter": false, "replicates": [1069.433200403786, 1082.5128692088563, 1186.715188354795, 1280.8911242544384, 1545.5440645009721, 6205.968970155149, 6761.2900645432255, 6895.138107736533, 6911.550749201311, 6923.342282483169, 6809.863802723942, 6973.721051157948, 6978.0928479297745, 6979.895301570467, 6982.650867456619, 2182.8144607708364, 2202.7797220278003, 2212.0156530343925, 2213.4134454369523, 2213.9335819925427, 2110.9366718998454, 2139.967900481486, 2149.6453085240914, 2165.9133634654595, 2172.283146561631, 2123.883186424746, 2131.2007997001124, 2154.041451554059, 2162.945926351846, 2249.4263962689574, 2236.865788052714, 2242.831787615927, 2244.371575958734, 2245.214175038723, 2245.2927327891744, 2160.5786871560053, 2204.382772823612, 2204.5921504521552, 2205.856619319739, 2209.723784526934, 7133.251008644122, 7165.068541089677, 7174.784756457315, 7180.964095179491, 7181.066461360042, 4360.062586543908, 4456.286994080931, 4458.264386376277, 4462.419885414908, 4484.148011877733, 2882.1641723900043, 2925.9853700731574, 2969.4803409403266, 2972.1083674897445, 3004.669486356499, 899.1503029636996, 929.9863149167372, 943.1652987106391, 956.7464621875208, 958.8945216026232, 9443.763905902339, 9444.669436569688, 9444.669436569688, 9455.669051583161, 9463.195628371597, 4036.6972477064337, 4076.429299897957, 4080.693947953856, 4081.4898137732785, 4083.387491876183, 8170.959145204236, 8218.0, 8224.794380140425, 8231.46495477792, 8249.505029698237, 4386.1008493258805, 4389.29771236607, 4404.6035856772405, 4406.184855801687, 4407.074514351958, 3479.408500554861, 3906.2187562487616, 3983.143624120828, 4027.0, 4028.6575641070835, 3458.8270586470576, 3507.4212754895666, 3532.6643968822923, 3554.306910152495, 3555.235624340779, 1140.5722853929776, 1141.1612464838338, 1147.6614398752222, 1153.3195414705365, 1162.2096974057554, 997.8253805583994, 1018.4551265073151, 1019.9643012494527, 1094.5020015892749, 1227.3433712963522, 6630.1049358336, 6651.63416012124, 6655.600663960178, 6667.233268174125, 6668.466522678174, 452.7147896824979, 460.8502236773062, 462.45199438665287, 464.2224274340466, 464.7954899844058, 5251.369835619674, 5258.2638430619745, 5270.130428479258, 5270.262163297141, 5285.07511185541, 8323.750287491384, 8568.400211985101, 8584.227419532272, 8589.26991205742, 8606.397552171287, 8377.120402357787, 8377.246047855722, 8419.0, 8435.95782021086, 8447.619857106445, 6567.277599464055, 6713.597184168868, 6751.358620931003, 6774.762883299061, 6781.152355955505, 6419.197600299963, 6448.387403196689, 6448.903266450913, 6449.871002580016, 6483.837904052436, 7316.853662926818, 7521.699132034876, 7609.961950190213, 7625.8856117157175, 7697.498987697345, 7677.8464430709955, 7995.040595128622, 7998.080220774453, 8020.318272946864, 8024.9598752008205, 5429.864253393696, 5585.944140558542, 5910.852228694317, 6093.238345206849, 6162.352952940056, 6603.174603174603, 6614.900776488453, 6653.135092438146, 6655.900161497679, 6663.666816659244, 5875.6474611523445, 6019.067044608093, 6020.1270815730595, 6025.457708806229, 6038.094285856981, 5891.351951285269, 6020.548458865515, 6058.454739073504, 6101.450869421773, 6136.478399336106, 6270.341614130633, 6321.683915804099, 6328.525360597881, 6337.493000560036, 6338.049292606146, 5805.883882322414, 5868.295804503487, 5868.94131058684, 5876.647401155944, 5878.735456904535, 5893.322267939242, 5941.1088336749835, 6065.484433823174, 6087.269527656709, 6132.9080063799975], "unit": "score", "name": "mootools.html", "value": 4021.043981812171}, {"lowerIsBetter": false, "replicates": [295.3885457103795, 299.7931427315152, 299.8365890589628, 301.5311191097842, 303.39775545542096, 5258.342707161605, 5268.288781014562, 5271.65734227275, 5295.655782374143, 5298.390685071218, 5223.112070947938, 5229.849433124716, 5232.92150617741, 5235.79056837727, 5237.5548078413285, 3889.2804831106264, 3969.2260009298197, 4045.312296909518, 4085.9387109193385, 4086.83652653895, 4062.7608579383277, 4084.060666046811, 4087.8569250076253, 4090.1615168890307, 4096.037431203665, 3860.112174199936, 4051.3922911563354, 4051.7366371185926, 4053.9797301013455, 4056.7363121397016, 3950.249452603996, 4037.394390841368, 4041.4341992121126, 4048.6153815387343, 4051.0480037191237, 3533.293341331744, 3536.0099172231817, 3542.4332106863035, 3549.236914063463, 3554.5556805399324, 4965.776540055706, 5000.374953130859, 5002.224655178453, 5006.849794506171, 5010.674306170124, 4658.767061646938, 4660.720356778605, 4662.184117779409, 4666.043461090469, 4668.346431499593, 5428.348598168245, 5447.863803404907, 5470.91793623096, 5489.64317319373, 5490.478404551562, 3896.5908579599018, 3899.220155968789, 3901.2782635212293, 3903.33643280643, 3905.3946638271113, 5549.833504994856, 5726.68503232322, 5732.856678583027, 5736.8852622947725, 5739.196512488255, 3807.6192380762254, 3867.651911327994, 3867.9749866285456, 3871.399933010388, 3872.1094148346037, 3931.351327031065, 3970.5433875104154, 3972.0467087899274, 3974.3839704845795, 3978.522577290744, 4540.228161212602, 4567.725936443824, 4567.748773817472, 4578.267477203632, 4578.2903649934315, 5495.670259784426, 5505.064139096363, 5505.421930697299, 5508.724563771795, 5512.834614961557, 1378.30395650198, 1405.2411697683342, 1406.339020660288, 1406.5920882944035, 1408.0214251095595, 908.2597682888425, 942.1050002497518, 946.3186505716011, 960.6109525642127, 969.4231932000448, 4842.58837998767, 4847.418309802846, 4857.9028419432125, 4864.051509955525, 4873.171560834667, 5661.065924122556, 5661.207430959669, 5664.150377443334, 5665.773369065274, 5671.1493276008105, 4848.151573474628, 4857.489963553847, 4857.587105096107, 4860.927086093711, 4864.173090574611, 3011.864466099031, 3039.498482750366, 3044.4367791958557, 3046.2688954650725, 3047.405755877627, 5361.731913404392, 5393.056215162409, 5395.865103372447, 5396.4603539646505, 5400.486953739389, 5617.269754931833, 5788.82633520995, 5797.4782269595935, 5798.88402231953, 5806.44838740319, 5350.250964864922, 5369.543588794996, 5380.0, 5382.434844341366, 5382.4886635769535, 5662.150677398258, 5667.20659107717, 5668.121441176624, 5675.460831221028, 5676.68778217202, 5539.390667026704, 5544.251526043932, 5544.500994910478, 5545.972270138624, 5549.750261238173, 5360.758765855468, 5368.7852485901685, 5369.140937449989, 5373.301470808769, 5384.730763461889, 3822.9235415292096, 3916.4908561886773, 3925.313070212644, 3933.8033098344395, 3933.9606603933594, 5465.371482279589, 5574.86062848432, 5601.859953501195, 5632.464915833153, 5638.23883775685, 5548.722563871871, 5550.306211723535, 5553.416891226363, 5554.694491802989, 5566.582506311962, 5531.695756733418, 5541.889162216652, 5543.584231182596, 5546.528545073714, 5554.944450555605, 5459.754311056092, 5460.972695136657, 5466.535344495604, 5466.808661696821, 5467.699276539669, 5566.415526369673, 5574.832755017356, 5583.860403489945, 5588.497035266845, 5595.916061259003, 5279.894402112013, 5447.673139611636, 5448.891022179455, 5455.918161227505, 5458.072127738374], "unit": "score", "name": "prototype.html", "value": 4124.910133615937}, {"lowerIsBetter": false, "replicates": [684.8390628202374, 748.7080038784878, 764.7629234937172, 764.9426293028024, 777.4130531448759, 12260.509579616804, 12393.946514546253, 12464.25214487129, 12483.5006599736, 12513.687157821036, 11709.70725731857, 12804.871951280484, 12818.0, 12818.038647101457, 12828.358582070905, 638.9073584330292, 771.5717776633966, 782.3037496628006, 792.6155814429997, 805.4764403137949, 807.1605530248535, 809.0978558906835, 812.5003123079293, 812.585581353511, 812.6424373275739, 847.3941132090554, 849.0193826130798, 849.5285116760195, 849.9787505312386, 849.9927585810834, 658.9670516474181, 832.0597724571256, 842.7429633961639, 845.6913226672282, 847.2798121596655, 616.0512810272176, 617.7127635649445, 619.0343064818896, 619.4610688700814, 620.5811077522654, 12928.28894410807, 13002.804957925639, 13034.608961731163, 13035.86964130356, 13059.085863989525, 11903.0, 12007.57973470933, 12088.456019479145, 12389.876101238962, 12554.0, 10628.14974802014, 10807.081398081173, 10810.891532679529, 10838.67483975482, 11249.100071994302, 3319.5020746887917, 3355.1612096975755, 3365.7307415406954, 3378.2567835076243, 3438.7420943429343, 40707.592924070974, 41193.58806411928, 41375.1724965502, 41479.1704165918, 41615.583844161476, 9676.758081047888, 9725.221982241404, 9812.90187098134, 9840.311178217598, 9895.505224738734, 16642.3343066276, 16647.91676041612, 16650.666986660442, 16654.83345166557, 16660.6667866642, 6587.538872278895, 6615.4046135848, 6660.800175994631, 6690.933090669031, 6908.723651054002, 3751.718621103428, 3853.2678791029616, 3869.380899056194, 3893.5717071122153, 3978.8209530571194, 2853.429314137181, 2860.4708128996203, 2861.484932712132, 2863.7565806906227, 2882.956755648667, 500.7352064539184, 508.6261597725669, 522.0498692379832, 524.8346770767196, 541.0, 458.63767623577667, 475.4413564062213, 488.8899997500534, 577.9133130030445, 585.7071464267866, 7461.291177338144, 7490.1386340571535, 7873.645685944146, 7881.211878812188, 8019.39854510914, 536.1154095741979, 553.8947599955995, 558.9469000444951, 570.891530609183, 577.413924866261, 3363.428217203081, 3554.4668299755244, 3621.94567081494, 3667.1198912261398, 3713.721470889694, 45975.0, 50596.747016264686, 50975.49024509782, 51013.744931275105, 51019.23471147936, 40106.197876042315, 40222.195556088715, 40465.59534404618, 40541.59458405437, 40751.388729169084, 37165.814170929516, 37195.07012324713, 37240.813795930844, 37802.0, 41356.37965430521, 8430.15698430152, 8477.660893564189, 8496.915030849612, 8585.8712119317, 8675.219230269306, 30443.39113217679, 30714.0, 31292.0, 31345.0, 31371.21571960628, 35172.29655406826, 36384.81807591051, 38819.2236155281, 39254.4111838317, 39480.60519394769, 10867.565297388015, 10884.51019704131, 10937.0, 11063.0, 11085.168612354268, 11632.11312237469, 11730.882691173321, 11902.761944761229, 11983.150095602252, 12057.57798477049, 10665.89334106649, 10808.729781755519, 10902.0, 11101.666949991513, 11396.94301528487, 11258.549658013588, 11648.941755291507, 11650.417479125841, 11668.766624667629, 11678.591249306233, 10144.746381340525, 10268.897311026794, 10361.11930485887, 10478.37129772216, 10719.839202411815, 9076.228520575825, 9115.635374584943, 9198.908010920073, 9269.860952085859, 9651.71044868655, 9306.767330816783, 9629.903700962901, 9666.468344241135, 9700.0, 9747.951260243653], "unit": "score", "name": "yui.html", "value": 5859.342707936799}], "name": "dromaeo_css", "value": 6200.713784184834}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 113.0, 108.0, 114.0, 112.0, 112.0, 103.0, 114.0, 112.0, 112.0], "unit": "score", "name": "ai-astar", "value": 111.2}, {"lowerIsBetter": true, "replicates": [156.0, 129.0, 153.0, 161.0, 131.0, 152.0, 162.0, 132.0, 175.0, 130.0], "unit": "score", "name": "audio-beat-detection", "value": 148.1}, {"lowerIsBetter": true, "replicates": [162.0, 164.0, 162.0, 163.0, 162.0, 161.0, 163.0, 164.0, 161.0, 161.0], "unit": "score", "name": "audio-dft", "value": 162.3}, {"lowerIsBetter": true, "replicates": [77.0, 72.0, 94.0, 92.0, 73.0, 73.0, 73.0, 109.0, 97.0, 73.0], "unit": "score", "name": "audio-fft", "value": 83.3}, {"lowerIsBetter": true, "replicates": [94.0, 96.0, 142.0, 93.0, 93.0, 96.0, 143.0, 93.0, 93.0, 136.0], "unit": "score", "name": "audio-oscillator", "value": 107.9}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 116.0, 117.0, 117.0, 118.0, 117.0, 118.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.1}, {"lowerIsBetter": true, "replicates": [145.0, 146.0, 145.0, 145.0, 145.0, 146.0, 146.0, 145.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.5}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 95.0, 95.0, 96.0, 95.0, 96.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.4}, {"lowerIsBetter": true, "replicates": [69.0, 70.0, 71.0, 69.0, 69.0, 70.0, 69.0, 78.0, 67.0, 66.0], "unit": "score", "name": "json-parse-financial", "value": 69.8}, {"lowerIsBetter": true, "replicates": [64.0, 65.0, 64.0, 64.0, 65.0, 64.0, 64.0, 64.0, 65.0, 70.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.9}, {"lowerIsBetter": true, "replicates": [83.0, 81.0, 81.0, 82.0, 89.0, 82.0, 81.0, 82.0, 82.0, 83.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.6}, {"lowerIsBetter": true, "replicates": [120.0, 124.0, 115.0, 121.0, 131.0, 117.0, 118.0, 134.0, 127.0, 125.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 123.2}, {"lowerIsBetter": true, "replicates": [139.0, 129.0, 138.0, 143.0, 139.0, 128.0, 132.0, 142.0, 138.0, 133.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 136.1}, {"lowerIsBetter": true, "replicates": [68.0, 67.0, 66.0, 67.0, 68.0, 66.0, 65.0, 67.0, 68.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.8}], "name": "kraken", "value": 1514.2}]} 16:19:50 INFO - Return code: 0 16:19:50 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 16:19:50 ERROR - # TBPL SUCCESS # 16:19:50 INFO - Running post-action listener: _resource_record_post_action 16:19:50 INFO - Running post-run listener: _resource_record_post_run 16:19:52 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 0; Write bytes: 534757376; Read time: 0; Write time: 572344 16:19:52 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 249262080; Read time: 0; Write time: 319772 16:19:52 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 0; Write bytes: 285495296; Read time: 0; Write time: 252572 16:19:52 INFO - Running post-run listener: _upload_blobber_files 16:19:52 INFO - Blob upload gear active. 16:19:52 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:19:52 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 16:19:52 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'] 16:19:52 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 16:19:52 INFO - (blobuploader) - INFO - Open directory for files ... 16:19:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 16:19:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:19:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:19:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 16:19:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:19:53 INFO - (blobuploader) - INFO - Done attempting. 16:19:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 16:19:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:19:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:19:54 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 16:19:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:19:54 INFO - (blobuploader) - INFO - Done attempting. 16:19:54 INFO - (blobuploader) - INFO - Iteration through files over. 16:19:54 INFO - Return code: 0 16:19:54 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:19:54 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:19:54 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/21bf5f6a900e3df221036eecc71e106dce60b3a7a79148e1b7403aee428fe6a5d56c97c19d6eb114b7d545bcae99fc3fd68a6a4fc54000e283917ba5daa720af", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/994ce453f925566042a1f91a379ac158ad210a6c2c8d1c6f852e33db14675f2d24e4973e39a52c4e5c6166b2fcc73a878cb84b4f9b805cf909a6ded946c4a60f"} 16:19:54 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:19:54 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:19:54 INFO - Contents: 16:19:54 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/21bf5f6a900e3df221036eecc71e106dce60b3a7a79148e1b7403aee428fe6a5d56c97c19d6eb114b7d545bcae99fc3fd68a6a4fc54000e283917ba5daa720af", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/994ce453f925566042a1f91a379ac158ad210a6c2c8d1c6f852e33db14675f2d24e4973e39a52c4e5c6166b2fcc73a878cb84b4f9b805cf909a6ded946c4a60f"} 16:19:54 INFO - Running post-run listener: copy_logs_to_upload_dir 16:19:54 INFO - Copying logs to upload dir... 16:19:54 INFO - mkdir: /builds/slave/test/build/upload/logs 16:19:54 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.469111 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-03-21 16:19:54.059011) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-21 16:19:54.062373) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/21bf5f6a900e3df221036eecc71e106dce60b3a7a79148e1b7403aee428fe6a5d56c97c19d6eb114b7d545bcae99fc3fd68a6a4fc54000e283917ba5daa720af", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/994ce453f925566042a1f91a379ac158ad210a6c2c8d1c6f852e33db14675f2d24e4973e39a52c4e5c6166b2fcc73a878cb84b4f9b805cf909a6ded946c4a60f"} build_url:https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011478 build_url: 'https://queue.taskcluster.net/v1/task/X7Uueo9uT7qwFiZpWRx7Dg/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/21bf5f6a900e3df221036eecc71e106dce60b3a7a79148e1b7403aee428fe6a5d56c97c19d6eb114b7d545bcae99fc3fd68a6a4fc54000e283917ba5daa720af", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/994ce453f925566042a1f91a379ac158ad210a6c2c8d1c6f852e33db14675f2d24e4973e39a52c4e5c6166b2fcc73a878cb84b4f9b805cf909a6ded946c4a60f"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-21 16:19:54.087530) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 16:19:54.087851) ========= 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=b5f16d05e5ea93ddf675e67e000001bf-1458600838.557020-1997204341 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004461 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 16:19:54.171129) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-21 16:19:54.171491) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-21 16:19:54.171977) ========= ========= Total master_lag: 0.30 =========