builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-078 starttime: 1491579378.26 results: success (0) revision: 19e555dcd7e28ffae4440fb2220f1671cb81d6de ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.259969) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.260480) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.260761) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.280816) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.281227) ========= 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=dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-04-07 08:36:18-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 226M=0s 2017-04-07 08:36:18 (226 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.136225 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.431722) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.432064) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019245 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.481675) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:18.482028) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 19e555dcd7e28ffae4440fb2220f1671cb81d6de --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 19e555dcd7e28ffae4440fb2220f1671cb81d6de --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=dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-04-07 08:36:18,567 truncating revision to first 12 chars 2017-04-07 08:36:18,567 Setting DEBUG logging. 2017-04-07 08:36:18,567 attempt 1/10 2017-04-07 08:36:18,567 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/19e555dcd7e2?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-04-07 08:36:19,018 unpacking tar archive at: mozilla-central-19e555dcd7e2/testing/mozharness/ program finished with exit code 0 elapsedTime=0.747001 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:19.242385) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:19.242688) ========= script_repo_revision: 19e555dcd7e28ffae4440fb2220f1671cb81d6de ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:19.243076) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:19.243346) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-04-07 08:36:19.254387) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2017-04-07 08:36:19.254731) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-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', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-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=dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:36:19 INFO - MultiFileLogger online at 20170407 08:36:19 in /builds/slave/test 08:36:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 08:36:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:36:19 INFO - {'append_to_log': False, 08:36:19 INFO - 'base_work_dir': '/builds/slave/test', 08:36:19 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 08:36:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:36:19 INFO - 'branch': 'Firefox-Non-PGO', 08:36:19 INFO - 'buildbot_json_path': 'buildprops.json', 08:36:19 INFO - 'config_files': ('talos/linux_config.py',), 08:36:19 INFO - 'default_actions': ('clobber', 08:36:19 INFO - 'read-buildbot-config', 08:36:19 INFO - 'download-and-extract', 08:36:19 INFO - 'populate-webroot', 08:36:19 INFO - 'create-virtualenv', 08:36:19 INFO - 'install', 08:36:19 INFO - 'run-tests'), 08:36:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:36:19 INFO - 'download_minidump_stackwalk': True, 08:36:19 INFO - 'download_symbols': 'ondemand', 08:36:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:36:19 INFO - 'tooltool.py': '/tools/tooltool.py', 08:36:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:36:19 INFO - '/tools/misc-python/virtualenv.py')}, 08:36:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:36:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:36:19 INFO - 'gecko_profile': False, 08:36:19 INFO - 'gecko_profile_interval': 0, 08:36:19 INFO - 'installer_path': 'installer.exe', 08:36:19 INFO - 'log_level': 'info', 08:36:19 INFO - 'log_name': 'talos', 08:36:19 INFO - 'log_to_console': True, 08:36:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:36:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:36:19 INFO - 'opt_config_files': (), 08:36:19 INFO - 'pip_index': False, 08:36:19 INFO - 'suite': 'dromaeojs', 08:36:19 INFO - 'system_bits': '32', 08:36:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:36:19 INFO - 'title': 'talos-linux64-ix-078', 08:36:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:36:19 INFO - 'use_talos_json': True, 08:36:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:36:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:36:19 INFO - 'work_dir': 'build'} 08:36:19 INFO - [mozharness: 2017-04-07 15:36:19.450105Z] Running clobber step. 08:36:19 INFO - Running pre-action listener: _resource_record_pre_action 08:36:19 INFO - Running main action method: clobber 08:36:19 INFO - rmtree: /builds/slave/test/build 08:36:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:36:20 INFO - Running post-action listener: _resource_record_post_action 08:36:20 INFO - [mozharness: 2017-04-07 15:36:20.379344Z] Finished clobber step (success) 08:36:20 INFO - [mozharness: 2017-04-07 15:36:20.379445Z] Running read-buildbot-config step. 08:36:20 INFO - Running pre-action listener: _resource_record_pre_action 08:36:20 INFO - Running main action method: read_buildbot_config 08:36:20 INFO - Using buildbot properties: 08:36:20 INFO - { 08:36:20 INFO - "project": "", 08:36:20 INFO - "product": "firefox", 08:36:20 INFO - "who": "philringnalda@gmail.com", 08:36:20 INFO - "installer_path": "public/build/target.tar.bz2", 08:36:20 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 08:36:20 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 08:36:20 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 08:36:20 INFO - "stage_platform": "linux64", 08:36:20 INFO - "basedir": "/builds/slave/test", 08:36:20 INFO - "buildnumber": 532, 08:36:20 INFO - "platform": "ubuntu64_hw", 08:36:20 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 08:36:20 INFO - "slavebuilddir": "test", 08:36:20 INFO - "taskId": "BIHCyzpnR0yip0WRpwlx6w", 08:36:20 INFO - "branch": "mozilla-central", 08:36:20 INFO - "script_repo_revision": "production", 08:36:20 INFO - "revision": "19e555dcd7e28ffae4440fb2220f1671cb81d6de", 08:36:20 INFO - "slavename": "talos-linux64-ix-078", 08:36:20 INFO - "repo_path": "mozilla-central" 08:36:20 INFO - } 08:36:20 INFO - Finding installer, test and symbols from parent task. 08:36:20 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/BIHCyzpnR0yip0WRpwlx6w'}, attempt #1 08:36:20 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/BIHCyzpnR0yip0WRpwlx6w'}, attempt #1 08:36:21 INFO - Task dependencies: eOKtEkKmSRWLmPWmB-T6rg 08:36:21 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg'}, attempt #1 08:36:21 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.tar.bz2 08:36:21 INFO - Set test_url: https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/test_packages.json 08:36:21 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.crashreporter-symbols.zip 08:36:21 INFO - Running post-action listener: _resource_record_post_action 08:36:21 INFO - [mozharness: 2017-04-07 15:36:21.795002Z] Finished read-buildbot-config step (success) 08:36:21 INFO - [mozharness: 2017-04-07 15:36:21.795218Z] Running download-and-extract step. 08:36:21 INFO - Running pre-action listener: _resource_record_pre_action 08:36:21 INFO - Running main action method: download_and_extract 08:36:21 INFO - mkdir: /builds/slave/test/build/tests 08:36: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:21 INFO - trying https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.test_packages.json 08:36:21 INFO - Downloading https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 08:36:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 08:36:22 INFO - Downloaded 986 bytes. 08:36:22 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 08:36:22 INFO - Using the following test package requirements: 08:36:22 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 08:36:22 INFO - u'common': [u'target.common.tests.zip'], 08:36:22 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 08:36:22 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 08:36:22 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 08:36:22 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 08:36:22 INFO - u'mozbase': [u'target.common.tests.zip'], 08:36:22 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 08:36:22 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 08:36:22 INFO - u'web-platform': [u'target.common.tests.zip', 08:36:22 INFO - u'target.web-platform.tests.zip'], 08:36:22 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 08:36:22 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 08:36:22 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.common.tests.zip 08:36:22 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:36:22 INFO - Fetch https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.common.tests.zip into memory 08:36:24 INFO - Expected file size: 58238853 08:36:24 INFO - Obtained file size: 58238853 08:36:34 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 08:36:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.common.tests.zip 08:36:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:36:34 INFO - Fetch https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.common.tests.zip into memory 08:36:35 INFO - Expected file size: 58238853 08:36:35 INFO - Obtained file size: 58238853 08:36:46 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.talos.tests.zip 08:36:46 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 08:36:46 INFO - Fetch https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.talos.tests.zip into memory 08:36:47 INFO - Expected file size: 14404138 08:36:47 INFO - Obtained file size: 14404138 08:36:47 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:47 INFO - trying https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.tar.bz2 08:36:47 INFO - Downloading https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 08:36:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 08:36:49 INFO - Downloaded 57647282 bytes. 08:36:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.tar.bz2 08:36:49 INFO - mkdir: /builds/slave/test/properties 08:36:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:36:49 INFO - Writing to file /builds/slave/test/properties/build_url 08:36:49 INFO - Contents: 08:36:49 INFO - build_url:https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.tar.bz2 08:36:49 INFO - Running post-action listener: _resource_record_post_action 08:36:49 INFO - Running post-action listener: set_extra_try_arguments 08:36:49 INFO - [mozharness: 2017-04-07 15:36:49.931877Z] Finished download-and-extract step (success) 08:36:49 INFO - [mozharness: 2017-04-07 15:36:49.931985Z] Running populate-webroot step. 08:36:49 INFO - Running pre-action listener: _resource_record_pre_action 08:36:49 INFO - Running main action method: populate_webroot 08:36:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:36:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:36:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:36:49 INFO - '--tppagecycles', 08:36:49 INFO - '7'], 08:36:49 INFO - 'tests': ['tsvgm']}}, 08:36:49 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:36:49 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:36:49 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:36:49 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:36:49 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 08:36:49 INFO - 'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:36:49 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:36:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:36:49 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 08:36:49 INFO - 'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['damp', 'tps']}, 08:36:49 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:36:49 INFO - 'tests': ['damp', 'tps']}, 08:36:49 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['dromaeo_dom']}, 08:36:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:36:49 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['basic_compositor_video']}, 08:36:49 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:36:49 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['a11yr', 08:36:49 INFO - 'ts_paint', 08:36:49 INFO - 'tpaint', 08:36:49 INFO - 'sessionrestore', 08:36:49 INFO - 'sessionrestore_no_auto_restore', 08:36:49 INFO - 'tabpaint']}, 08:36:49 INFO - 'other-e10s': {'tests': ['a11yr', 08:36:49 INFO - 'ts_paint', 08:36:49 INFO - 'tpaint', 08:36:49 INFO - 'sessionrestore', 08:36:49 INFO - 'sessionrestore_no_auto_restore', 08:36:49 INFO - 'tabpaint']}, 08:36:49 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:36:49 INFO - 'ts_paint', 08:36:49 INFO - 'tpaint', 08:36:49 INFO - 'sessionrestore', 08:36:49 INFO - 'sessionrestore_no_auto_restore', 08:36:49 INFO - 'tabpaint']}, 08:36:49 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:36:49 INFO - 'ts_paint', 08:36:49 INFO - 'tpaint', 08:36:49 INFO - 'sessionrestore', 08:36:49 INFO - 'sessionrestore_no_auto_restore', 08:36:49 INFO - 'tabpaint']}, 08:36:49 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['a11yr', 08:36:49 INFO - 'ts_paint', 08:36:49 INFO - 'tpaint', 08:36:49 INFO - 'sessionrestore', 08:36:49 INFO - 'sessionrestore_no_auto_restore', 08:36:49 INFO - 'tabpaint']}, 08:36:49 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['a11yr', 08:36:49 INFO - 'ts_paint', 08:36:49 INFO - 'tpaint', 08:36:49 INFO - 'sessionrestore', 08:36:49 INFO - 'sessionrestore_no_auto_restore', 08:36:49 INFO - 'tabpaint']}, 08:36:49 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['tsvgx', 08:36:49 INFO - 'tsvgr_opacity', 08:36:49 INFO - 'tart', 08:36:49 INFO - 'tscrollx', 08:36:49 INFO - 'cart', 08:36:49 INFO - 'tsvg_static']}, 08:36:49 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:36:49 INFO - 'tsvgr_opacity', 08:36:49 INFO - 'tart', 08:36:49 INFO - 'tscrollx', 08:36:49 INFO - 'cart', 08:36:49 INFO - 'tsvg_static']}, 08:36:49 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 08:36:49 INFO - 'talos_options': ['--disable-e10s'], 08:36:49 INFO - 'tests': ['tp5o']}, 08:36:49 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:36:49 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 08:36:49 INFO - 'talos_options': ['--disable-e10s', 08:36:49 INFO - '--xperf_path', 08:36:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:36:49 INFO - 'tests': ['tp5n']}, 08:36:49 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:36:49 INFO - 'talos_options': ['--xperf_path', 08:36:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:36:49 INFO - 'tests': ['tp5n']}}, 08:36:49 INFO - 'talos.zip': {'path': '', 08:36:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:36:49 INFO - Running post-action listener: _resource_record_post_action 08:36:49 INFO - [mozharness: 2017-04-07 15:36:49.945180Z] Finished populate-webroot step (success) 08:36:49 INFO - [mozharness: 2017-04-07 15:36:49.945270Z] Running create-virtualenv step. 08:36:49 INFO - Running pre-action listener: _resource_record_pre_action 08:36:49 INFO - Running main action method: create_virtualenv 08:36:49 INFO - Creating virtualenv /builds/slave/test/build/venv 08:36:49 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 08:36:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:36:50 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:36:50 INFO - Using real prefix '/usr' 08:36:50 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:36:50 INFO - Installing distribute.............................................................................................................................................................................................done. 08:36:52 INFO - Installing pip.................done. 08:36:52 INFO - Return code: 0 08:36:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:36:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:36:52 INFO - Reading from file tmpfile_stdout 08:36:52 INFO - Output received: 08:36:52 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 08:36:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:36:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:52 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 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:36:52 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 08:36:52 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 08:36:52 INFO - Using env: {'DISPLAY': ':0', 08:36:52 INFO - 'HOME': '/home/cltbld', 08:36:52 INFO - 'LANG': 'en_US.UTF-8', 08:36:52 INFO - 'LANGUAGE': 'en_US:en', 08:36:52 INFO - 'LOGNAME': 'cltbld', 08:36:52 INFO - 'MAIL': '/var/mail/cltbld', 08:36:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:52 INFO - 'MOZ_NO_REMOTE': '1', 08:36:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:36:52 INFO - 'NO_EM_RESTART': '1', 08:36:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:36:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:52 INFO - 'PWD': '/builds/slave/test', 08:36:52 INFO - 'SHELL': '/bin/bash', 08:36:52 INFO - 'SHLVL': '1', 08:36:52 INFO - 'TERM': 'linux', 08:36:52 INFO - 'TMOUT': '86400', 08:36:52 INFO - 'USER': 'cltbld', 08:36:52 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:36:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:52 INFO - '_': '/tools/buildbot/bin/python'} 08:36:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:52 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 08:36:52 INFO - Cleaning up... 08:36:52 INFO - Return code: 0 08:36:52 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:36:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:52 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>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:36:52 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>=3.1.1'] in /builds/slave/test/build 08:36:52 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>=3.1.1 08:36:52 INFO - Using env: {'DISPLAY': ':0', 08:36:52 INFO - 'HOME': '/home/cltbld', 08:36:52 INFO - 'LANG': 'en_US.UTF-8', 08:36:52 INFO - 'LANGUAGE': 'en_US:en', 08:36:52 INFO - 'LOGNAME': 'cltbld', 08:36:52 INFO - 'MAIL': '/var/mail/cltbld', 08:36:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:52 INFO - 'MOZ_NO_REMOTE': '1', 08:36:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:36:52 INFO - 'NO_EM_RESTART': '1', 08:36:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:36:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:52 INFO - 'PWD': '/builds/slave/test', 08:36:52 INFO - 'SHELL': '/bin/bash', 08:36:52 INFO - 'SHLVL': '1', 08:36:52 INFO - 'TERM': 'linux', 08:36:52 INFO - 'TMOUT': '86400', 08:36:52 INFO - 'USER': 'cltbld', 08:36:52 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:36:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:52 INFO - '_': '/tools/buildbot/bin/python'} 08:36:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:53 INFO - Downloading/unpacking psutil>=3.1.1 08:36: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 08:36: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 08:36: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 08:36: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 08:36: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 08:36: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 08:36:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:36:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:36:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:36:55 INFO - Installing collected packages: psutil 08:36:55 INFO - Running setup.py install for psutil 08:36:55 INFO - building 'psutil._psutil_linux' extension 08:36:55 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 08:36:55 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 08:36:55 INFO - building 'psutil._psutil_posix' extension 08:36:55 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 08:36:55 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 08:36:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:36:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:36:55 INFO - Successfully installed psutil 08:36:55 INFO - Cleaning up... 08:36:55 INFO - Return code: 0 08:36:55 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:36:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:55 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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:36:55 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.3'] in /builds/slave/test/build 08:36:55 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.3 08:36:55 INFO - Using env: {'DISPLAY': ':0', 08:36:55 INFO - 'HOME': '/home/cltbld', 08:36:55 INFO - 'LANG': 'en_US.UTF-8', 08:36:55 INFO - 'LANGUAGE': 'en_US:en', 08:36:55 INFO - 'LOGNAME': 'cltbld', 08:36:55 INFO - 'MAIL': '/var/mail/cltbld', 08:36:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:55 INFO - 'MOZ_NO_REMOTE': '1', 08:36:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:36:55 INFO - 'NO_EM_RESTART': '1', 08:36:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:36:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:55 INFO - 'PWD': '/builds/slave/test', 08:36:55 INFO - 'SHELL': '/bin/bash', 08:36:55 INFO - 'SHLVL': '1', 08:36:55 INFO - 'TERM': 'linux', 08:36:55 INFO - 'TMOUT': '86400', 08:36:55 INFO - 'USER': 'cltbld', 08:36:55 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:36:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:55 INFO - '_': '/tools/buildbot/bin/python'} 08:36:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:56 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:36:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:58 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:36:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:36:58 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:36:58 INFO - Installing collected packages: mozsystemmonitor 08:36:58 INFO - Running setup.py install for mozsystemmonitor 08:36:58 INFO - Successfully installed mozsystemmonitor 08:36:58 INFO - Cleaning up... 08:36:58 INFO - Return code: 0 08:36:58 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:36:58 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:36:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:58 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:36:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:36:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:36:58 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==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:36:58 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==2.5.1'] in /builds/slave/test/build 08:36:58 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==2.5.1 08:36:58 INFO - Using env: {'DISPLAY': ':0', 08:36:58 INFO - 'HOME': '/home/cltbld', 08:36:58 INFO - 'LANG': 'en_US.UTF-8', 08:36:58 INFO - 'LANGUAGE': 'en_US:en', 08:36:58 INFO - 'LOGNAME': 'cltbld', 08:36:58 INFO - 'MAIL': '/var/mail/cltbld', 08:36:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:36:58 INFO - 'MOZ_NO_REMOTE': '1', 08:36:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:36:58 INFO - 'NO_EM_RESTART': '1', 08:36:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:36:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:36:58 INFO - 'PWD': '/builds/slave/test', 08:36:58 INFO - 'SHELL': '/bin/bash', 08:36:58 INFO - 'SHLVL': '1', 08:36:58 INFO - 'TERM': 'linux', 08:36:58 INFO - 'TMOUT': '86400', 08:36:58 INFO - 'USER': 'cltbld', 08:36:58 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:36:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:36:58 INFO - '_': '/tools/buildbot/bin/python'} 08:36:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:36:58 INFO - Downloading/unpacking jsonschema==2.5.1 08:36:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:36:58 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:58 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:36:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:36:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:00 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:37:00 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:37:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:00 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 08:37:00 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 08:37:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:00 INFO - Downloading functools32-3.2.3-2.tar.gz 08:37:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:37:00 INFO - warning: no files found matching '*.txt' 08:37:00 INFO - no previously-included directories found matching 'build' 08:37:00 INFO - no previously-included directories found matching 'dist' 08:37:00 INFO - no previously-included directories found matching '.git*' 08:37:00 INFO - Installing collected packages: jsonschema, functools32 08:37:00 INFO - Running setup.py install for functools32 08:37:01 INFO - warning: no files found matching '*.txt' 08:37:01 INFO - no previously-included directories found matching 'build' 08:37:01 INFO - no previously-included directories found matching 'dist' 08:37:01 INFO - no previously-included directories found matching '.git*' 08:37:01 INFO - Successfully installed jsonschema functools32 08:37:01 INFO - Cleaning up... 08:37:01 INFO - Return code: 0 08:37:01 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:37:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:37:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:37:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:01 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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:37:01 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', 'functools32==3.2.3-2'] in /builds/slave/test/build 08:37:01 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 functools32==3.2.3-2 08:37:01 INFO - Using env: {'DISPLAY': ':0', 08:37:01 INFO - 'HOME': '/home/cltbld', 08:37:01 INFO - 'LANG': 'en_US.UTF-8', 08:37:01 INFO - 'LANGUAGE': 'en_US:en', 08:37:01 INFO - 'LOGNAME': 'cltbld', 08:37:01 INFO - 'MAIL': '/var/mail/cltbld', 08:37:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:37:01 INFO - 'MOZ_NO_REMOTE': '1', 08:37:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:37:01 INFO - 'NO_EM_RESTART': '1', 08:37:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:37:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:37:01 INFO - 'PWD': '/builds/slave/test', 08:37:01 INFO - 'SHELL': '/bin/bash', 08:37:01 INFO - 'SHLVL': '1', 08:37:01 INFO - 'TERM': 'linux', 08:37:01 INFO - 'TMOUT': '86400', 08:37:01 INFO - 'USER': 'cltbld', 08:37:01 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:37:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:37:01 INFO - '_': '/tools/buildbot/bin/python'} 08:37:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:37:01 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:37:01 INFO - Cleaning up... 08:37:01 INFO - Return code: 0 08:37:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:37:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:37:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:37:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:01 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 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:37:01 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 08:37:01 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 08:37:01 INFO - Using env: {'DISPLAY': ':0', 08:37:01 INFO - 'HOME': '/home/cltbld', 08:37:01 INFO - 'LANG': 'en_US.UTF-8', 08:37:01 INFO - 'LANGUAGE': 'en_US:en', 08:37:01 INFO - 'LOGNAME': 'cltbld', 08:37:01 INFO - 'MAIL': '/var/mail/cltbld', 08:37:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:37:01 INFO - 'MOZ_NO_REMOTE': '1', 08:37:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:37:01 INFO - 'NO_EM_RESTART': '1', 08:37:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:37:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:37:01 INFO - 'PWD': '/builds/slave/test', 08:37:01 INFO - 'SHELL': '/bin/bash', 08:37:01 INFO - 'SHLVL': '1', 08:37:01 INFO - 'TERM': 'linux', 08:37:01 INFO - 'TMOUT': '86400', 08:37:01 INFO - 'USER': 'cltbld', 08:37:01 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:37:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:37:01 INFO - '_': '/tools/buildbot/bin/python'} 08:37:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:37:01 INFO - Downloading/unpacking blobuploader==1.2.4 08:37:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:01 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 08:37:01 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 08:37:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:03 INFO - Downloading blobuploader-1.2.4.tar.gz 08:37:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:37:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:37:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:03 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 08:37:03 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 08:37:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:37:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:37:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:37:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:37:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:04 INFO - Downloading docopt-0.6.1.tar.gz 08:37:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:37:04 INFO - Installing collected packages: blobuploader, requests, docopt 08:37:04 INFO - Running setup.py install for blobuploader 08:37:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:37:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:37:04 INFO - Running setup.py install for requests 08:37:04 INFO - Running setup.py install for docopt 08:37:04 INFO - Successfully installed blobuploader requests docopt 08:37:04 INFO - Cleaning up... 08:37:04 INFO - Return code: 0 08:37:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:37:04 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:37:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:04 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:37:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:04 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 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:37:04 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 08:37:04 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 08:37:04 INFO - Using env: {'DISPLAY': ':0', 08:37:04 INFO - 'HOME': '/home/cltbld', 08:37:04 INFO - 'LANG': 'en_US.UTF-8', 08:37:04 INFO - 'LANGUAGE': 'en_US:en', 08:37:04 INFO - 'LOGNAME': 'cltbld', 08:37:04 INFO - 'MAIL': '/var/mail/cltbld', 08:37:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:37:04 INFO - 'MOZ_NO_REMOTE': '1', 08:37:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:37:04 INFO - 'NO_EM_RESTART': '1', 08:37:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:37:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:37:04 INFO - 'PWD': '/builds/slave/test', 08:37:04 INFO - 'SHELL': '/bin/bash', 08:37:04 INFO - 'SHLVL': '1', 08:37:04 INFO - 'TERM': 'linux', 08:37:04 INFO - 'TMOUT': '86400', 08:37:04 INFO - 'USER': 'cltbld', 08:37:04 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:37:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:37:04 INFO - '_': '/tools/buildbot/bin/python'} 08:37:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:37:05 INFO - Running setup.py (path:/tmp/pip-NsWhIC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:37:05 INFO - Running setup.py (path:/tmp/pip-GfkAmr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:37:05 INFO - Running setup.py (path:/tmp/pip-Cpujqu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:37:05 INFO - Running setup.py (path:/tmp/pip-5z1t_d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:37:05 INFO - Running setup.py (path:/tmp/pip-j88TOD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:37:05 INFO - Running setup.py (path:/tmp/pip-5S5lQe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:37:05 INFO - Running setup.py (path:/tmp/pip-RRFTCV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:37:05 INFO - Running setup.py (path:/tmp/pip-nliCij-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:37:05 INFO - Running setup.py (path:/tmp/pip-eTQqb_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:37:05 INFO - Running setup.py (path:/tmp/pip-8Fhr1T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:37:05 INFO - Running setup.py (path:/tmp/pip-sKB7Pd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:37:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:37:05 INFO - Running setup.py (path:/tmp/pip-7irF3e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:37:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:37:06 INFO - Running setup.py (path:/tmp/pip-wkT9Fk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:37:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:37:06 INFO - Running setup.py (path:/tmp/pip-vrA3Kk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:37:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:37:06 INFO - Running setup.py (path:/tmp/pip-UwkgCr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:37:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:37:06 INFO - Running setup.py (path:/tmp/pip-Dujj2E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:37:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:37:06 INFO - Running setup.py (path:/tmp/pip-9w2ya4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:37:06 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:37:06 INFO - Running setup.py install for manifestparser 08:37:06 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:37:06 INFO - Running setup.py install for mozcrash 08:37:06 INFO - Running setup.py install for mozdebug 08:37:06 INFO - Running setup.py install for mozdevice 08:37:06 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:37:06 INFO - Running setup.py install for mozfile 08:37:06 INFO - Running setup.py install for mozhttpd 08:37:07 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Running setup.py install for mozinfo 08:37:07 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Running setup.py install for mozInstall 08:37:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Running setup.py install for mozleak 08:37:07 INFO - Running setup.py install for mozlog 08:37:07 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Running setup.py install for moznetwork 08:37:07 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Running setup.py install for mozprocess 08:37:07 INFO - Running setup.py install for mozprofile 08:37:07 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Running setup.py install for mozrunner 08:37:07 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:37:07 INFO - Running setup.py install for mozscreenshot 08:37:07 INFO - Running setup.py install for moztest 08:37:08 INFO - Running setup.py install for mozversion 08:37:08 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:37:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:37:08 INFO - Cleaning up... 08:37:08 INFO - Return code: 0 08:37:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:37:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:37:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:37:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:08 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 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:37:08 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 08:37:08 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 08:37:08 INFO - Using env: {'DISPLAY': ':0', 08:37:08 INFO - 'HOME': '/home/cltbld', 08:37:08 INFO - 'LANG': 'en_US.UTF-8', 08:37:08 INFO - 'LANGUAGE': 'en_US:en', 08:37:08 INFO - 'LOGNAME': 'cltbld', 08:37:08 INFO - 'MAIL': '/var/mail/cltbld', 08:37:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:37:08 INFO - 'MOZ_NO_REMOTE': '1', 08:37:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:37:08 INFO - 'NO_EM_RESTART': '1', 08:37:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:37:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:37:08 INFO - 'PWD': '/builds/slave/test', 08:37:08 INFO - 'SHELL': '/bin/bash', 08:37:08 INFO - 'SHLVL': '1', 08:37:08 INFO - 'TERM': 'linux', 08:37:08 INFO - 'TMOUT': '86400', 08:37:08 INFO - 'USER': 'cltbld', 08:37:08 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:37:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:37:08 INFO - '_': '/tools/buildbot/bin/python'} 08:37:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:37:08 INFO - Running setup.py (path:/tmp/pip-oOxi3d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:37:08 INFO - Running setup.py (path:/tmp/pip-YWUeUo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:37:08 INFO - Running setup.py (path:/tmp/pip-JaQK80-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:37:08 INFO - Running setup.py (path:/tmp/pip-5_cW6b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:37:08 INFO - Running setup.py (path:/tmp/pip-LwKkk4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:37:08 INFO - Running setup.py (path:/tmp/pip-VVdkHY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:37:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 08:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:37:08 INFO - Running setup.py (path:/tmp/pip-O8lrCI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:37:08 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)) 08:37:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:37:08 INFO - Running setup.py (path:/tmp/pip-FB3YlS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:37:09 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)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:37:09 INFO - Running setup.py (path:/tmp/pip-20lG4k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:37:09 INFO - Running setup.py (path:/tmp/pip-iIU9sW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:37:09 INFO - Running setup.py (path:/tmp/pip-vTspeE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:37:09 INFO - Running setup.py (path:/tmp/pip-fHKW1o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:37:09 INFO - Running setup.py (path:/tmp/pip-km1em_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:37:09 INFO - Running setup.py (path:/tmp/pip-WlnD31-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:37:09 INFO - Running setup.py (path:/tmp/pip-7_JgIX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:37:09 INFO - Running setup.py (path:/tmp/pip-UiyRHH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:37:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:37:09 INFO - Running setup.py (path:/tmp/pip-exSd9T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:37:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:37:09 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:37:09 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:37:09 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:37:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:37:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:37:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:37:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:37:11 INFO - Downloading blessings-1.6.tar.gz 08:37:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:37:11 INFO - Installing collected packages: blessings 08:37:11 INFO - Running setup.py install for blessings 08:37:11 INFO - Successfully installed blessings 08:37:11 INFO - Cleaning up... 08:37:11 INFO - Return code: 0 08:37:11 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:37:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:37:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:37:12 INFO - Reading from file tmpfile_stdout 08:37:12 INFO - Current package versions: 08:37:12 INFO - argparse == 1.2.1 08:37:12 INFO - blessings == 1.6 08:37:12 INFO - blobuploader == 1.2.4 08:37:12 INFO - docopt == 0.6.1 08:37:12 INFO - functools32 == 3.2.3-2 08:37:12 INFO - jsonschema == 2.5.1 08:37:12 INFO - manifestparser == 1.1 08:37:12 INFO - mozInstall == 1.12 08:37:12 INFO - mozcrash == 1.0 08:37:12 INFO - mozdebug == 0.1 08:37:12 INFO - mozdevice == 0.50 08:37:12 INFO - mozfile == 1.2 08:37:12 INFO - mozhttpd == 0.7 08:37:12 INFO - mozinfo == 0.9 08:37:12 INFO - mozleak == 0.1 08:37:12 INFO - mozlog == 3.4 08:37:12 INFO - moznetwork == 0.27 08:37:12 INFO - mozprocess == 0.25 08:37:12 INFO - mozprofile == 0.28 08:37:12 INFO - mozrunner == 6.13 08:37:12 INFO - mozscreenshot == 0.1 08:37:12 INFO - mozsystemmonitor == 0.3 08:37:12 INFO - moztest == 0.8 08:37:12 INFO - mozversion == 1.4 08:37:12 INFO - psutil == 3.1.1 08:37:12 INFO - requests == 1.2.3 08:37:12 INFO - wsgiref == 0.1.2 08:37:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:37:12 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:37:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:12 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:37:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:12 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 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:37:12 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 08:37:12 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 08:37:12 INFO - Using env: {'DISPLAY': ':0', 08:37:12 INFO - 'HOME': '/home/cltbld', 08:37:12 INFO - 'LANG': 'en_US.UTF-8', 08:37:12 INFO - 'LANGUAGE': 'en_US:en', 08:37:12 INFO - 'LOGNAME': 'cltbld', 08:37:12 INFO - 'MAIL': '/var/mail/cltbld', 08:37:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:37:12 INFO - 'MOZ_NO_REMOTE': '1', 08:37:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:37:12 INFO - 'NO_EM_RESTART': '1', 08:37:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:37:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:37:12 INFO - 'PWD': '/builds/slave/test', 08:37:12 INFO - 'SHELL': '/bin/bash', 08:37:12 INFO - 'SHLVL': '1', 08:37:12 INFO - 'TERM': 'linux', 08:37:12 INFO - 'TMOUT': '86400', 08:37:12 INFO - 'USER': 'cltbld', 08:37:12 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:37:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:37:12 INFO - '_': '/tools/buildbot/bin/python'} 08:37:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:37:12 INFO - Cleaning up... 08:37:12 INFO - Return code: 0 08:37:12 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:37:12 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:37:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:12 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:37:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:37:12 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 0xfd21f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10caa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x126fb10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, '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': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:37:12 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 08:37:12 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 08:37:12 INFO - Using env: {'DISPLAY': ':0', 08:37:12 INFO - 'HOME': '/home/cltbld', 08:37:12 INFO - 'LANG': 'en_US.UTF-8', 08:37:12 INFO - 'LANGUAGE': 'en_US:en', 08:37:12 INFO - 'LOGNAME': 'cltbld', 08:37:12 INFO - 'MAIL': '/var/mail/cltbld', 08:37:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:37:12 INFO - 'MOZ_NO_REMOTE': '1', 08:37:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:37:12 INFO - 'NO_EM_RESTART': '1', 08:37:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:37:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:37:12 INFO - 'PWD': '/builds/slave/test', 08:37:12 INFO - 'SHELL': '/bin/bash', 08:37:12 INFO - 'SHLVL': '1', 08:37:12 INFO - 'TERM': 'linux', 08:37:12 INFO - 'TMOUT': '86400', 08:37:12 INFO - 'USER': 'cltbld', 08:37:12 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:37:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:37:12 INFO - '_': '/tools/buildbot/bin/python'} 08:37:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:37:12 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:37:12 INFO - Cleaning up... 08:37:12 INFO - Return code: 0 08:37:12 INFO - Running post-action listener: _resource_record_post_action 08:37:12 INFO - Running post-action listener: _start_resource_monitoring 08:37:12 INFO - Starting resource monitoring. 08:37:12 INFO - [mozharness: 2017-04-07 15:37:12.621321Z] Finished create-virtualenv step (success) 08:37:12 INFO - [mozharness: 2017-04-07 15:37:12.621826Z] Running install step. 08:37:12 INFO - Running pre-action listener: _resource_record_pre_action 08:37:12 INFO - Running main action method: install 08:37:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:37:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:37:12 INFO - Reading from file tmpfile_stdout 08:37:12 INFO - Detecting whether we're running mozinstall >=1.0... 08:37:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:37:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:37:12 INFO - Reading from file tmpfile_stdout 08:37:12 INFO - Output received: 08:37:12 INFO - Usage: mozinstall [options] installer 08:37:12 INFO - Options: 08:37:12 INFO - -h, --help show this help message and exit 08:37:12 INFO - -d DEST, --destination=DEST 08:37:12 INFO - Directory to install application into. [default: 08:37:12 INFO - "/builds/slave/test"] 08:37:12 INFO - --app=APP Application being installed. [default: firefox] 08:37:12 INFO - mkdir: /builds/slave/test/build/application 08:37:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:37:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 08:37:27 INFO - Reading from file tmpfile_stdout 08:37:27 INFO - Output received: 08:37:27 INFO - /builds/slave/test/build/application/firefox/firefox 08:37:27 INFO - Running post-action listener: _resource_record_post_action 08:37:27 INFO - [mozharness: 2017-04-07 15:37:27.662239Z] Finished install step (success) 08:37:27 INFO - [mozharness: 2017-04-07 15:37:27.662512Z] Running run-tests step. 08:37:27 INFO - Running pre-action listener: _resource_record_pre_action 08:37:27 INFO - Running main action method: run_tests 08:37:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:37:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:37:27 INFO - Python 2.7.3 08:37:27 INFO - Return code: 0 08:37:27 INFO - grabbing minidump binary from tooltool 08:37: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:37:27 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x126d290>, '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 0x126db90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x126e040>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:37:27 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 08:37:27 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 08:37:27 INFO - Calling ['/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'] with output_timeout 600 08:37:27 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:37:27 INFO - Return code: 0 08:37:27 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:37:27 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:37:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:37:27 INFO - ENV: RUST_BACKTRACE is now 1 08:37:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:37:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:37:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-078', '--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 08:37:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-078 --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 08:37:27 INFO - Using env: {'DISPLAY': ':0', 08:37:27 INFO - 'HOME': '/home/cltbld', 08:37:27 INFO - 'LANG': 'en_US.UTF-8', 08:37:27 INFO - 'LANGUAGE': 'en_US:en', 08:37:27 INFO - 'LOGNAME': 'cltbld', 08:37:27 INFO - 'MAIL': '/var/mail/cltbld', 08:37:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:37:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:37:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:37:27 INFO - 'MOZ_NO_REMOTE': '1', 08:37:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:37:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:37:27 INFO - 'NO_EM_RESTART': '1', 08:37:27 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:37:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:37:27 INFO - 'PWD': '/builds/slave/test', 08:37:27 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:37:27 INFO - 'RUST_BACKTRACE': '1', 08:37:27 INFO - 'SHELL': '/bin/bash', 08:37:27 INFO - 'SHLVL': '1', 08:37:27 INFO - 'TERM': 'linux', 08:37:27 INFO - 'TMOUT': '86400', 08:37:27 INFO - 'USER': 'cltbld', 08:37:27 INFO - 'XDG_SESSION_COOKIE': 'dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127', 08:37:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:37:27 INFO - '_': '/tools/buildbot/bin/python'} 08:37:27 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-078', '--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 08:37:27 INFO - mozversion application_buildid: 20170407145947 08:37:27 INFO - mozversion application_changeset: 19e555dcd7e28ffae4440fb2220f1671cb81d6de 08:37:27 INFO - mozversion application_display_name: Nightly 08:37:27 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:37:27 INFO - mozversion application_name: Firefox 08:37:27 INFO - mozversion application_remotingname: firefox 08:37:27 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 08:37:27 INFO - mozversion application_vendor: Mozilla 08:37:27 INFO - mozversion application_version: 55.0a1 08:37:27 INFO - mozversion platform_buildid: 20170407145947 08:37:27 INFO - mozversion platform_changeset: 19e555dcd7e28ffae4440fb2220f1671cb81d6de 08:37:27 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 08:37:27 INFO - mozversion platform_version: 55.0a1 08:37:27 INFO - using testdate: 1491579447 08:37:27 INFO - actual date: 1491579447 08:37:27 INFO - starting webserver on 'localhost:47817' 08:37:27 INFO - SUITE-START | Running 2 tests 08:37:27 INFO - TEST-START | dromaeo_css 08:37:27 INFO - operating with platform_type : linux_ 08:37:27 INFO - Initialising browser for dromaeo_css test... 08:37:27 INFO - TEST-INFO | started process 7520 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnp5LPd/profile http://localhost:47817/getInfo.html) 08:37:32 INFO - PID 7520 | __metrics Screen width/height:1600/1200 08:37:32 INFO - PID 7520 | colorDepth:24 08:37:32 INFO - PID 7520 | Browser inner width/height: 1024/697 08:37:32 INFO - PID 7520 | __metrics 08:37:33 INFO - PID 7520 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:37:33 INFO - PID 7520 | JavaScript error: resource:///modules/BrowserUsageTelemetry.jsm, line 304: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:37:34 INFO - TEST-INFO | 7520: exit 0 08:37:34 INFO - Browser initialized. 08:37:34 INFO - Running cycle 1/1 for dromaeo_css test... 08:37:34 INFO - TEST-INFO | started process 7612 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnp5LPd/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:37:46 INFO - PID 7612 | RSS: Main: 154202112 08:37:46 INFO - PID 7612 | 08:40:53 INFO - PID 7612 | Cycle 1(1): loaded http://localhost:47817/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47817/tests/dromaeo/cssquery-ext.html) 08:40:55 INFO - PID 7612 | RSS: Main: 342028288 08:40:55 INFO - PID 7612 | 08:42:36 INFO - PID 7612 | ************************* 08:42:36 INFO - PID 7612 | A coding exception was thrown and uncaught in a Task. 08:42:36 INFO - PID 7612 | 08:42:36 ERROR - PID 7612 | Full message: TypeError: NetworkError when attempting to fetch resource. 08:42:36 INFO - PID 7612 | Full stack: 08:42:36 INFO - PID 7612 | ************************* 08:42:36 INFO - PID 7612 | ************************* 08:42:36 INFO - PID 7612 | A coding exception was thrown and uncaught in a Task. 08:42:36 INFO - PID 7612 | 08:42:36 ERROR - PID 7612 | Full message: TypeError: NetworkError when attempting to fetch resource. 08:42:36 INFO - PID 7612 | Full stack: 08:42:36 INFO - PID 7612 | ************************* 08:42:36 INFO - PID 7612 | ************************* 08:42:36 INFO - PID 7612 | A coding exception was thrown and uncaught in a Task. 08:42:36 INFO - PID 7612 | 08:42:36 ERROR - PID 7612 | Full message: TypeError: NetworkError when attempting to fetch resource. 08:42:36 INFO - PID 7612 | Full stack: 08:42:36 INFO - PID 7612 | ************************* 08:42:36 INFO - PID 7612 | ************************* 08:42:36 INFO - PID 7612 | A coding exception was thrown and uncaught in a Task. 08:42:36 INFO - PID 7612 | 08:42:36 ERROR - PID 7612 | Full message: TypeError: NetworkError when attempting to fetch resource. 08:42:36 INFO - PID 7612 | Full stack: 08:42:36 INFO - PID 7612 | ************************* 08:43:58 INFO - PID 7612 | Cycle 1(1): loaded http://localhost:47817/tests/dromaeo/cssquery-ext.html (next: http://localhost:47817/tests/dromaeo/cssquery-jquery.html) 08:43:58 INFO - PID 7612 | RSS: Main: 238411776 08:43:58 INFO - PID 7612 | 08:47:00 INFO - PID 7612 | Cycle 1(1): loaded http://localhost:47817/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47817/tests/dromaeo/cssquery-mootools.html) 08:47:01 INFO - PID 7612 | RSS: Main: 207220736 08:47:01 INFO - PID 7612 | 08:50:03 INFO - PID 7612 | Cycle 1(1): loaded http://localhost:47817/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47817/tests/dromaeo/cssquery-prototype.html) 08:50:04 INFO - PID 7612 | RSS: Main: 179175424 08:50:04 INFO - PID 7612 | 08:53:07 INFO - PID 7612 | Cycle 1(1): loaded http://localhost:47817/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47817/tests/dromaeo/cssquery-yui.html) 08:53:07 INFO - PID 7612 | RSS: Main: 188456960 08:53:07 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | Cycle 1(1): loaded http://localhost:47817/tests/dromaeo/cssquery-yui.html (next: http://localhost:47817/tests/dromaeo/cssquery-dojo.html) 08:56:10 INFO - PID 7612 | RSS: Main: 271118336 08:56:10 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | __start_tp_report 08:56:10 INFO - PID 7612 | _x_x_mozilla_page_load 08:56:10 INFO - PID 7612 | _x_x_mozilla_page_load_details 08:56:10 INFO - PID 7612 | |i|pagename|runs| 08:56:10 INFO - PID 7612 | |0;dojo.html;2686.4627074585082;2725.6184134221226;2731.576605626128;2755.1321333779856;2755.966512557791;5158.123119069758;5310.522053015228;5331.520163185312;5331.520163185312;5423.511883930445;5281.207818827178;5281.2342210379475;5298.92051619226;5309.33633295838;5311.2298716686155;4709.293605959117;4728.550787675165;4761.285807128941;4773.832915847946;4802.25565037418;4767.90464190716;4801.639877009221;4802.279658051285;4805.735684537349;4812.68717533361;4793.832215872445;4799.016201678665;4804.231322988323;4805.255185446262;4809.807607695706;4781.211100168468;4800.3279540864305;4804.375431193957;4808.543188397097;4808.975955120202;4733.692309999873;4741.359916411275;4765.356676848615;4774.689645173087;4775.594074503671;5331.253624492574;5409.918851217235;5409.9459005409835;5413.350397952271;5433.809816656438;5591.329040515124;5769.855753606152;5780.248567686216;5785.2189954356045;5841.474267315962;5744.6840423776675;5784.8843023139725;5786.768529258825;5798.855028624276;5805.941940580582;4343.782810859476;5329.54698850602;5396.460353964572;5409.756560954727;5414.3232095988005;5920.4967577755515;5933.732982015819;5933.881322373529;5941.732622031933;5946.048632218911;5510.504054635102;5643.887122257532;5657.405972372924;5662.122371032414;5663.830085097454;5744.770209191585;5765.682887441147;5768.855778605568;5771.336296325892;5778.971105144531;5726.570507211893;5770.2498675171955;5794.594378393556;5797.623154495029;5820.912686309709;5714.685692286881;5749.453801888814;5759.7408116634015;5775.220345253421;5775.653460792366;4786.138495070921;4851.466338702739;4893.4617192108835;4895.437024742129;4950.628702847301;4137.131202447459;4150.086980864205;4150.543440221573;4162.209180255742;4185.874423767292;4900.779464924087;4907.509249075135;4907.55831975124;4908.705477671279;4912.238603016538;5743.396943320975;5794.50746686528;5795.739191736382;5796.768129274782;5799.101139323411;4796.976015119972;4860.756962151878;4867.3915760529935;4867.975660121677;4914.70511769295;5159.484051594811;5161.096808058574;5162.174052151638;5170.560502357266;5179.870503237449;5271.630985830955;5338.97330513345;5353.812616558402;5354.54486368663;5360.490753378423;5850;5857.58996870215;5863.560232982458;5889.263842019747;5909.497692696169;5352;5390.649607775482;5392.568594512508;5393.649412788156;5411.134218525174;5593.552515798645;5666.660000399989;5738.856528586819;5742.138679198154;5743.511801496752;5780.768769249351;5785.4214578541805;5817.7963771267805;5870.471657550841;5873.353931067664;5607.495325420732;5654.491095801398;5696.857578560569;5700.486956173964;5710.5717071219;5599.384067752625;5632;5632.436756324335;5641.548676105984;5647.237622920853;5368.677879327252;5453.072977593898;5512.641678290898;5573.916391254053;5579.637323573955;5636.21093046982;5664.178694089416;5664.773409063591;5692.857678558069;5743.396943321059;5533.00405926937;5571.303587051619;5578.079616863334;5580.441955804549;5586.86032849182 08:56:10 INFO - PID 7612 | |1;ext.html;733.8018734941566;747.7681918605231;1049.06109032416;1062.7236918401213;1180.7579446213526;32216.67783322166;33528.66471335286;33538.83230583847;33544.161395965115;33591.328173436515;31384.843075784647;31768.20579485514;31789;31797.205069873206;31842.522362164527;5492.533134683556;5601.131824567198;6666.0667506549125;6801.251862295144;6808.557443766164;6979.720811167547;7156.785296441115;7160.64196790161;7165.319294666998;7166.892496612555;7212.819679508002;7263.1284245890565;7265.564066156021;7270.418366530691;7271.345578897898;7179.820504487378;7226.891596626002;7234.385077268438;7236.312550307739;7239.638018099126;7203.639818009078;7251.057362542836;7259.89110163348;7263.455240856904;7264.818379540501;31998.360032799214;32243.19392015195;32251.354972900644;32398.6760132398;32403.675963240537;3027.1523973287512;3061.158181500083;3063.3720087382035;3069.2020074780494;3069.478188707925;24641.38396540083;24672.136475223462;24710.752892471024;24723.50552988948;24763.5047299053;3063.188255112397;3098.055093196574;3098.5662007318992;3125.1249650098007;3139.450596145688;134513;134708;134880.32559837235;135068.32465837608;135078;33715.83142084274;34594;38875.61124388777;40113;40285.59714402877;41132.588674113475;41142;41157.38263926043;41179.382309265384;41187.382189267184;12503.937480312723;12591.055670824542;12678.9366053171;12679.112462127563;12728.745425091447;9936.20510359184;9999.800003999879;10008.849867251996;10087;10094.192464602815;11444.713882153013;11527.76944461106;11593.014593759457;11719.296842189326;11744.76510469803;4776.426828780569;4789.784459699322;4797.208460604031;4813.927791083137;4831.806727730851;865.4720620421538;874.5190145419994;877.1886005444937;877.916597923209;895.5343221524771;19191;20078.297259595845;20455.8977205113;20488.59022819565;20830.791692082887;942.3074040580168;956.416585882611;964.9807003860024;973.8831340239217;980.3970558106855;10380.216013710102;10733.731656708489;10802.945985270024;10850.0777433919;11091.944540277247;181085;181532;181952;182019;182776;40216.59783402187;40418.79790601028;40437;40466;40496.39255411171;1198.8335673398965;1210.5520957245699;1216.1000859364008;1217.379136640302;1228.3244215681339;18613.906930465262;19075.80924190796;20052.197912083353;20093.49766255855;20348.79651203469;29658;29682.10953671393;29692.703072968994;29705.554416683335;29728;175181.12409438382;176093;176196.11901940408;176244.1187794104;176299;22574.661380078982;23043.193488227833;26271.343216419744;28155.155345339674;28244.293892652848;32026;32061.358772823947;32201;32394.67605324011;32981.50527742038;24865.39990101837;24874.751252487968;25419.237422877344;25811.354716132246;25972.694377112435;24973.87513062423;25229.24312270635;25482.490350193264;25620.103296384535;25679;27260.591091133254;28044.055374185416;28131.71868281291;28193.859030705535;28226;24290.75709242885;24512.75487245105;25117.87441062783;25785.355366115997;25870.87064564665;19796.703049454558;20767.169313227907;20813.58372832565;20816.60140174071;20829.583408331444 08:56:10 INFO - PID 7612 | |2;jquery.html;407.2465938014673;414.34326592351124;422.75902735440803;435.16665585403945;447.34464010225014;17898.284068637273;18147.546311342223;18235.908820455912;18882.33911813087;18964.90517547412;18324.725129123042;18601.7209741854;18998.90500547499;19176.71234931477;19210.615787684237;5589.832305030835;5605.159226116074;5743.310802703661;5786.421357864201;5791.971040144815;5641.971790141043;5768.423157684219;5771.509421699139;5773.422657734235;5776.364599894008;5565.30433695788;5695.060315048012;5703.57223208259;5711.2575365202465;5713.085906255;5437.293151890269;5574.10814269717;5607.523360514361;5612.147991162907;5616.073347897613;5083.61872859537;5137.717425541594;5145.125328694094;5145.845624631267;5146.459621739701;21836.23573174947;22171.00230489632;22277.331680049625;22387;22546.661800073012;1641.6798724248777;1671.35652773683;1677.7064013797537;1678.7230107032326;1679.9916000420042;14612.926935365362;14716.705665886622;14947.252637368198;15031.699366012728;15080.849191508054;2030.644637188486;2067.059487932987;2113.323736404351;2142.121730090671;2162.059504115715;80034.5998270005;80054.59972700158;80309;81691.5915420425;81795.18204817935;10864.619738309122;11058.668239952814;11166;11177.49701263445;11267.605633802777;15403.306851191499;15413.691726165414;15424.922875385551;15442.768358474632;15452.072875627498;6899.318090653799;7080.929190708027;7271.381932535688;7279.963600181965;7281.854362912712;6348.206474190726;6359.6184228945485;6375.904361434582;6542.934570654233;6544.934550654528;6869.450443964471;6880.311968803079;6946.305369463013;7012.333828286304;7080.929190708027;1979.9406017819201;1995.1420889017572;2002.3092033248506;2021.6866385710239;2025.2607798153567;863.9827203455895;887.8890138732659;894.7226359828474;895.5029958373035;922.377395258198;16776.65786737058;16999.575010624587;17653.558661033578;17664.9116754418;18001.459956201335;893.2675206330747;895.5164211325811;901.4005686218591;903.3992395057345;920.9815803684023;9325.906740932503;9473.952630236805;9842.163416109568;9886.068358984552;9928.751781205383;434294;436893;445698;447709;449785;92989;93605;94420.52789736008;95574.52212739032;95647.52176239074;1083.101026148295;1094.8631421072366;1132.4733998690483;1137.7155711072232;1138.573035111833;17339.2197351122;17777.911110444365;17853.125421830522;18935.14791834343;19059.618807624047;44913.01426118096;45998.77000614975;46021;46435;47064;51178.74410627923;54624.72687636536;54921.72539137279;55062;55499.44500554943;7759.466499325174;7765.339946104418;7788.688452461838;7907.84184316299;8067.5797260820345;12011.099167562643;12089.81865272004;12173.20874143178;12263.202891812003;12325.260484370609;10104.494775261355;10134.391936483835;10395.376277423378;10742.462876856282;10777.407242601732;10374.844377334497;10394.58421663125;10557.366558006544;10647.361158330525;10896.237263391486;10744.355338679705;10870.130389568974;11046.226764126433;11101.056410205223;11213.60752373663;7924;8015.559144247122;8192.484390387797;8231.218034286732;8275.131111233233;9959.352642078242;10030.899691002996;10253.692389228336;10322.587096516056;10547.578096876347 08:56:10 INFO - PID 7612 | |3;mootools.html;1133.1501373969522;1276.5787290194237;1333.2800287844564;1344.166616697647;1348.7504811609854;8574.271186949109;9820.901790982098;10110.595576176953;10167.949160254208;10182.439965801877;9925.354851934619;10014.198864090873;10024.348417352885;10034.347767395115;10043.447610381427;1941.9805801942011;2269.954600907985;2293.747687754346;2294.437862723635;2297.356740112771;1999.2103119267954;2277.954440911181;2368.017272831773;2371.774681405264;2379.1553998330605;2203.603351396748;2221.244776775896;2225.621644320461;2228.765979572146;2234.7876951689564;2206.5145667953025;2240.305505293356;2244.3827947314458;2247.0113150213933;2250.606143924823;2191.82465402769;2199.3841724317217;2202.405350555341;2206.2388475975763;2207.2054060538194;10211.6425925093;10277.743056423575;10294.43380614066;10302.639407620773;10304.433256170907;5731.340895796995;5906.675132867691;5938.346781854036;5939.643621382731;5952.1964534787685;3355.899323020313;3453.033150717803;3575.94636080459;3589.6769290763696;3597.8740744074094;1072.6781965410346;1104.1332553945194;1153.3887039868882;1155.699518125285;1159.4550561236206;14446.855531444657;14455.638609034753;14455.927720361437;14466.204358760264;14470.348834302376;5084.51697088776;5103.948960510347;5111.309973153651;5292.311999440049;5299.417064122943;12092.39538023113;12106.81839772404;12117.575884843987;12119.454624541917;12141.964508872781;5797.710114494258;5800.100984347433;5816.651000939957;5817.592768506164;5837.270341207349;5163.97418012915;5239.476052394806;5247.134222853187;5408.756605952742;5456.863578410572;4225.535191128974;4267.338562522814;4297.871063868089;4344.196323680129;4353.760543170156;1340.2360654426884;1354.6477915741782;1355.4578168732585;1381.7927310903244;1386.272207091265;700.7057036044873;712.7826013066065;727.7198278662753;739.5636574421118;753.9132999705104;5463.235147079412;5519.2824932758485;5729.427057294237;5833.88332233353;6599.175103112111;841.5077179849857;842.3177226446597;842.8567143585606;846.7205822078822;868.2446271743497;3980.8606698765984;4048.959510404858;4052.574479679591;4087.0395457067566;4130.091379896418;12933.54732584355;13395.732085358239;13464.461421543225;13464.663383415493;13467.393967271497;13128.540501082416;13195.670108247179;13208.075434719478;13228.735425291441;13244.867551324363;9620.75948101303;9668.564914578861;9776.071273229032;9945.303828732063;9952.054554817281;6080.8783824324155;6247.68761561911;6257.4994000480765;6317.368263173646;6443.742250309935;11962.880371196177;12103.576374826838;12226;12308;12332.136750427384;10316.226283028653;12447.875521245034;12593.181443206162;12630.684232894251;12632.873671263169;7623.123340815877;7738.303552680286;7826.491278066907;7828.804279893048;7830.2952734254195;9176.632934682539;9216.631334746804;9258.398204116711;9332.673356432764;9333.160015598358;8286.295664868312;8440.831183376175;8465.492070475791;8571.185737354941;8651.48091114535;7763.10724266694;7963.601819908866;8128.471649342774;8131.878021829795;8169.346452283922;7114.786556403316;7142.250063743232;7272.563646181246;7274.454415918722;7277.235890231661;5661.122526008476;5767.2502574666705;5819.4180581943165;5819.476247137778;5921.052631579099;5658.265813151861;5742.741576628978;5773.942260577341;5972.581919265784;5991.221141251609 08:56:10 INFO - PID 7612 | |4;prototype.html;380.85146792750834;395.59253968412537;399.8968008255935;400.1217327965114;405.8437501561898;5331.706756128417;5365.758540865666;5409.106812615582;5415.918761218575;5430.67415955043;5106.183010718286;5204.193350030741;5302.469753024696;5324.227986941891;5332.973335133319;4185.560516145806;4212.452381190441;4226.429432026668;4226.746395216282;4228.260054490467;4224.134052519226;4242.21519018981;4253.574642535753;4256.212600668886;4257;4102.364133559288;4206;4208.97895510522;4215.873523794291;4225.91548169038;4200.621944025037;4206.579342065799;4209.410682504452;4211.936820947688;4233.259179643565;3785.5047256333596;3789.9810500947597;3790.65884070435;3806;3809.980950095232;5094.541491265803;5159.948400515985;5174.197999310075;5193.4938867728315;5217.087009773312;4551.726896386227;4710.905781884378;4733.3846599942135;4742.644301677388;4744.928826067612;5568.888622227573;5570.303712035996;5573.749181286852;5587.1339942309005;5595.580331475156;3983.50206224222;3989.501312335958;4000.2599519089063;4003.11931375097;4015.819288132041;5612.35457922336;5683.573731970118;5814.796482123105;5858.677772722499;5966.241268001175;3970.642642162219;4054.3715724062818;4058.452108965311;4065.735727177724;4083.8366465341055;4115.5678653741525;4135.17296540687;4158.9376159357635;4160.375943608483;4163.208990291835;4489.9775501122285;4570.840020599329;4601.148787474328;4746;4754.072955773591;5552.52803511706;5577.414371491016;5580.19087232349;5581.5813813963305;5603.971980140073;1411.922344271075;1420.7868819676924;1425.415579612354;1435.0170133458614;1439.1796675894848;946.1579194516886;969.8981606931312;976.2531663277598;982.8378317577519;985.2216748768536;4870.9269360959615;4882.584980276645;4883.706977581356;4907.6564640475535;4911.508849115131;5766.88466230673;5771.220885180447;5775.5668324875805;5776.566757493205;5793.754342816314;4716.198246298069;4906.460289368167;4914.33656456381;4916.508349165055;4935.383077115361;3068.3709839482854;3090.5165520550263;3092.2424006118645;3097.1018404662846;3119.1890108571934;5429.864253393618;5434.375046869582;5441.755121019563;5454.863628409322;5456.508914197741;5829.504492118217;5961.433663801932;5980.162777211194;5997.910031349533;5999.340072592011;5399.811006614749;5400;5402.864928376744;5418.647787893853;5423.810166644227;5683.829485115453;5834.0747553306455;5835.3581106077445;5836.591438599257;5837.562182836219;5701.318111157136;5739.823336215982;5757.280339957505;5770.653760774367;5779.768809247751;5162.97418512905;5278.709670968134;5303.204519322133;5313.734313284398;5402.5677945763455;3881.3983832506005;3928.626780455852;3936.8818935430836;3996.820143093626;4021.8994525137105;5773.8556536086935;5784.334801497714;5798.362180160095;5802.4197580241635;5819.447152520504;5464.972675136599;5570.3315602128005;5617.32592088952;5631.183478395692;5632.521235694848;5602.299712535933;5612.130119831432;5617.606767526234;5619.129034999582;5625.718714064362;5391.568674506108;5526.696031718294;5544.972275138599;5546.362168350692;5559.305086864142;5644.209810626434;5650.01124803166;5667.603267771216;5670.631408958405;5681.630694004876;5491.807786727445;5525;5528.668279903219;5541.362743284412;5560.082586373203 08:56:10 INFO - PID 7612 | |5;yui.html;736.028442455958;742.2799884112411;747.193031525952;755.4183278875263;768.3891306411402;13359.398827052783;13614.45542178313;13826.17042977422;14091.084079534836;14120.646983825409;12878;13196;13212.339383030858;13215.141015833964;13348.866511334909;841.1966571923829;857.9356548258875;865.3293697384514;865.7186414415308;866.3026263857593;861.9094995025526;895.5969813583881;898.5956319656149;899.3030401438905;899.6266549381999;932.39394393644;933.8785957825473;934.5187228577288;934.9205317548017;935.1396715022196;929.005963618928;929.5631053404888;929.9767505812341;930.0745757970794;930.0792215706435;680.1430197950568;682.8054004608663;683.0948992584796;683.5181197255922;683.5249501596393;14280.07179533327;14568.12591244518;14650.487232946902;14674.486392976194;14675.339609717588;13040;13699.96956892639;13746.518871839538;13834.515791947335;13993.16041037541;11627.6511704649;11955.641330760003;12006.819897701542;12051.15641905067;12154.513819447211;2824.5198316286283;2849.1879814253048;2862.6421697287838;2867.698891616392;2879.956800647971;65713;65799.34200658028;67028.32971670319;68311;68625.65687171533;10806.135509159249;10827.133829293638;10916.07213386855;10974;10975.780484390267;20239.898800505904;21361.89319053395;22355.217567385065;22847.543049138923;22850.428739281317;6904;6910.239873613898;6992.965035174791;6994.545354551938;7076.32774886385;3427.1089516725333;3449.965500345015;3455.51622772812;3497.667721566498;3503.1417302760988;3806.9428958565645;3873.8063096845044;3896.2012787379085;3902.492675952165;3912.4522566840665;745.8694728422613;779.9649015794303;789.6841263494648;792.4769652029632;792.8374683189933;567.8410045187354;583.3146053387253;592.1739173852537;597.1490625858135;615.7690865925279;8421.831563368822;8807.867881981776;8846.690365837165;8848.734537963872;9146.634134634673;589.9056151015817;596.9940300596938;598.1536126381209;613.2702084519408;616.3651439017818;3753.512043434336;3787.9242415152094;3822.5412950446125;3850.961490385116;3889.5138107736534;65451.67274163694;66932.665336673;67711.5674010978;67940.6602966982;69341.30658693348;57851;57929.4207057924;58552.4144758547;58906;59182.40817591769;39262.411063834064;48662.756686216344;49704.75147624239;50606;51849.2222616661;8674.132586741276;9056.637734490547;9230.630774768933;9231.35380523357;9232.723018309462;26560.468790624465;26980.1905942822;27029.72970270272;27183.86408067947;27708.891644334002;32156.83921580377;32382;32499;32805.83597082095;33049.83475082609;11651.59219427316;11971.521139154685;12089.697757556132;12124.09069319787;12198.634040978784;12992.740145196854;13162.868371316164;13251.867481325064;13327.067105302536;13328;12166.756664866476;12332.445039973043;12469.688257793629;12668.049896258002;13170.275634840176;11011.504482298156;11128.332300062022;11254.268472549258;11333.689236587637;11720.296782193096;11178.552857885594;11199.104071674083;11369.829452558053;11474.196806223485;11508.194426390073;8888.422252553562;8977.730668079968;9047.954760226157;9171.128742769426;9239.538023098952;9035.774105647411;9190;9466.857997130186;9478.668246611336;9522.571484283086 08:56:10 INFO - PID 7612 | __end_tp_report 08:56:10 INFO - PID 7612 | __start_cc_report 08:56:10 INFO - PID 7612 | _x_x_mozilla_cycle_collect,2150 08:56:10 INFO - PID 7612 | __end_cc_report 08:56:10 INFO - PID 7612 | __startTimestamp1491580570590__endTimestamp 08:56:10 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | ------- Summary: start ------- 08:56:10 INFO - PID 7612 | Number of tests: 6 08:56:10 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | [#0] dojo.html Cycles:165 Average:5277.62 Median:5413.35 stddev:632.96 (11.7%) stddev-sans-first:601.37 08:56:10 INFO - PID 7612 | Values: 2686.5 2725.6 2731.6 2755.1 2756.0 5158.1 5310.5 5331.5 5331.5 5423.5 5281.2 5281.2 5298.9 5309.3 5311.2 4709.3 4728.6 4761.3 4773.8 4802.3 4767.9 4801.6 4802.3 4805.7 4812.7 4793.8 4799.0 4804.2 4805.3 4809.8 4781.2 4800.3 4804.4 4808.5 4809.0 4733.7 4741.4 4765.4 4774.7 4775.6 5331.3 5409.9 5409.9 5413.4 5433.8 5591.3 5769.9 5780.2 5785.2 5841.5 5744.7 5784.9 5786.8 5798.9 5805.9 4343.8 5329.5 5396.5 5409.8 5414.3 5920.5 5933.7 5933.9 5941.7 5946.0 5510.5 5643.9 5657.4 5662.1 5663.8 5744.8 5765.7 5768.9 5771.3 5779.0 5726.6 5770.2 5794.6 5797.6 5820.9 5714.7 5749.5 5759.7 5775.2 5775.7 4786.1 4851.5 4893.5 4895.4 4950.6 4137.1 4150.1 4150.5 4162.2 4185.9 4900.8 4907.5 4907.6 4908.7 4912.2 5743.4 5794.5 5795.7 5796.8 5799.1 4797.0 4860.8 4867.4 4868.0 4914.7 5159.5 5161.1 5162.2 5170.6 5179.9 5271.6 5339.0 5353.8 5354.5 5360.5 5850.0 5857.6 5863.6 5889.3 5909.5 5352.0 5390.6 5392.6 5393.6 5411.1 5593.6 5666.7 5738.9 5742.1 5743.5 5780.8 5785.4 5817.8 5870.5 5873.4 5607.5 5654.5 5696.9 5700.5 5710.6 5599.4 5632.0 5632.4 5641.5 5647.2 5368.7 5453.1 5512.6 5573.9 5579.6 5636.2 5664.2 5664.8 5692.9 5743.4 5533.0 5571.3 5578.1 5580.4 5586.9 08:56:10 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | [#1] ext.html Cycles:180 Average:30025.56 Median:16377.58 stddev:42810.19 (261.4%) stddev-sans-first:42873.78 08:56:10 INFO - PID 7612 | Values: 733.8 747.8 1049.1 1062.7 1180.8 32216.7 33528.7 33538.8 33544.2 33591.3 31384.8 31768.2 31789.0 31797.2 31842.5 5492.5 5601.1 6666.1 6801.3 6808.6 6979.7 7156.8 7160.6 7165.3 7166.9 7212.8 7263.1 7265.6 7270.4 7271.3 7179.8 7226.9 7234.4 7236.3 7239.6 7203.6 7251.1 7259.9 7263.5 7264.8 31998.4 32243.2 32251.4 32398.7 32403.7 3027.2 3061.2 3063.4 3069.2 3069.5 24641.4 24672.1 24710.8 24723.5 24763.5 3063.2 3098.1 3098.6 3125.1 3139.5 134513.0 134708.0 134880.3 135068.3 135078.0 33715.8 34594.0 38875.6 40113.0 40285.6 41132.6 41142.0 41157.4 41179.4 41187.4 12503.9 12591.1 12678.9 12679.1 12728.7 9936.2 9999.8 10008.8 10087.0 10094.2 11444.7 11527.8 11593.0 11719.3 11744.8 4776.4 4789.8 4797.2 4813.9 4831.8 865.5 874.5 877.2 877.9 895.5 19191.0 20078.3 20455.9 20488.6 20830.8 942.3 956.4 965.0 973.9 980.4 10380.2 10733.7 10802.9 10850.1 11091.9 181085.0 181532.0 181952.0 182019.0 182776.0 40216.6 40418.8 40437.0 40466.0 40496.4 1198.8 1210.6 1216.1 1217.4 1228.3 18613.9 19075.8 20052.2 20093.5 20348.8 29658.0 29682.1 29692.7 29705.6 29728.0 175181.1 176093.0 176196.1 176244.1 176299.0 22574.7 23043.2 26271.3 28155.2 28244.3 32026.0 32061.4 32201.0 32394.7 32981.5 24865.4 24874.8 25419.2 25811.4 25972.7 24973.9 25229.2 25482.5 25620.1 25679.0 27260.6 28044.1 28131.7 28193.9 28226.0 24290.8 24512.8 25117.9 25785.4 25870.9 19796.7 20767.2 20813.6 20816.6 20829.6 08:56:10 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | [#2] jquery.html Cycles:180 Average:27571.44 Median:223072.67 stddev:73397.75 (32.9%) stddev-sans-first:73575.31 08:56:10 INFO - PID 7612 | Values: 407.2 414.3 422.8 435.2 447.3 17898.3 18147.5 18235.9 18882.3 18964.9 18324.7 18601.7 18998.9 19176.7 19210.6 5589.8 5605.2 5743.3 5786.4 5792.0 5642.0 5768.4 5771.5 5773.4 5776.4 5565.3 5695.1 5703.6 5711.3 5713.1 5437.3 5574.1 5607.5 5612.1 5616.1 5083.6 5137.7 5145.1 5145.8 5146.5 21836.2 22171.0 22277.3 22387.0 22546.7 1641.7 1671.4 1677.7 1678.7 1680.0 14612.9 14716.7 14947.3 15031.7 15080.8 2030.6 2067.1 2113.3 2142.1 2162.1 80034.6 80054.6 80309.0 81691.6 81795.2 10864.6 11058.7 11166.0 11177.5 11267.6 15403.3 15413.7 15424.9 15442.8 15452.1 6899.3 7080.9 7271.4 7280.0 7281.9 6348.2 6359.6 6375.9 6542.9 6544.9 6869.5 6880.3 6946.3 7012.3 7080.9 1979.9 1995.1 2002.3 2021.7 2025.3 864.0 887.9 894.7 895.5 922.4 16776.7 16999.6 17653.6 17664.9 18001.5 893.3 895.5 901.4 903.4 921.0 9325.9 9474.0 9842.2 9886.1 9928.8 434294.0 436893.0 445698.0 447709.0 449785.0 92989.0 93605.0 94420.5 95574.5 95647.5 1083.1 1094.9 1132.5 1137.7 1138.6 17339.2 17777.9 17853.1 18935.1 19059.6 44913.0 45998.8 46021.0 46435.0 47064.0 51178.7 54624.7 54921.7 55062.0 55499.4 7759.5 7765.3 7788.7 7907.8 8067.6 12011.1 12089.8 12173.2 12263.2 12325.3 10104.5 10134.4 10395.4 10742.5 10777.4 10374.8 10394.6 10557.4 10647.4 10896.2 10744.4 10870.1 11046.2 11101.1 11213.6 7924.0 8015.6 8192.5 8231.2 8275.1 9959.4 10030.9 10253.7 10322.6 10547.6 08:56:10 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | [#3] mootools.html Cycles:180 Average:6454.07 Median:4108.57 stddev:4025.98 (98.0%) stddev-sans-first:4017.41 08:56:10 INFO - PID 7612 | Values: 1133.2 1276.6 1333.3 1344.2 1348.8 8574.3 9820.9 10110.6 10167.9 10182.4 9925.4 10014.2 10024.3 10034.3 10043.4 1942.0 2270.0 2293.7 2294.4 2297.4 1999.2 2278.0 2368.0 2371.8 2379.2 2203.6 2221.2 2225.6 2228.8 2234.8 2206.5 2240.3 2244.4 2247.0 2250.6 2191.8 2199.4 2202.4 2206.2 2207.2 10211.6 10277.7 10294.4 10302.6 10304.4 5731.3 5906.7 5938.3 5939.6 5952.2 3355.9 3453.0 3575.9 3589.7 3597.9 1072.7 1104.1 1153.4 1155.7 1159.5 14446.9 14455.6 14455.9 14466.2 14470.3 5084.5 5103.9 5111.3 5292.3 5299.4 12092.4 12106.8 12117.6 12119.5 12142.0 5797.7 5800.1 5816.7 5817.6 5837.3 5164.0 5239.5 5247.1 5408.8 5456.9 4225.5 4267.3 4297.9 4344.2 4353.8 1340.2 1354.6 1355.5 1381.8 1386.3 700.7 712.8 727.7 739.6 753.9 5463.2 5519.3 5729.4 5833.9 6599.2 841.5 842.3 842.9 846.7 868.2 3980.9 4049.0 4052.6 4087.0 4130.1 12933.5 13395.7 13464.5 13464.7 13467.4 13128.5 13195.7 13208.1 13228.7 13244.9 9620.8 9668.6 9776.1 9945.3 9952.1 6080.9 6247.7 6257.5 6317.4 6443.7 11962.9 12103.6 12226.0 12308.0 12332.1 10316.2 12447.9 12593.2 12630.7 12632.9 7623.1 7738.3 7826.5 7828.8 7830.3 9176.6 9216.6 9258.4 9332.7 9333.2 8286.3 8440.8 8465.5 8571.2 8651.5 7763.1 7963.6 8128.5 8131.9 8169.3 7114.8 7142.3 7272.6 7274.5 7277.2 5661.1 5767.3 5819.4 5819.5 5921.1 5658.3 5742.7 5773.9 5972.6 5991.2 08:56:10 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | [#4] prototype.html Cycles:180 Average:4657.87 Median:5308.47 stddev:1343.60 (25.3%) stddev-sans-first:1308.45 08:56:10 INFO - PID 7612 | Values: 380.9 395.6 399.9 400.1 405.8 5331.7 5365.8 5409.1 5415.9 5430.7 5106.2 5204.2 5302.5 5324.2 5333.0 4185.6 4212.5 4226.4 4226.7 4228.3 4224.1 4242.2 4253.6 4256.2 4257.0 4102.4 4206.0 4209.0 4215.9 4225.9 4200.6 4206.6 4209.4 4211.9 4233.3 3785.5 3790.0 3790.7 3806.0 3810.0 5094.5 5159.9 5174.2 5193.5 5217.1 4551.7 4710.9 4733.4 4742.6 4744.9 5568.9 5570.3 5573.7 5587.1 5595.6 3983.5 3989.5 4000.3 4003.1 4015.8 5612.4 5683.6 5814.8 5858.7 5966.2 3970.6 4054.4 4058.5 4065.7 4083.8 4115.6 4135.2 4158.9 4160.4 4163.2 4490.0 4570.8 4601.1 4746.0 4754.1 5552.5 5577.4 5580.2 5581.6 5604.0 1411.9 1420.8 1425.4 1435.0 1439.2 946.2 969.9 976.3 982.8 985.2 4870.9 4882.6 4883.7 4907.7 4911.5 5766.9 5771.2 5775.6 5776.6 5793.8 4716.2 4906.5 4914.3 4916.5 4935.4 3068.4 3090.5 3092.2 3097.1 3119.2 5429.9 5434.4 5441.8 5454.9 5456.5 5829.5 5961.4 5980.2 5997.9 5999.3 5399.8 5400.0 5402.9 5418.6 5423.8 5683.8 5834.1 5835.4 5836.6 5837.6 5701.3 5739.8 5757.3 5770.7 5779.8 5163.0 5278.7 5303.2 5313.7 5402.6 3881.4 3928.6 3936.9 3996.8 4021.9 5773.9 5784.3 5798.4 5802.4 5819.4 5465.0 5570.3 5617.3 5631.2 5632.5 5602.3 5612.1 5617.6 5619.1 5625.7 5391.6 5526.7 5545.0 5546.4 5559.3 5644.2 5650.0 5667.6 5670.6 5681.6 5491.8 5525.0 5528.7 5541.4 5560.1 08:56:10 INFO - PID 7612 | 08:56:10 INFO - PID 7612 | [#5] yui.html Cycles:180 Average:14596.61 Median:43962.58 stddev:18003.49 (41.0%) stddev-sans-first:18023.91 08:56:10 INFO - PID 7612 | Values: 736.0 742.3 747.2 755.4 768.4 13359.4 13614.5 13826.2 14091.1 14120.6 12878.0 13196.0 13212.3 13215.1 13348.9 841.2 857.9 865.3 865.7 866.3 861.9 895.6 898.6 899.3 899.6 932.4 933.9 934.5 934.9 935.1 929.0 929.6 930.0 930.1 930.1 680.1 682.8 683.1 683.5 683.5 14280.1 14568.1 14650.5 14674.5 14675.3 13040.0 13700.0 13746.5 13834.5 13993.2 11627.7 11955.6 12006.8 12051.2 12154.5 2824.5 2849.2 2862.6 2867.7 2880.0 65713.0 65799.3 67028.3 68311.0 68625.7 10806.1 10827.1 10916.1 10974.0 10975.8 20239.9 21361.9 22355.2 22847.5 22850.4 6904.0 6910.2 6993.0 6994.5 7076.3 3427.1 3450.0 3455.5 3497.7 3503.1 3806.9 3873.8 3896.2 3902.5 3912.5 745.9 780.0 789.7 792.5 792.8 567.8 583.3 592.2 597.1 615.8 8421.8 8807.9 8846.7 8848.7 9146.6 589.9 597.0 598.2 613.3 616.4 3753.5 3787.9 3822.5 3851.0 3889.5 65451.7 66932.7 67711.6 67940.7 69341.3 57851.0 57929.4 58552.4 58906.0 59182.4 39262.4 48662.8 49704.8 50606.0 51849.2 8674.1 9056.6 9230.6 9231.4 9232.7 26560.5 26980.2 27029.7 27183.9 27708.9 32156.8 32382.0 32499.0 32805.8 33049.8 11651.6 11971.5 12089.7 12124.1 12198.6 12992.7 13162.9 13251.9 13327.1 13328.0 12166.8 12332.4 12469.7 12668.0 13170.3 11011.5 11128.3 11254.3 11333.7 11720.3 11178.6 11199.1 11369.8 11474.2 11508.2 8888.4 8977.7 9048.0 9171.1 9239.5 9035.8 9190.0 9466.9 9478.7 9522.6 08:56:10 INFO - PID 7612 | -------- Summary: end -------- 08:56:10 INFO - PID 7612 | 08:56:11 INFO - TEST-INFO | 7612: exit 0 08:56:11 INFO - TEST-OK | dromaeo_css | took 1123503ms 08:56:11 INFO - TEST-START | kraken 08:56:11 INFO - operating with platform_type : linux_ 08:56:11 INFO - Initialising browser for kraken test... 08:56:11 INFO - TEST-INFO | started process 7938 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2f_h4m/profile http://localhost:47817/getInfo.html) 08:56:15 INFO - PID 7938 | __metrics Screen width/height:1600/1200 08:56:15 INFO - PID 7938 | colorDepth:24 08:56:15 INFO - PID 7938 | Browser inner width/height: 1024/697 08:56:15 INFO - PID 7938 | __metrics 08:56:16 INFO - PID 7938 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 673: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:56:16 INFO - PID 7938 | JavaScript error: resource:///modules/BrowserUsageTelemetry.jsm, line 304: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:56:17 INFO - TEST-INFO | 7938: exit 0 08:56:17 INFO - Browser initialized. 08:56:17 INFO - Running cycle 1/1 for kraken test... 08:56:17 INFO - TEST-INFO | started process 8035 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2f_h4m/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:56:30 INFO - PID 8035 | RSS: Main: 154312704 08:56:30 INFO - PID 8035 | 08:56:32 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47817/tests/kraken/driver.html?testName=audio-beat-detection) 08:56:33 INFO - PID 8035 | RSS: Main: 209367040 08:56:33 INFO - PID 8035 | 08:56:36 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47817/tests/kraken/driver.html?testName=audio-dft) 08:56:37 INFO - PID 8035 | RSS: Main: 188239872 08:56:37 INFO - PID 8035 | 08:56:40 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47817/tests/kraken/driver.html?testName=audio-fft) 08:56:40 INFO - PID 8035 | RSS: Main: 270823424 08:56:40 INFO - PID 8035 | 08:56:43 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47817/tests/kraken/driver.html?testName=audio-oscillator) 08:56:43 INFO - PID 8035 | RSS: Main: 181948416 08:56:43 INFO - PID 8035 | 08:56:45 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47817/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:56:46 INFO - PID 8035 | RSS: Main: 185409536 08:56:46 INFO - PID 8035 | 08:56:49 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47817/tests/kraken/driver.html?testName=imaging-darkroom) 08:56:50 INFO - PID 8035 | RSS: Main: 223944704 08:56:50 INFO - PID 8035 | 08:56:53 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47817/tests/kraken/driver.html?testName=imaging-desaturate) 08:56:54 INFO - PID 8035 | RSS: Main: 219541504 08:56:54 INFO - PID 8035 | 08:56:57 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47817/tests/kraken/driver.html?testName=json-parse-financial) 08:56:58 INFO - PID 8035 | RSS: Main: 221630464 08:56:58 INFO - PID 8035 | 08:56:59 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47817/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:57:00 INFO - PID 8035 | RSS: Main: 184659968 08:57:00 INFO - PID 8035 | 08:57:02 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47817/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:57:02 INFO - PID 8035 | RSS: Main: 191631360 08:57:02 INFO - PID 8035 | 08:57:04 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47817/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:57:05 INFO - PID 8035 | RSS: Main: 201289728 08:57:05 INFO - PID 8035 | 08:57:08 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47817/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:57:09 INFO - PID 8035 | RSS: Main: 205459456 08:57:09 INFO - PID 8035 | 08:57:12 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47817/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:57:13 INFO - PID 8035 | RSS: Main: 206278656 08:57:13 INFO - PID 8035 | 08:57:14 INFO - PID 8035 | Cycle 1(1): loaded http://localhost:47817/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47817/tests/kraken/driver.html?testName=ai-astar) 08:57:15 INFO - PID 8035 | RSS: Main: 275701760 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | __start_tp_report 08:57:15 INFO - PID 8035 | _x_x_mozilla_page_load 08:57:15 INFO - PID 8035 | _x_x_mozilla_page_load_details 08:57:15 INFO - PID 8035 | |i|pagename|runs| 08:57:15 INFO - PID 8035 | |0;ai-astar;110;111;113;114;110;112;113;112;113;112 08:57:15 INFO - PID 8035 | |1;audio-beat-detection;163;130;125;173;130;126;125;126;147;126 08:57:15 INFO - PID 8035 | |2;audio-dft;166;164;165;165;165;166;166;173;172;172 08:57:15 INFO - PID 8035 | |3;audio-fft;78;76;76;111;76;76;76;88;96;76 08:57:15 INFO - PID 8035 | |4;audio-oscillator;84;85;115;84;83;85;107;84;85;106 08:57:15 INFO - PID 8035 | |5;imaging-gaussian-blur;114;116;113;115;114;115;114;114;114;114 08:57:15 INFO - PID 8035 | |6;imaging-darkroom;155;150;149;149;149;150;149;150;149;150 08:57:15 INFO - PID 8035 | |7;imaging-desaturate;101;94;95;95;95;95;95;95;95;95 08:57:15 INFO - PID 8035 | |8;json-parse-financial;53;54;55;54;55;55;55;55;55;55 08:57:15 INFO - PID 8035 | |9;json-stringify-tinderbox;57;56;56;55;55;56;57;56;56;56 08:57:15 INFO - PID 8035 | |10;stanford-crypto-aes;84;85;84;84;83;84;82;83;83;86 08:57:15 INFO - PID 8035 | |11;stanford-crypto-ccm;149;137;142;145;140;135;138;139;227;148 08:57:15 INFO - PID 8035 | |12;stanford-crypto-pbkdf2;185;197;202;193;199;201;201;198;196;196 08:57:15 INFO - PID 8035 | |13;stanford-crypto-sha256-iterative;78;71;71;72;71;72;72;74;71;71 08:57:15 INFO - PID 8035 | __end_tp_report 08:57:15 INFO - PID 8035 | __start_cc_report 08:57:15 INFO - PID 8035 | _x_x_mozilla_cycle_collect,2001 08:57:15 INFO - PID 8035 | __end_cc_report 08:57:15 INFO - PID 8035 | __startTimestamp1491580635080__endTimestamp 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | ------- Summary: start ------- 08:57:15 INFO - PID 8035 | Number of tests: 14 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#0] ai-astar Cycles:10 Average:112.00 Median:112.50 stddev:1.33 (1.2%) stddev-sans-first:1.20 08:57:15 INFO - PID 8035 | Values: 110.0 111.0 113.0 114.0 110.0 112.0 113.0 112.0 113.0 112.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#1] audio-beat-detection Cycles:10 Average:137.10 Median:130.00 stddev:17.70 (13.6%) stddev-sans-first:16.11 08:57:15 INFO - PID 8035 | Values: 163.0 130.0 125.0 173.0 130.0 126.0 125.0 126.0 147.0 126.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#2] audio-dft Cycles:10 Average:167.40 Median:166.00 stddev:3.47 (2.1%) stddev-sans-first:3.64 08:57:15 INFO - PID 8035 | Values: 166.0 164.0 165.0 165.0 165.0 166.0 166.0 173.0 172.0 172.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#3] audio-fft Cycles:10 Average:82.90 Median:76.00 stddev:12.00 (15.8%) stddev-sans-first:12.60 08:57:15 INFO - PID 8035 | Values: 78.0 76.0 76.0 111.0 76.0 76.0 76.0 88.0 96.0 76.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#4] audio-oscillator Cycles:10 Average:91.80 Median:84.00 stddev:12.34 (14.7%) stddev-sans-first:12.76 08:57:15 INFO - PID 8035 | Values: 84.0 85.0 115.0 84.0 83.0 85.0 107.0 84.0 85.0 106.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#5] imaging-gaussian-blur Cycles:10 Average:114.30 Median:114.00 stddev:0.82 (0.7%) stddev-sans-first:0.87 08:57:15 INFO - PID 8035 | Values: 114.0 116.0 113.0 115.0 114.0 115.0 114.0 114.0 114.0 114.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#6] imaging-darkroom Cycles:10 Average:150.00 Median:150.00 stddev:1.83 (1.2%) stddev-sans-first:0.53 08:57:15 INFO - PID 8035 | Values: 155.0 150.0 149.0 149.0 149.0 150.0 149.0 150.0 149.0 150.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:95.00 stddev:1.96 (2.1%) stddev-sans-first:0.33 08:57:15 INFO - PID 8035 | Values: 101.0 94.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#8] json-parse-financial Cycles:10 Average:54.60 Median:55.00 stddev:0.70 (1.3%) stddev-sans-first:0.44 08:57:15 INFO - PID 8035 | Values: 53.0 54.0 55.0 54.0 55.0 55.0 55.0 55.0 55.0 55.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#9] json-stringify-tinderbox Cycles:10 Average:56.00 Median:56.00 stddev:0.67 (1.2%) stddev-sans-first:0.60 08:57:15 INFO - PID 8035 | Values: 57.0 56.0 56.0 55.0 55.0 56.0 57.0 56.0 56.0 56.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#10] stanford-crypto-aes Cycles:10 Average:83.80 Median:84.00 stddev:1.14 (1.4%) stddev-sans-first:1.20 08:57:15 INFO - PID 8035 | Values: 84.0 85.0 84.0 84.0 83.0 84.0 82.0 83.0 83.0 86.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#11] stanford-crypto-ccm Cycles:10 Average:150.00 Median:143.50 stddev:27.45 (19.1%) stddev-sans-first:29.11 08:57:15 INFO - PID 8035 | Values: 149.0 137.0 142.0 145.0 140.0 135.0 138.0 139.0 227.0 148.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:196.80 Median:198.50 stddev:4.98 (2.5%) stddev-sans-first:2.93 08:57:15 INFO - PID 8035 | Values: 185.0 197.0 202.0 193.0 199.0 201.0 201.0 198.0 196.0 196.0 08:57:15 INFO - PID 8035 | 08:57:15 INFO - PID 8035 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.30 Median:72.00 stddev:2.21 (3.1%) stddev-sans-first:1.00 08:57:15 INFO - PID 8035 | Values: 78.0 71.0 71.0 72.0 71.0 72.0 72.0 74.0 71.0 71.0 08:57:15 INFO - PID 8035 | -------- Summary: end -------- 08:57:15 INFO - PID 8035 | 08:57:16 INFO - TEST-INFO | 8035: exit 0 08:57:16 INFO - TEST-OK | kraken | took 65050ms 08:57:16 INFO - SUITE-END | took 1188s 08:57:16 INFO - Completed test suite (00:19:48) 08:57:16 INFO - javascript benchmark 08:57:16 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": [], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6699.437443241458, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2686.4627074585082, 2725.6184134221226, 2731.576605626128, 2755.1321333779856, 2755.966512557791, 5158.123119069758, 5310.522053015228, 5331.520163185312, 5331.520163185312, 5423.511883930445, 5281.207818827178, 5281.2342210379475, 5298.92051619226, 5309.33633295838, 5311.2298716686155, 4709.293605959117, 4728.550787675165, 4761.285807128941, 4773.832915847946, 4802.25565037418, 4767.90464190716, 4801.639877009221, 4802.279658051285, 4805.735684537349, 4812.68717533361, 4793.832215872445, 4799.016201678665, 4804.231322988323, 4805.255185446262, 4809.807607695706, 4781.211100168468, 4800.3279540864305, 4804.375431193957, 4808.543188397097, 4808.975955120202, 4733.692309999873, 4741.359916411275, 4765.356676848615, 4774.689645173087, 4775.594074503671, 5331.253624492574, 5409.918851217235, 5409.9459005409835, 5413.350397952271, 5433.809816656438, 5591.329040515124, 5769.855753606152, 5780.248567686216, 5785.2189954356045, 5841.474267315962, 5744.6840423776675, 5784.8843023139725, 5786.768529258825, 5798.855028624276, 5805.941940580582, 4343.782810859476, 5329.54698850602, 5396.460353964572, 5409.756560954727, 5414.3232095988005, 5920.4967577755515, 5933.732982015819, 5933.881322373529, 5941.732622031933, 5946.048632218911, 5510.504054635102, 5643.887122257532, 5657.405972372924, 5662.122371032414, 5663.830085097454, 5744.770209191585, 5765.682887441147, 5768.855778605568, 5771.336296325892, 5778.971105144531, 5726.570507211893, 5770.2498675171955, 5794.594378393556, 5797.623154495029, 5820.912686309709, 5714.685692286881, 5749.453801888814, 5759.7408116634015, 5775.220345253421, 5775.653460792366, 4786.138495070921, 4851.466338702739, 4893.4617192108835, 4895.437024742129, 4950.628702847301, 4137.131202447459, 4150.086980864205, 4150.543440221573, 4162.209180255742, 4185.874423767292, 4900.779464924087, 4907.509249075135, 4907.55831975124, 4908.705477671279, 4912.238603016538, 5743.396943320975, 5794.50746686528, 5795.739191736382, 5796.768129274782, 5799.101139323411, 4796.976015119972, 4860.756962151878, 4867.3915760529935, 4867.975660121677, 4914.70511769295, 5159.484051594811, 5161.096808058574, 5162.174052151638, 5170.560502357266, 5179.870503237449, 5271.630985830955, 5338.97330513345, 5353.812616558402, 5354.54486368663, 5360.490753378423, 5850.0, 5857.58996870215, 5863.560232982458, 5889.263842019747, 5909.497692696169, 5352.0, 5390.649607775482, 5392.568594512508, 5393.649412788156, 5411.134218525174, 5593.552515798645, 5666.660000399989, 5738.856528586819, 5742.138679198154, 5743.511801496752, 5780.768769249351, 5785.4214578541805, 5817.7963771267805, 5870.471657550841, 5873.353931067664, 5607.495325420732, 5654.491095801398, 5696.857578560569, 5700.486956173964, 5710.5717071219, 5599.384067752625, 5632.0, 5632.436756324335, 5641.548676105984, 5647.237622920853, 5368.677879327252, 5453.072977593898, 5512.641678290898, 5573.916391254053, 5579.637323573955, 5636.21093046982, 5664.178694089416, 5664.773409063591, 5692.857678558069, 5743.396943321059, 5533.00405926937, 5571.303587051619, 5578.079616863334, 5580.441955804549, 5586.86032849182], "value": 5230.832145022523, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [733.8018734941566, 747.7681918605231, 1049.06109032416, 1062.7236918401213, 1180.7579446213526, 32216.67783322166, 33528.66471335286, 33538.83230583847, 33544.161395965115, 33591.328173436515, 31384.843075784647, 31768.20579485514, 31789.0, 31797.205069873206, 31842.522362164527, 5492.533134683556, 5601.131824567198, 6666.0667506549125, 6801.251862295144, 6808.557443766164, 6979.720811167547, 7156.785296441115, 7160.64196790161, 7165.319294666998, 7166.892496612555, 7212.819679508002, 7263.1284245890565, 7265.564066156021, 7270.418366530691, 7271.345578897898, 7179.820504487378, 7226.891596626002, 7234.385077268438, 7236.312550307739, 7239.638018099126, 7203.639818009078, 7251.057362542836, 7259.89110163348, 7263.455240856904, 7264.818379540501, 31998.360032799214, 32243.19392015195, 32251.354972900644, 32398.6760132398, 32403.675963240537, 3027.1523973287512, 3061.158181500083, 3063.3720087382035, 3069.2020074780494, 3069.478188707925, 24641.38396540083, 24672.136475223462, 24710.752892471024, 24723.50552988948, 24763.5047299053, 3063.188255112397, 3098.055093196574, 3098.5662007318992, 3125.1249650098007, 3139.450596145688, 134513.0, 134708.0, 134880.32559837235, 135068.32465837608, 135078.0, 33715.83142084274, 34594.0, 38875.61124388777, 40113.0, 40285.59714402877, 41132.588674113475, 41142.0, 41157.38263926043, 41179.382309265384, 41187.382189267184, 12503.937480312723, 12591.055670824542, 12678.9366053171, 12679.112462127563, 12728.745425091447, 9936.20510359184, 9999.800003999879, 10008.849867251996, 10087.0, 10094.192464602815, 11444.713882153013, 11527.76944461106, 11593.014593759457, 11719.296842189326, 11744.76510469803, 4776.426828780569, 4789.784459699322, 4797.208460604031, 4813.927791083137, 4831.806727730851, 865.4720620421538, 874.5190145419994, 877.1886005444937, 877.916597923209, 895.5343221524771, 19191.0, 20078.297259595845, 20455.8977205113, 20488.59022819565, 20830.791692082887, 942.3074040580168, 956.416585882611, 964.9807003860024, 973.8831340239217, 980.3970558106855, 10380.216013710102, 10733.731656708489, 10802.945985270024, 10850.0777433919, 11091.944540277247, 181085.0, 181532.0, 181952.0, 182019.0, 182776.0, 40216.59783402187, 40418.79790601028, 40437.0, 40466.0, 40496.39255411171, 1198.8335673398965, 1210.5520957245699, 1216.1000859364008, 1217.379136640302, 1228.3244215681339, 18613.906930465262, 19075.80924190796, 20052.197912083353, 20093.49766255855, 20348.79651203469, 29658.0, 29682.10953671393, 29692.703072968994, 29705.554416683335, 29728.0, 175181.12409438382, 176093.0, 176196.11901940408, 176244.1187794104, 176299.0, 22574.661380078982, 23043.193488227833, 26271.343216419744, 28155.155345339674, 28244.293892652848, 32026.0, 32061.358772823947, 32201.0, 32394.67605324011, 32981.50527742038, 24865.39990101837, 24874.751252487968, 25419.237422877344, 25811.354716132246, 25972.694377112435, 24973.87513062423, 25229.24312270635, 25482.490350193264, 25620.103296384535, 25679.0, 27260.591091133254, 28044.055374185416, 28131.71868281291, 28193.859030705535, 28226.0, 24290.75709242885, 24512.75487245105, 25117.87441062783, 25785.355366115997, 25870.87064564665, 19796.703049454558, 20767.169313227907, 20813.58372832565, 20816.60140174071, 20829.583408331444], "value": 14123.122474878863, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [407.2465938014673, 414.34326592351124, 422.75902735440803, 435.16665585403945, 447.34464010225014, 17898.284068637273, 18147.546311342223, 18235.908820455912, 18882.33911813087, 18964.90517547412, 18324.725129123042, 18601.7209741854, 18998.90500547499, 19176.71234931477, 19210.615787684237, 5589.832305030835, 5605.159226116074, 5743.310802703661, 5786.421357864201, 5791.971040144815, 5641.971790141043, 5768.423157684219, 5771.509421699139, 5773.422657734235, 5776.364599894008, 5565.30433695788, 5695.060315048012, 5703.57223208259, 5711.2575365202465, 5713.085906255, 5437.293151890269, 5574.10814269717, 5607.523360514361, 5612.147991162907, 5616.073347897613, 5083.61872859537, 5137.717425541594, 5145.125328694094, 5145.845624631267, 5146.459621739701, 21836.23573174947, 22171.00230489632, 22277.331680049625, 22387.0, 22546.661800073012, 1641.6798724248777, 1671.35652773683, 1677.7064013797537, 1678.7230107032326, 1679.9916000420042, 14612.926935365362, 14716.705665886622, 14947.252637368198, 15031.699366012728, 15080.849191508054, 2030.644637188486, 2067.059487932987, 2113.323736404351, 2142.121730090671, 2162.059504115715, 80034.5998270005, 80054.59972700158, 80309.0, 81691.5915420425, 81795.18204817935, 10864.619738309122, 11058.668239952814, 11166.0, 11177.49701263445, 11267.605633802777, 15403.306851191499, 15413.691726165414, 15424.922875385551, 15442.768358474632, 15452.072875627498, 6899.318090653799, 7080.929190708027, 7271.381932535688, 7279.963600181965, 7281.854362912712, 6348.206474190726, 6359.6184228945485, 6375.904361434582, 6542.934570654233, 6544.934550654528, 6869.450443964471, 6880.311968803079, 6946.305369463013, 7012.333828286304, 7080.929190708027, 1979.9406017819201, 1995.1420889017572, 2002.3092033248506, 2021.6866385710239, 2025.2607798153567, 863.9827203455895, 887.8890138732659, 894.7226359828474, 895.5029958373035, 922.377395258198, 16776.65786737058, 16999.575010624587, 17653.558661033578, 17664.9116754418, 18001.459956201335, 893.2675206330747, 895.5164211325811, 901.4005686218591, 903.3992395057345, 920.9815803684023, 9325.906740932503, 9473.952630236805, 9842.163416109568, 9886.068358984552, 9928.751781205383, 434294.0, 436893.0, 445698.0, 447709.0, 449785.0, 92989.0, 93605.0, 94420.52789736008, 95574.52212739032, 95647.52176239074, 1083.101026148295, 1094.8631421072366, 1132.4733998690483, 1137.7155711072232, 1138.573035111833, 17339.2197351122, 17777.911110444365, 17853.125421830522, 18935.14791834343, 19059.618807624047, 44913.01426118096, 45998.77000614975, 46021.0, 46435.0, 47064.0, 51178.74410627923, 54624.72687636536, 54921.72539137279, 55062.0, 55499.44500554943, 7759.466499325174, 7765.339946104418, 7788.688452461838, 7907.84184316299, 8067.5797260820345, 12011.099167562643, 12089.81865272004, 12173.20874143178, 12263.202891812003, 12325.260484370609, 10104.494775261355, 10134.391936483835, 10395.376277423378, 10742.462876856282, 10777.407242601732, 10374.844377334497, 10394.58421663125, 10557.366558006544, 10647.361158330525, 10896.237263391486, 10744.355338679705, 10870.130389568974, 11046.226764126433, 11101.056410205223, 11213.60752373663, 7924.0, 8015.559144247122, 8192.484390387797, 8231.218034286732, 8275.131111233233, 9959.352642078242, 10030.899691002996, 10253.692389228336, 10322.587096516056, 10547.578096876347], "value": 9003.082758422634, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1133.1501373969522, 1276.5787290194237, 1333.2800287844564, 1344.166616697647, 1348.7504811609854, 8574.271186949109, 9820.901790982098, 10110.595576176953, 10167.949160254208, 10182.439965801877, 9925.354851934619, 10014.198864090873, 10024.348417352885, 10034.347767395115, 10043.447610381427, 1941.9805801942011, 2269.954600907985, 2293.747687754346, 2294.437862723635, 2297.356740112771, 1999.2103119267954, 2277.954440911181, 2368.017272831773, 2371.774681405264, 2379.1553998330605, 2203.603351396748, 2221.244776775896, 2225.621644320461, 2228.765979572146, 2234.7876951689564, 2206.5145667953025, 2240.305505293356, 2244.3827947314458, 2247.0113150213933, 2250.606143924823, 2191.82465402769, 2199.3841724317217, 2202.405350555341, 2206.2388475975763, 2207.2054060538194, 10211.6425925093, 10277.743056423575, 10294.43380614066, 10302.639407620773, 10304.433256170907, 5731.340895796995, 5906.675132867691, 5938.346781854036, 5939.643621382731, 5952.1964534787685, 3355.899323020313, 3453.033150717803, 3575.94636080459, 3589.6769290763696, 3597.8740744074094, 1072.6781965410346, 1104.1332553945194, 1153.3887039868882, 1155.699518125285, 1159.4550561236206, 14446.855531444657, 14455.638609034753, 14455.927720361437, 14466.204358760264, 14470.348834302376, 5084.51697088776, 5103.948960510347, 5111.309973153651, 5292.311999440049, 5299.417064122943, 12092.39538023113, 12106.81839772404, 12117.575884843987, 12119.454624541917, 12141.964508872781, 5797.710114494258, 5800.100984347433, 5816.651000939957, 5817.592768506164, 5837.270341207349, 5163.97418012915, 5239.476052394806, 5247.134222853187, 5408.756605952742, 5456.863578410572, 4225.535191128974, 4267.338562522814, 4297.871063868089, 4344.196323680129, 4353.760543170156, 1340.2360654426884, 1354.6477915741782, 1355.4578168732585, 1381.7927310903244, 1386.272207091265, 700.7057036044873, 712.7826013066065, 727.7198278662753, 739.5636574421118, 753.9132999705104, 5463.235147079412, 5519.2824932758485, 5729.427057294237, 5833.88332233353, 6599.175103112111, 841.5077179849857, 842.3177226446597, 842.8567143585606, 846.7205822078822, 868.2446271743497, 3980.8606698765984, 4048.959510404858, 4052.574479679591, 4087.0395457067566, 4130.091379896418, 12933.54732584355, 13395.732085358239, 13464.461421543225, 13464.663383415493, 13467.393967271497, 13128.540501082416, 13195.670108247179, 13208.075434719478, 13228.735425291441, 13244.867551324363, 9620.75948101303, 9668.564914578861, 9776.071273229032, 9945.303828732063, 9952.054554817281, 6080.8783824324155, 6247.68761561911, 6257.4994000480765, 6317.368263173646, 6443.742250309935, 11962.880371196177, 12103.576374826838, 12226.0, 12308.0, 12332.136750427384, 10316.226283028653, 12447.875521245034, 12593.181443206162, 12630.684232894251, 12632.873671263169, 7623.123340815877, 7738.303552680286, 7826.491278066907, 7828.804279893048, 7830.2952734254195, 9176.632934682539, 9216.631334746804, 9258.398204116711, 9332.673356432764, 9333.160015598358, 8286.295664868312, 8440.831183376175, 8465.492070475791, 8571.185737354941, 8651.48091114535, 7763.10724266694, 7963.601819908866, 8128.471649342774, 8131.878021829795, 8169.346452283922, 7114.786556403316, 7142.250063743232, 7272.563646181246, 7274.454415918722, 7277.235890231661, 5661.122526008476, 5767.2502574666705, 5819.4180581943165, 5819.476247137778, 5921.052631579099, 5658.265813151861, 5742.741576628978, 5773.942260577341, 5972.581919265784, 5991.221141251609], "value": 4912.149634710012, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [380.85146792750834, 395.59253968412537, 399.8968008255935, 400.1217327965114, 405.8437501561898, 5331.706756128417, 5365.758540865666, 5409.106812615582, 5415.918761218575, 5430.67415955043, 5106.183010718286, 5204.193350030741, 5302.469753024696, 5324.227986941891, 5332.973335133319, 4185.560516145806, 4212.452381190441, 4226.429432026668, 4226.746395216282, 4228.260054490467, 4224.134052519226, 4242.21519018981, 4253.574642535753, 4256.212600668886, 4257.0, 4102.364133559288, 4206.0, 4208.97895510522, 4215.873523794291, 4225.91548169038, 4200.621944025037, 4206.579342065799, 4209.410682504452, 4211.936820947688, 4233.259179643565, 3785.5047256333596, 3789.9810500947597, 3790.65884070435, 3806.0, 3809.980950095232, 5094.541491265803, 5159.948400515985, 5174.197999310075, 5193.4938867728315, 5217.087009773312, 4551.726896386227, 4710.905781884378, 4733.3846599942135, 4742.644301677388, 4744.928826067612, 5568.888622227573, 5570.303712035996, 5573.749181286852, 5587.1339942309005, 5595.580331475156, 3983.50206224222, 3989.501312335958, 4000.2599519089063, 4003.11931375097, 4015.819288132041, 5612.35457922336, 5683.573731970118, 5814.796482123105, 5858.677772722499, 5966.241268001175, 3970.642642162219, 4054.3715724062818, 4058.452108965311, 4065.735727177724, 4083.8366465341055, 4115.5678653741525, 4135.17296540687, 4158.9376159357635, 4160.375943608483, 4163.208990291835, 4489.9775501122285, 4570.840020599329, 4601.148787474328, 4746.0, 4754.072955773591, 5552.52803511706, 5577.414371491016, 5580.19087232349, 5581.5813813963305, 5603.971980140073, 1411.922344271075, 1420.7868819676924, 1425.415579612354, 1435.0170133458614, 1439.1796675894848, 946.1579194516886, 969.8981606931312, 976.2531663277598, 982.8378317577519, 985.2216748768536, 4870.9269360959615, 4882.584980276645, 4883.706977581356, 4907.6564640475535, 4911.508849115131, 5766.88466230673, 5771.220885180447, 5775.5668324875805, 5776.566757493205, 5793.754342816314, 4716.198246298069, 4906.460289368167, 4914.33656456381, 4916.508349165055, 4935.383077115361, 3068.3709839482854, 3090.5165520550263, 3092.2424006118645, 3097.1018404662846, 3119.1890108571934, 5429.864253393618, 5434.375046869582, 5441.755121019563, 5454.863628409322, 5456.508914197741, 5829.504492118217, 5961.433663801932, 5980.162777211194, 5997.910031349533, 5999.340072592011, 5399.811006614749, 5400.0, 5402.864928376744, 5418.647787893853, 5423.810166644227, 5683.829485115453, 5834.0747553306455, 5835.3581106077445, 5836.591438599257, 5837.562182836219, 5701.318111157136, 5739.823336215982, 5757.280339957505, 5770.653760774367, 5779.768809247751, 5162.97418512905, 5278.709670968134, 5303.204519322133, 5313.734313284398, 5402.5677945763455, 3881.3983832506005, 3928.626780455852, 3936.8818935430836, 3996.820143093626, 4021.8994525137105, 5773.8556536086935, 5784.334801497714, 5798.362180160095, 5802.4197580241635, 5819.447152520504, 5464.972675136599, 5570.3315602128005, 5617.32592088952, 5631.183478395692, 5632.521235694848, 5602.299712535933, 5612.130119831432, 5617.606767526234, 5619.129034999582, 5625.718714064362, 5391.568674506108, 5526.696031718294, 5544.972275138599, 5546.362168350692, 5559.305086864142, 5644.209810626434, 5650.01124803166, 5667.603267771216, 5670.631408958405, 5681.630694004876, 5491.807786727445, 5525.0, 5528.668279903219, 5541.362743284412, 5560.082586373203], "value": 4249.451908269213, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [736.028442455958, 742.2799884112411, 747.193031525952, 755.4183278875263, 768.3891306411402, 13359.398827052783, 13614.45542178313, 13826.17042977422, 14091.084079534836, 14120.646983825409, 12878.0, 13196.0, 13212.339383030858, 13215.141015833964, 13348.866511334909, 841.1966571923829, 857.9356548258875, 865.3293697384514, 865.7186414415308, 866.3026263857593, 861.9094995025526, 895.5969813583881, 898.5956319656149, 899.3030401438905, 899.6266549381999, 932.39394393644, 933.8785957825473, 934.5187228577288, 934.9205317548017, 935.1396715022196, 929.005963618928, 929.5631053404888, 929.9767505812341, 930.0745757970794, 930.0792215706435, 680.1430197950568, 682.8054004608663, 683.0948992584796, 683.5181197255922, 683.5249501596393, 14280.07179533327, 14568.12591244518, 14650.487232946902, 14674.486392976194, 14675.339609717588, 13040.0, 13699.96956892639, 13746.518871839538, 13834.515791947335, 13993.16041037541, 11627.6511704649, 11955.641330760003, 12006.819897701542, 12051.15641905067, 12154.513819447211, 2824.5198316286283, 2849.1879814253048, 2862.6421697287838, 2867.698891616392, 2879.956800647971, 65713.0, 65799.34200658028, 67028.32971670319, 68311.0, 68625.65687171533, 10806.135509159249, 10827.133829293638, 10916.07213386855, 10974.0, 10975.780484390267, 20239.898800505904, 21361.89319053395, 22355.217567385065, 22847.543049138923, 22850.428739281317, 6904.0, 6910.239873613898, 6992.965035174791, 6994.545354551938, 7076.32774886385, 3427.1089516725333, 3449.965500345015, 3455.51622772812, 3497.667721566498, 3503.1417302760988, 3806.9428958565645, 3873.8063096845044, 3896.2012787379085, 3902.492675952165, 3912.4522566840665, 745.8694728422613, 779.9649015794303, 789.6841263494648, 792.4769652029632, 792.8374683189933, 567.8410045187354, 583.3146053387253, 592.1739173852537, 597.1490625858135, 615.7690865925279, 8421.831563368822, 8807.867881981776, 8846.690365837165, 8848.734537963872, 9146.634134634673, 589.9056151015817, 596.9940300596938, 598.1536126381209, 613.2702084519408, 616.3651439017818, 3753.512043434336, 3787.9242415152094, 3822.5412950446125, 3850.961490385116, 3889.5138107736534, 65451.67274163694, 66932.665336673, 67711.5674010978, 67940.6602966982, 69341.30658693348, 57851.0, 57929.4207057924, 58552.4144758547, 58906.0, 59182.40817591769, 39262.411063834064, 48662.756686216344, 49704.75147624239, 50606.0, 51849.2222616661, 8674.132586741276, 9056.637734490547, 9230.630774768933, 9231.35380523357, 9232.723018309462, 26560.468790624465, 26980.1905942822, 27029.72970270272, 27183.86408067947, 27708.891644334002, 32156.83921580377, 32382.0, 32499.0, 32805.83597082095, 33049.83475082609, 11651.59219427316, 11971.521139154685, 12089.697757556132, 12124.09069319787, 12198.634040978784, 12992.740145196854, 13162.868371316164, 13251.867481325064, 13327.067105302536, 13328.0, 12166.756664866476, 12332.445039973043, 12469.688257793629, 12668.049896258002, 13170.275634840176, 11011.504482298156, 11128.332300062022, 11254.268472549258, 11333.689236587637, 11720.296782193096, 11178.552857885594, 11199.104071674083, 11369.829452558053, 11474.196806223485, 11508.194426390073, 8888.422252553562, 8977.730668079968, 9047.954760226157, 9171.128742769426, 9239.538023098952, 9035.774105647411, 9190.0, 9466.857997130186, 9478.668246611336, 9522.571484283086], "value": 6511.820198060333, "unit": "score"}]}, {"extraOptions": [], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1564.4999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 111.0, 113.0, 114.0, 110.0, 112.0, 113.0, 112.0, 113.0, 112.0], "value": 112.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 130.0, 125.0, 173.0, 130.0, 126.0, 125.0, 126.0, 147.0, 126.0], "value": 137.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [166.0, 164.0, 165.0, 165.0, 165.0, 166.0, 166.0, 173.0, 172.0, 172.0], "value": 167.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 76.0, 76.0, 111.0, 76.0, 76.0, 76.0, 88.0, 96.0, 76.0], "value": 82.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 115.0, 84.0, 83.0, 85.0, 107.0, 84.0, 85.0, 106.0], "value": 91.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 116.0, 113.0, 115.0, 114.0, 115.0, 114.0, 114.0, 114.0, 114.0], "value": 114.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 150.0, 149.0, 149.0, 149.0, 150.0, 149.0, 150.0, 149.0, 150.0], "value": 150.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 94.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 54.0, 55.0, 54.0, 55.0, 55.0, 55.0, 55.0, 55.0, 55.0], "value": 54.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 56.0, 56.0, 55.0, 55.0, 56.0, 57.0, 56.0, 56.0, 56.0], "value": 56.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 84.0, 84.0, 83.0, 84.0, 82.0, 83.0, 83.0, 86.0], "value": 83.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 137.0, 142.0, 145.0, 140.0, 135.0, 138.0, 139.0, 227.0, 148.0], "value": 150.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [185.0, 197.0, 202.0, 193.0, 199.0, 201.0, 201.0, 198.0, 196.0, 196.0], "value": 196.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 71.0, 71.0, 72.0, 71.0, 72.0, 72.0, 74.0, 71.0, 71.0], "value": 72.3, "unit": "score"}]}]} 08:57:16 INFO - Return code: 0 08:57:16 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:57:16 ERROR - # TBPL SUCCESS # 08:57:16 INFO - Running post-action listener: _resource_record_post_action 08:57:16 INFO - [mozharness: 2017-04-07 15:57:16.905819Z] Finished run-tests step (success) 08:57:16 INFO - Running post-run listener: _resource_record_post_run 08:57:16 INFO - Total resource usage - Wall time: 1204s; CPU: 13.0%; Read bytes: 4096; Write bytes: 366182400; Read time: 16; Write time: 190100 08:57:16 INFO - TinderboxPrint: CPU usage
13.0% 08:57:16 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 08:57:16 INFO - TinderboxPrint: I/O write bytes / time
366,182,400 / 190,100 08:57:16 INFO - TinderboxPrint: CPU idle
8,360.3 (87.0%) 08:57:16 INFO - TinderboxPrint: CPU user
1,203.2 (12.5%) 08:57:16 INFO - TinderboxPrint: Swap in / out
0 / 0 08:57:16 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 114065408; Read time: 0; Write time: 85120 08:57:17 INFO - run-tests - Wall time: 1189s; CPU: 13.0%; Read bytes: 0; Write bytes: 252116992; Read time: 0; Write time: 104980 08:57:17 INFO - Running post-run listener: _upload_blobber_files 08:57:17 INFO - Blob upload gear active. 08:57:17 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:57:17 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 08:57:17 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', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:57:17 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 Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:57:18 INFO - (blobuploader) - INFO - Open directory for files ... 08:57:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:57:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:57:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:57:21 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:57:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:57:21 INFO - (blobuploader) - INFO - Done attempting. 08:57:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:57:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:57:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:57:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:57:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:57:23 INFO - (blobuploader) - INFO - Done attempting. 08:57:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 08:57:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:57:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:57:24 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 08:57:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:57:24 INFO - (blobuploader) - INFO - Done attempting. 08:57:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:57:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:57:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:57:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:57:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:57:25 INFO - (blobuploader) - INFO - Done attempting. 08:57:25 INFO - (blobuploader) - INFO - Iteration through files over. 08:57:25 INFO - Return code: 0 08:57:25 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:57:25 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:57:25 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e5c8627c4453f3b0981d5f87f208bca13a5017c0041bfc1f8b2e8cf20b9765d0414d1afb25dbe76803ee381c553f3c59b35aa7b76237d57d0b781161a6e7ede4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a1e43ed130c74b8f8b52f9cf8d6b4c87bc51564f963236f5bfd9d20bea2954b326f7126fce3d3c928eea45341fc156dee790ee6cd0d2db9dfabe461a6813267c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8af2c33e0502d43fd10d9790696674e1f03941539bd58dbde6f41c64d7300224e35e23b78c61cd8d39694747fd9db8ba08747bed45bc7bb3afa77227e0ad988d", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/5d6b17a3d00cc274554464bfe54f5a11efdf77b7b73873e6eb319fee0ce2f6725b88b426cfe3ddd01e8b5e990428ceb5ac13b5f5a813cea9971cf844d98aa4cf"} 08:57:25 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:57:25 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:57:25 INFO - Contents: 08:57:25 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e5c8627c4453f3b0981d5f87f208bca13a5017c0041bfc1f8b2e8cf20b9765d0414d1afb25dbe76803ee381c553f3c59b35aa7b76237d57d0b781161a6e7ede4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a1e43ed130c74b8f8b52f9cf8d6b4c87bc51564f963236f5bfd9d20bea2954b326f7126fce3d3c928eea45341fc156dee790ee6cd0d2db9dfabe461a6813267c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8af2c33e0502d43fd10d9790696674e1f03941539bd58dbde6f41c64d7300224e35e23b78c61cd8d39694747fd9db8ba08747bed45bc7bb3afa77227e0ad988d", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/5d6b17a3d00cc274554464bfe54f5a11efdf77b7b73873e6eb319fee0ce2f6725b88b426cfe3ddd01e8b5e990428ceb5ac13b5f5a813cea9971cf844d98aa4cf"} 08:57:25 INFO - Running post-run listener: copy_logs_to_upload_dir 08:57:25 INFO - Copying logs to upload dir... 08:57:25 INFO - mkdir: /builds/slave/test/build/upload/logs 08:57:25 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1266.392381 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 6 secs) (at 2017-04-07 08:57:25.662456) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-07 08:57:25.666396) ========= 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=dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e5c8627c4453f3b0981d5f87f208bca13a5017c0041bfc1f8b2e8cf20b9765d0414d1afb25dbe76803ee381c553f3c59b35aa7b76237d57d0b781161a6e7ede4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a1e43ed130c74b8f8b52f9cf8d6b4c87bc51564f963236f5bfd9d20bea2954b326f7126fce3d3c928eea45341fc156dee790ee6cd0d2db9dfabe461a6813267c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8af2c33e0502d43fd10d9790696674e1f03941539bd58dbde6f41c64d7300224e35e23b78c61cd8d39694747fd9db8ba08747bed45bc7bb3afa77227e0ad988d", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/5d6b17a3d00cc274554464bfe54f5a11efdf77b7b73873e6eb319fee0ce2f6725b88b426cfe3ddd01e8b5e990428ceb5ac13b5f5a813cea9971cf844d98aa4cf"} build_url:https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011345 build_url: 'https://queue.taskcluster.net/v1/task/eOKtEkKmSRWLmPWmB-T6rg/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e5c8627c4453f3b0981d5f87f208bca13a5017c0041bfc1f8b2e8cf20b9765d0414d1afb25dbe76803ee381c553f3c59b35aa7b76237d57d0b781161a6e7ede4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/a1e43ed130c74b8f8b52f9cf8d6b4c87bc51564f963236f5bfd9d20bea2954b326f7126fce3d3c928eea45341fc156dee790ee6cd0d2db9dfabe461a6813267c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8af2c33e0502d43fd10d9790696674e1f03941539bd58dbde6f41c64d7300224e35e23b78c61cd8d39694747fd9db8ba08747bed45bc7bb3afa77227e0ad988d", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/5d6b17a3d00cc274554464bfe54f5a11efdf77b7b73873e6eb319fee0ce2f6725b88b426cfe3ddd01e8b5e990428ceb5ac13b5f5a813cea9971cf844d98aa4cf"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-04-07 08:57:25.691846) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-07 08:57:25.692177) ========= 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=dac658600622fd96716c9acf000001b3-1491579374.560896-1472982127 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004351 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-04-07 08:57:25.777416) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-07 08:57:25.777929) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-04-07 08:57:25.778391) ========= ========= Total master_lag: 0.17 =========